Attachment 155135 Details for Bug 236828 – Excerpt from /var/log/messages

Excerpt from /var/log/messages

messages (text/plain), 13.07 KB, created by Adam Huffman on 2007-05-21 22:45:10 UTC

(hide)

Description:

Filename:

MIME Type:

Creator: Adam Huffman

Created: 2007-05-21 22:45:10 UTC

Size: 13.07 KB

patch

obsolete

>May 21 23:18:13 localhost wpa_supplicant[3823]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:18:16 localhost wpa_supplicant[3823]: Trying to associate with 00:14:7f:69:12:4e (SSID='Guermantes' freq=2452 MHz) 
>May 21 23:18:16 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:18:16 localhost wpa_supplicant[3823]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:18:16 localhost wpa_supplicant[3823]: Associated with 00:14:7f:69:12:4e 
>May 21 23:18:16 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:18:16 localhost wpa_supplicant[3823]: Associated with 00:14:7f:69:12:4e 
>May 21 23:18:17 localhost kernel: hwcrypto disabled!
>May 21 23:18:17 localhost kernel: hwcrypto disabled!
>May 21 23:18:17 localhost wpa_supplicant[3823]: WPA: Key negotiation completed with 00:14:7f:69:12:4e [PTK=TKIP GTK=TKIP] 
>May 21 23:18:17 localhost wpa_supplicant[3823]: CTRL-EVENT-CONNECTED - Connection to 00:14:7f:69:12:4e completed (reauth) [id=0 id_str=] 
>May 21 23:19:43 localhost ntpd[2510]: bind() fd 20, family 10, port 123, scope 4, addr fe80::218:deff:fead:10cd, in6_is_addr_multicast=0 flags=17 fails: Cannot assign requested address
>May 21 23:19:43 localhost ntpd[2510]: unable to create socket on wlan0 (12) for fe80::218:deff:fead:10cd#123
>May 21 23:19:43 localhost ntpd[2510]: failed to initialize interface for address fe80::218:deff:fead:10cd
>May 21 23:20:28 localhost kernel: hwcrypto disabled!
>May 21 23:20:28 localhost wpa_supplicant[3823]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:20:31 localhost wpa_supplicant[3823]: Trying to associate with 00:14:7f:69:12:4e (SSID='Guermantes' freq=2452 MHz) 
>May 21 23:20:31 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:20:31 localhost wpa_supplicant[3823]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:20:31 localhost wpa_supplicant[3823]: Associated with 00:14:7f:69:12:4e 
>May 21 23:20:31 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:20:31 localhost wpa_supplicant[3823]: Associated with 00:14:7f:69:12:4e 
>May 21 23:20:32 localhost kernel: hwcrypto disabled!
>May 21 23:20:32 localhost kernel: hwcrypto disabled!
>May 21 23:20:32 localhost wpa_supplicant[3823]: WPA: Key negotiation completed with 00:14:7f:69:12:4e [PTK=TKIP GTK=TKIP] 
>May 21 23:20:32 localhost wpa_supplicant[3823]: CTRL-EVENT-CONNECTED - Connection to 00:14:7f:69:12:4e completed (reauth) [id=0 id_str=] 
>May 21 23:24:43 localhost ntpd[2510]: bind() fd 20, family 10, port 123, scope 4, addr fe80::218:deff:fead:10cd, in6_is_addr_multicast=0 flags=17 fails: Cannot assign requested address
>May 21 23:24:43 localhost ntpd[2510]: unable to create socket on wlan0 (13) for fe80::218:deff:fead:10cd#123
>May 21 23:24:43 localhost ntpd[2510]: failed to initialize interface for address fe80::218:deff:fead:10cd
>May 21 23:27:03 localhost kernel: hwcrypto disabled!
>May 21 23:27:03 localhost wpa_supplicant[3823]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:27:06 localhost wpa_supplicant[3823]: Trying to associate with 00:14:7f:69:12:4e (SSID='Guermantes' freq=2452 MHz) 
>May 21 23:27:06 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:27:06 localhost wpa_supplicant[3823]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:27:06 localhost wpa_supplicant[3823]: Associated with 00:14:7f:69:12:4e 
>May 21 23:27:06 localhost wpa_supplicant[3823]: Associated with 00:14:7f:69:12:4e 
>May 21 23:27:06 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:27:07 localhost kernel: hwcrypto disabled!
>May 21 23:27:07 localhost kernel: hwcrypto disabled!
>May 21 23:27:07 localhost wpa_supplicant[3823]: WPA: Key negotiation completed with 00:14:7f:69:12:4e [PTK=TKIP GTK=TKIP] 
>May 21 23:27:07 localhost wpa_supplicant[3823]: CTRL-EVENT-CONNECTED - Connection to 00:14:7f:69:12:4e completed (reauth) [id=0 id_str=] 
>May 21 23:29:19 localhost kernel: hwcrypto disabled!
>May 21 23:29:19 localhost wpa_supplicant[3823]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:29:22 localhost wpa_supplicant[3823]: Trying to associate with 00:14:7f:69:12:4e (SSID='Guermantes' freq=2452 MHz) 
>May 21 23:29:22 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:29:22 localhost wpa_supplicant[3823]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:29:22 localhost wpa_supplicant[3823]: Associated with 00:14:7f:69:12:4e 
>May 21 23:29:22 localhost wpa_supplicant[3823]: Associated with 00:14:7f:69:12:4e 
>May 21 23:29:22 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:29:23 localhost kernel: hwcrypto disabled!
>May 21 23:29:23 localhost kernel: hwcrypto disabled!
>May 21 23:29:23 localhost wpa_supplicant[3823]: WPA: Key negotiation completed with 00:14:7f:69:12:4e [PTK=TKIP GTK=TKIP] 
>May 21 23:29:23 localhost wpa_supplicant[3823]: CTRL-EVENT-CONNECTED - Connection to 00:14:7f:69:12:4e completed (reauth) [id=0 id_str=] 
>May 21 23:29:24 localhost kernel: hwcrypto disabled!
>May 21 23:29:24 localhost wpa_supplicant[3823]: WPA: Group rekeying completed with 00:14:7f:69:12:4e [GTK=TKIP] 
>May 21 23:29:43 localhost ntpd[2510]: bind() fd 20, family 10, port 123, scope 4, addr fe80::218:deff:fead:10cd, in6_is_addr_multicast=0 flags=17 fails: Cannot assign requested address
>May 21 23:29:43 localhost ntpd[2510]: unable to create socket on wlan0 (14) for fe80::218:deff:fead:10cd#123
>May 21 23:29:43 localhost ntpd[2510]: failed to initialize interface for address fe80::218:deff:fead:10cd
>May 21 23:31:34 localhost kernel: hwcrypto disabled!
>May 21 23:31:34 localhost wpa_supplicant[3823]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:31:37 localhost wpa_supplicant[3823]: Trying to associate with 00:14:7f:69:12:4e (SSID='Guermantes' freq=2452 MHz) 
>May 21 23:31:37 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:31:37 localhost wpa_supplicant[3823]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:31:37 localhost wpa_supplicant[3823]: Associated with 00:14:7f:69:12:4e 
>May 21 23:31:37 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:31:37 localhost wpa_supplicant[3823]: Associated with 00:14:7f:69:12:4e 
>May 21 23:31:45 localhost NetworkManager: <info>  wlan0: link timed out. 
>May 21 23:31:45 localhost NetworkManager: <info>  SWITCH: found better connection 'wlan0/Guermantes' than current connection 'wlan0/Guermantes'.  same_ssid=1, have_link=0 
>May 21 23:31:45 localhost NetworkManager: <info>  Will activate connection 'wlan0/Guermantes'. 
>May 21 23:31:45 localhost NetworkManager: <info>  Device wlan0 activation scheduled... 
>May 21 23:31:45 localhost NetworkManager: <info>  Deactivating device wlan0. 
>May 21 23:31:45 localhost dhclient: wmaster0: unknown hardware address type 801
>May 21 23:31:45 localhost dhclient: wmaster0: unknown hardware address type 801
>May 21 23:31:45 localhost dhclient: DHCPRELEASE on wlan0 to 192.168.1.254 port 67
>May 21 23:31:46 localhost wpa_supplicant[3823]: CTRL-EVENT-TERMINATING - signal 15 received 
>May 21 23:31:46 localhost avahi-daemon[2808]: Withdrawing address record for 192.168.1.64 on wlan0.
>May 21 23:31:46 localhost avahi-daemon[2808]: Leaving mDNS multicast group on interface wlan0.IPv4 with address 192.168.1.64.
>May 21 23:31:46 localhost avahi-daemon[2808]: Interface wlan0.IPv4 no longer relevant for mDNS.
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) started... 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 1 of 5 (Device Prepare) scheduled... 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 1 of 5 (Device Prepare) started... 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 2 of 5 (Device Configure) scheduled... 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 1 of 5 (Device Prepare) complete. 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 2 of 5 (Device Configure) starting... 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0/wireless): access point 'Guermantes' is encrypted, but NO valid key exists.  New key needed. 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) New wireless user key requested for network 'Guermantes'. 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 2 of 5 (Device Configure) complete. 
>May 21 23:31:46 localhost NetworkManager: <info>  DHCP daemon state is now 14 (normal exit) for interface wlan0 
>May 21 23:31:46 localhost NetworkManager: <info>  DHCP daemon state is now 11 (unknown) for interface wlan0 
>May 21 23:31:46 localhost NetworkManager: <info>  DHCP daemon state is now 14 (normal exit) for interface wlan0 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) New wireless user key for network 'Guermantes' received. 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 1 of 5 (Device Prepare) scheduled... 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 1 of 5 (Device Prepare) started... 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 2 of 5 (Device Configure) scheduled... 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 1 of 5 (Device Prepare) complete. 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 2 of 5 (Device Configure) starting... 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0/wireless): access point 'Guermantes' is encrypted, and a key exists.  No new key needed. 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: sending command 'INTERFACE_ADD wlan0		wext	/var/run/wpa_supplicant	' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: response was 'OK' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: sending command 'AP_SCAN 1' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: response was 'OK' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: sending command 'ADD_NETWORK' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: response was '0' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: sending command 'SET_NETWORK 0 ssid 477565726d616e746573' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: response was 'OK' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: sending command 'SET_NETWORK 0 proto WPA' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: response was 'OK' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: sending command 'SET_NETWORK 0 key_mgmt WPA-PSK' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: response was 'OK' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: sending command 'SET_NETWORK 0 psk <key>' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: response was 'OK' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: sending command 'ENABLE_NETWORK 0' 
>May 21 23:31:46 localhost NetworkManager: <info>  SUP: response was 'OK' 
>May 21 23:31:46 localhost NetworkManager: <info>  Activation (wlan0) Stage 2 of 5 (Device Configure) complete. 
>May 21 23:31:46 localhost wpa_supplicant[4035]: Trying to associate with 00:14:7f:69:12:4e (SSID='Guermantes' freq=2452 MHz) 
>May 21 23:31:46 localhost kernel: iwl3945: REPLY_ADD_STA failed
>May 21 23:31:46 localhost wpa_supplicant[4035]: Associated with 00:14:7f:69:12:4e 
>May 21 23:31:47 localhost kernel: ADDRCONF(NETDEV_CHANGE): wlan0: link becomes ready
>May 21 23:31:51 localhost wpa_supplicant[4035]: Failed to initiate AP scan. 
>May 21 23:31:51 localhost kernel: iwl3945: Microcode SW error detected.  Restarting 0x82000000.
>May 21 23:31:51 localhost kernel: iwl3945: Error Reply type 0x0000003A cmd RXON_ASSOC (0x11) seq 0x04FE info 0x00000000
>May 21 23:31:51 localhost kernel: iwl3945: Error setting RXON_ASSOC configuration (-5).
>May 21 23:31:51 localhost kernel: iwl3945: Can't stop Rx DMA.
>May 21 23:31:55 localhost NetworkManager: <info>  Old device 'wlan0' activating, won't change. 
>May 21 23:31:56 localhost wpa_supplicant[4035]: Authentication with 00:14:7f:69:12:4e timed out. 
>May 21 23:31:56 localhost wpa_supplicant[4035]: Failed to initiate AP scan. 
>May 21 23:31:56 localhost wpa_supplicant[4035]: CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys 
>May 21 23:32:04 localhost NetworkManager: <info>  Activation (wlan0/wireless): disconnected during association, asking for new key. 
>May 21 23:32:04 localhost NetworkManager: <info>  Activation (wlan0) New wireless user key requested for network 'Guermantes'. 
>May 21 23:32:04 localhost wpa_supplicant[4035]: Failed to initiate AP scan. 
>May 21 23:32:12 localhost wpa_supplicant[4035]: Failed to initiate AP scan. 
>May 21 23:32:19 localhost NetworkManager: <info>  Activation (wlan0) New wireless user key for network 'Guermantes' received. 
>May 21 23:32:19 localhost NetworkManager: <info>  Activation (wlan0) Stage 1 of 5 (Device Prepare) scheduled... 
>May 21 23:32:19 localhost NetworkManager: <info>  Activation (wlan0) Stage 1 of 5 (Device Prepare) started... 
>May 21 23:32:19 localhost NetworkManager: <info>  Activation (wlan0) Stage 2 of 5 (Device Configure) scheduled... 
>May 21 23:32:19 localhost NetworkManager: <info>  Activation (wlan0) Stage 1 of 5 (Device Prepare) complete. 
>May 21 23:32:19 localhost NetworkManager: <info>  Activation (wlan0) Stage 2 of 5 (Device Configure) starting...

Actions: View

Attachments on bug 236828: 152850 | 154877 | 155135 | 155280