Re: NM Connection Problem



Jim,

I don't think this is a NM problem. Caveat: I could be wrong about that.

On my box, my wireless card gets configured as wlan0, not eth1. While this isn't necessarily a problem, it could be that you have your wireless device configured using the standard wireless tools.

Note: If your driver is automatically being registered as eth1 (without modprobe aliasing or being configured via wireless-tools), then this may not help at all:

I would run system-config-network-gui (as root) and clean out any devices configured to use eth1 from your configuration. (If you aren't comfortable with that, then just create a new profile that only has the eth0 device selected and only use that profile with NM.) Also, edit /etc/modprobe.conf and comment-out any aliases for eth1 OR wlan0. Finally, reboot and see if this helps. (The reboot may be needed to cleanly reload your wireless driver.)

This will ensure that the standard wireless tools do not try to configure your wireless device before NM gets a chance to configure it.

Let me know if this helps (or if there are no configured eth1 devices or modprobe aliases to comment out)...

JLP

Jim Webb wrote:
Joshua,
Thanks for the reply. I have included the pertinent log info below...but I don't see anything wrong.

Thanks again,
Jim
*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*
Oct 11 05:44:21 NetworkManager: <information> User Switch: /org/freedesktop/NetworkManager/Devices/eth1 / stayonline Oct 11 05:44:21 NetworkManager: <information> Deactivating device eth1.
Oct 11 05:44:21  dhclient: DHCPRELEASE on eth1 to 172.16.1.1 port 67
Oct 11 05:44:21 named[1516]: D-BUS: dhclient for interface eth1 released lease - removing forwarders. Oct 11 05:44:22 avahi-daemon[1986]: Interface eth1.IPv4 no longer relevant for mDNS. Oct 11 05:44:22 avahi-daemon[1986]: Leaving mDNS multicast group on interface eth1.IPv4 with address 172.16.1.138. Oct 11 05:44:22 avahi-daemon[1986]: Withdrawing address record for 172.16.1.138 on eth1. Oct 11 05:44:22 NetworkManager: <information> Device eth1 activation scheduled... Oct 11 05:44:22 NetworkManager: <information> Activation (eth1) started...Oct 11 05:44:22 NetworkManager: <information> Activation (eth1) Stage 1 of 5 (Device Prepare) scheduled... Oct 11 05:44:22 NetworkManager: <information> Activation (eth1) Stage 1 of 5 (Device Prepare) started... Oct 11 05:44:22 NetworkManager: <information> Activation (eth1) Stage 2 of 5 (Device Configure) scheduled... Oct 11 05:44:22 NetworkManager: <information> Activation (eth1) Stage 1 of 5 (Device Prepare) complete. Oct 11 05:44:22 NetworkManager: <information> Activation (eth1) Stage 2 of 5 (Device Configure) starting... Oct 11 05:44:22 NetworkManager: <information> Activation (eth1/wireless): access point 'stayonline' is unencrypted, no key needed.
Oct 11 05:44:22  kernel: ADDRCONF(NETDEV_UP): eth1: link is not ready
Oct 11 05:44:22 NetworkManager: <information> SUP: sending command 'INTERFACE_ADD eth1 wext /var/run/wpa_supplicant '
Oct 11 05:44:22  NetworkManager: <information>      SUP: response was 'OK'
Oct 11 05:44:22 NetworkManager: <information> SUP: sending command 'AP_SCAN 1'
Oct 11 05:44:22  NetworkManager: <information>      SUP: response was 'OK'
Oct 11 05:44:22 NetworkManager: <information> SUP: sending command 'ADD_NETWORK'
Oct 11 05:44:22  NetworkManager: <information>      SUP: response was '0'
Oct 11 05:44:22 NetworkManager: <information> SUP: sending command 'SET_NETWORK 0 ssid 737461796f6e6c696e65'
Oct 11 05:44:22  NetworkManager: <information>      SUP: response was 'OK'
Oct 11 05:44:22 NetworkManager: <information> SUP: sending command 'SET_NETWORK 0 key_mgmt NONE'
Oct 11 05:44:22  NetworkManager: <information>      SUP: response was 'OK'
Oct 11 05:44:22 NetworkManager: <information> SUP: sending command 'ENABLE_NETWORK 0'
Oct 11 05:44:22  NetworkManager: <information>      SUP: response was 'OK'
Oct 11 05:44:22 NetworkManager: <information> Activation (eth1) Stage 2 of 5 (Device Configure) complete. Oct 11 05:44:22 NetworkManager: <information> Activation (eth1/wireless) Stage 2 of 5 (Device Configure) successful. Connected to access point 'stayonline'. Oct 11 05:44:22 NetworkManager: <information> Activation (eth1) Stage 3 of 5 (IP Configure Start) scheduled. Oct 11 05:44:22 NetworkManager: <information> Activation (eth1) Stage 3 of 5 (IP Configure Start) started...
Oct 11 05:44:23  kernel: ADDRCONF(NETDEV_CHANGE): eth1: link becomes ready
Oct 11 05:44:23 NetworkManager: <information> Activation (eth1) Beginning DHCP transaction. Oct 11 05:44:23 NetworkManager: <information> DHCP daemon state is now 12 (successfully started) for interface eth1 Oct 11 05:44:23 NetworkManager: <information> Activation (eth1) Stage 3 of 5 (IP Configure Start) complete. Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): Global control interface '/var/run/wpa_supplicant-global' Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): RX global ctrl_iface - hexdump_ascii(len=49): Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): 49 4e 54 45 52 46 41 43 45 5f 41 44 44 20 65 74 INTERFACE_ADD et Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): 68 31 09 09 77 65 78 74 09 2f 76 61 72 2f 72 75 h1__wext_/var/ru Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): 6e 2f 77 70 61 5f 73 75 70 70 6c 69 63 61 6e 74 n/wpa_supplicant Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): 09 _ Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): CTRL_IFACE GLOBAL INTERFACE_ADD 'eth1 wext /var/run/wpa_supplicant' Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): Initializing interface 'eth1' conf 'N/A' driver 'wext' ctrl_interface '/var/run/wpa_supplicant' Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): Initializing interface (2) 'eth1' Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): EAPOL: SUPP_PAE entering state DISCONNECTED Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): EAPOL: KEY_RX entering state NO_KEY_RECEIVE Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): EAPOL: SUPP_BE entering state INITIALIZE Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): EAP: EAP entering state DISABLED Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): EAPOL: External notification - portEnabled=0 Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): EAPOL: External notification - portValid=0 Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): SIOCGIWRANGE: WE(compiled)=20 WE(source)=18 enc_capa=0xf Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): capabilities: key_mgmt 0xf enc 0xf Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): Own MAC address: 00:13:e8:04:38:d9 Oct 11 05:44:23 dhclient: DHCPDISCOVER on eth1 to 255.255.255.255 port 67 interval 4 Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): wpa_driver_wext_set_wpa Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): =0 key_idx=0 set_tx=0 seq_len=0 key_len=0 Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): wpa_driver_wext_set_key: alg=0 key_idx=1 set_tx=0 seq_len=0 key_len=0 Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): wpa_driver_wext_set_key: alg=0 key_idx=2 set_tx=0 seq_len=0 key_len=0 Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): wpa_driver_wext_set_key: alg=0 key_idx=3 set_tx=0 seq_len=0 key_len=0 Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): wpa_driver_wext_set_countermeasures Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): wpa_driver_wext_set_drop_unencrypted Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): Setting scan request: 0 sec 100000 usec Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): Using existing control interface directory. Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): Added interface eth1 Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): Wireless event: cmd=0x8b06 len=8 Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): RX ctrl_iface - hexdump_ascii(len=9): Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): 41 50 5f 53 43 41 4e 20 31 AP_SCAN 1 Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): RX ctrl_iface - hexdump_ascii(len=11): Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): 41 44 44 5f 4e 45 54 57 4f 52 4b ADD_NETWORK Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): CTRL_IFACE: ADD_NETWORK Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): RX ctrl_iface - hexdump_ascii(len=39): Oct 11 05:44:23 NetworkManager: <information> wpa_supplicant(9484): 53 45 54 5f 4e 45 54 57 4f 52 4b 20 30 20 73 73 SET_NETWORK 0 ss Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): 69 64 20 37 33 37 34 36 31 37 39 36 66 36 65 36 id 737461796f6e6 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): 63 36 39 36 65 36 35 c696e65 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): 6c696e65' Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): ssid - hexdump_ascii(len=10): Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): 73 74 61 79 6f 6e 6c 69 6e 65 stayonline Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): RX ctrl_iface - hexdump_ascii(len=27): Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): 53 45 54 5f 4e 45 54 57 4f 52 4b 20 30 20 6b 65 SET_NETWORK 0 ke Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): 79 5f 6d 67 6d 74 20 4e 4f 4e 45 y_mgmt NONE Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): CTRL_IFACE: SET_NETWORK id=0 name='key_mgmt' value='NONE' Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): key_mgmt: 0x4 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): RX ctrl_iface - hexdump_ascii(len=16): Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): 45 4e 41 42 4c 45 5f 4e 45 54 57 4f 52 4b 20 30 ENABLE_NETWORK 0 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): CTRL_IFACE: ENABLE_NETWORK id=0 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): Setting scan request: 0 sec 0 usec Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): State: DISCONNECTED -> SCANNING Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): Starting AP scan (broadcast SSID) Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): RX ctrl_iface - hexdump_ascii(len=6): Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): 41 54 54 41 43 48 ATTACH Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): CTRL_IFACE monitor attached - hexdump(len=42): 2f 76 61 72 2f 72 75 6e 2f 4e 65 74 77 6f 72 6b 4d 61 6e 61 67 65 72 2f 77 70 61 5f 63 74 72 6c 5f 32 30 37 34 2d 34 00 00 00 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): Wireless event: cmd=0x8b15 len=20 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): Wireless event: new AP: 00:0f:f8:58:18:56 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): State: SCANNING -> ASSOCIATED Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): : BSSID=00:0f:f8:58:18:56 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): No keys have been configured - skip key clearing Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): Network configuration found for the current AP Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): WPA: clearing AP WPA IE Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): WPA: clearing AP RSN IE Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): WPA: clearing own WPA/RSN IE Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): EAPOL: External notification - portControl=ForceAuthorized Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): Associated with 00:0f:f8:58:18:56 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): CTRL_IFACE monitor send - hexdump(len=42): 2f 76 61 72 2f 72 75 6e 2f 4e 65 74 77 6f 72 6b 4d 61 6e 61 67 65 72 2f 77 70 61 5f 63 74 72 6c 5f 32 30 37 34 2d 34 00 00 00 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): WPA: Association event - clear replay counter Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): EAPOL: External notification - portEnabled=0 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): EAPOL: External notification - portValid=0 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): EAPOL: External notification - portEnabled=1 Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): EAPOL: SUPP_PAE entering state S_FORCE_AUTH Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): EAPOL: SUPP_BE entering state IDLE Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): Cancelling authentication timeout Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): State: ASSOCIATED -> COMPLETED Oct 11 05:44:24 NetworkManager: <information> wpa_supplicant(9484): CTRL-EVENT-CONNECTED - Connection to 00:0f:f8:58:18:56 completed (auth) Oct 11 05:44:23 NetworkManager: <information> DHCP daemon state is now 1 (starting) for interface eth1
Oct 11 05:44:25  NetworkManager: <information>      wpa_supplicant(9484): 0
Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): M_NEWLINK, IFLA_IFNAME: Interface 'eth1' added Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): Scan timeout - try to get results Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): Received 3890 bytes of scan results (21 BSSes) Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): Scan results: 21 Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): Selecting BSS from priority group 0 Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): 0: 00:18:3f:9f:39:19 ssid='2WIRE223' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): 1: 00:14:95:ec:08:01 ssid='2WIRE730' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): 2: 00:0d:72:90:cb:99 ssid='<hidden>' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): 3: 00:90:4b:e2:96:d5 ssid='wireless' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): 4: 00:12:88:ba:65:09 ssid='2WIRE437' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:25 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 5: 00:14:95:1e:89:09 ssid='2WIRE787' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 6: 00:14:6c:d7:35:38 ssid='piper69' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 7: 00:16:b6:a7:0e:a5 ssid='<hidden>' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): =0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 9: 00:12:88:8d:11:81 ssid='2WIRE777' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 10: 00:14:95:1f:cc:01 ssid='2WIRE096' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 11: 00:11:95:41:46:39 ssid='123456' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 12: 00:0f:b5:a3:5a:76 ssid='NETGEAR' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 13: 00:14:6c:42:d4:a8 ssid='CherMit' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 14: 00:d0:9e:c9:77:d1 ssid='DragonBallZ' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 15: 00:0c:41:3d:0c:7e ssid='AlwaysOffLineW' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 16: 00:30:bd:c1:ff:d8 ssid='sumit' wpa_ie_len=0 rsn_ie_len=0 caps=0x11 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 17: 00:13:10:72:cb:85 ssid='linksys' wpa_ie_len=0 rsn_ie_len=0 caps=0x1 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 18: 00:09:5b:f8:16:7d ssid='6x7world' wpa_ie_len=0 rsn_ie_len=0 caps=0x1 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): :18:56 ssid='stayonline' wpa_ie_len=0 rsn_ie_len=0 caps=0x1 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): 20: 00:0f:f8:58:12:4e ssid='stayonline' wpa_ie_len=0 rsn_ie_len=0 caps=0x1 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): skip - no WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): selected non-WPA AP 00:0f:f8:58:18:56 ssid='stayonline' Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Trying to associate with 00:0f:f8:58:18:56 (SSID='stayonline' freq=0 MHz) Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): CTRL_IFACE monitor send - hexdump(len=42): 2f 76 61 72 2f 72 75 6e 2f 4e 65 74 77 6f 72 6b 4d 61 6e 61 67 65 72 2f 77 70 61 5f 63 74 72 6c 5f 32 30 37 34 2d 34 00 00 00 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Cancelling scan request Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): WPA: clearing own WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Automatic auth_alg selection: 0x1 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): WPA: clearing AP WPA IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): WPA: clearing AP RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): WPA: clearing own WPA/RSN IE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): No keys have been configured - skip key clearing Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): wpa_driver_wext_set_drop_unencrypted Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): State: COMPLETED -> ASSOCIATING Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): wpa_driver_wext_associate Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Setting authentication timeout: 15 sec 0 usec Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): EAPOL: External notification - portControl=ForceAuthorized Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Wireless event: cmd=0x8b06 len=8 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): RTM_NEWLINK, IFLA_IFNAME: Interface 'eth1' added Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Wireless event: cmd=0x8b15 len=20 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): event: new AP: 00:00:00:00:00:00 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Added BSSID 00:00:00:00:00:00 into blacklist Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): State: ASSOCIATING -> DISCONNECTED Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): EAPOL: External notification - portEnabled=0 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): EAPOL: SUPP_PAE entering state DISCONNECTED Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): EAPOL: SUPP_BE entering state INITIALIZE Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): EAPOL: External notification - portValid=0 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): CTRL-EVENT-DISCONNECTED - Disconnect event - remove keys Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): CTRL_IFACE monitor send - hexdump(len=42): 2f 76 61 72 2f 72 75 6e 2f 4e 65 74 77 6f 72 6b 4d 61 6e 61 67 65 72 2f 77 70 61 5f 63 74 72 6c 5f 32 30 37 34 2d 34 00 00 00 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Wireless event: cmd=0x8b1a len=19 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Wireless event: cmd=0x8b15 len=20 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Wireless event: new AP: 00:0f:f8:58:18:56 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): State: DISCONNECTED -> ASSOCIATED Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Associated to a new BSS: BSSID=00:0f:f8:58:18:56 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): Associated with 00:0f:f8:58:18:56 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): CTRL_IFACE monitor send - hexdump(len=42): 2f 76 61 72 2f 72 75 6e 2f 4e 65 74 77 6f 72 6b 4d 61 6e 61 67 65 72 2f 77 70 61 5f 63 74 72 6c 5f 32 30 37 34 2d 34 00 00 00 Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): WPA: Association event - clear replay counter Oct 11 05:44:26 NetworkManager: <information> wpa_supplicant(9484): EAPOL: External notification - portEnabled=0 Oct 11 05:44:27 dhclient: DHCPDISCOVER on eth1 to 255.255.255.255 port 67 interval 11
Oct 11 05:44:28  dhclient: DHCPOFFER from 172.16.1.1
Oct 11 05:44:28  dhclient: DHCPREQUEST on eth1 to 255.255.255.255 port 67
Oct 11 05:44:28  dhclient: DHCPACK from 172.16.1.1
Oct 11 05:44:28 dhclient: bound to 172.16.1.138 -- renewal in 16802 seconds. Oct 11 05:44:28 NetworkManager: <information> DHCP daemon state is now 2 (bound) for interface eth1 Oct 11 05:44:28 NetworkManager: <information> Activation (eth1) Stage 4 of 5 (IP Configure Get) scheduled... Oct 11 05:44:28 NetworkManager: <information> Activation (eth1) Stage 4 of 5 (IP Configure Get) started... Oct 11 05:44:28 named[1516]: D-BUS: dhclient for interface eth1 acquired new lease - creating forwarders. Oct 11 05:44:28 dhcdbd: message_handler: message handler not found under /com/redhat/dhcp/eth1 for sub-path eth1.dbus.get.host_name Oct 11 05:44:28 dhcdbd: message_handler: message handler not found under /com/redhat/dhcp/eth1 for sub-path eth1.dbus.get.nis_domain Oct 11 05:44:28 dhcdbd: message_handler: message handler not found under /com/redhat/dhcp/eth1 for sub-path eth1.dbus.get.nis_servers Oct 11 05:44:28 NetworkManager: <information> Retrieved the following IP4 configuration from the DHCP daemon:
Oct 11 05:44:28  NetworkManager: <information>        address 172.16.1.138
Oct 11 05:44:28  NetworkManager: <information>        netmask 255.255.255.0
Oct 11 05:44:28  NetworkManager: <information>        broadcast 172.16.1.255
Oct 11 05:44:28  NetworkManager: <information>        gateway 172.16.1.1
Oct 11 05:44:28  NetworkManager: <information>        nameserver 172.16.1.1
Oct 11 05:44:28 NetworkManager: <information> domain name 'e-centre.net'Oct 11 05:44:28 NetworkManager: <information> Activation (eth1) Stage 5 of 5 (IP Configure Commit) scheduled... Oct 11 05:44:28 NetworkManager: <information> Activation (eth1) Stage 4 of 5 (IP Configure Get) complete. Oct 11 05:44:28 NetworkManager: <information> Activation (eth1) Stage 5 of 5 (IP Configure Commit) started... Oct 11 05:44:28 avahi-daemon[1986]: New relevant interface eth1.IPv4 for mDNS. Oct 11 05:44:28 avahi-daemon[1986]: Joining mDNS multicast group on interface eth1.IPv4 with address 172.16.1.138. Oct 11 05:44:28 avahi-daemon[1986]: Registering new address record for 172.16.1.138 on eth1. Oct 11 05:44:29 NetworkManager: <information> Activation (eth1) successful, device activated. Oct 11 05:44:29 NetworkManager: <information> Activation (eth1) Finish handler scheduled. Oct 11 05:44:29 NetworkManager: <information> Activation (eth1) Stage 5 of 5 (IP Configure Commit) complete.

*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*-*
----- Original Message ----
From: Joshua L. Phillips <jphillips7 ucmerced edu>
To: networkmanager-list gnome org
Sent: Tuesday, October 10, 2006 10:53:48 PM
Subject: Re: NM Connection Problem

Hey Jim,

NM uses a local caching nameserver (named) for DNS resolution, so your
setup looks correct... NM tells named about the DNS servers supplied by
the AP via D-BUS (messagebus). If named can't find an IP in the local
cache, it will contact the DNS servers provided by the AP.

However, there could be complications because of this. You should be
running the messagebus and named services for things to work properly.
You might want to check that both of these are running. On my machine (I
run FC5 also) NM will automatically start the named service before it
starts (if named was not already running.)

So, it sounds like you are having other problems... What is NM reporting
in your logs (/var/log/messages)?

JLP

Jim Webb wrote:
 > Hi...
 > I'm having a problem with NM-0.6.4-1 on FC5 on a ThinkPad T42
 > w/ipw2100.  I am able to connect to an AP and when I view the Active
> Connection Info I see all the appropriate info for a valid connection. > When I attempt to open my browser it eventially times out with a message
 > "the connection was reset while the page was loading..."  While
 > attempting to troubleshoot the problem I noticed that /etc/resolv.conf
 > contained the following:
 >
 > # generated by NetworkManager, do not edit!
 >
 > ; Use a local caching nameserver controlled ny NetworkManager
 >
 > search <my domain>
 >
 > nameserver 127.0.0.1
 >
 > But, the Active Connection Info shows a different IP address for the
 > Primary DNS, instead of LocalHost.
 >
 > Is the resolv.conf file being correctly constructed?  Or, is there a
 > place where this can be configured?
 >
 > Thanks for any assistance...
 > Jim
 >
 >
 > ------------------------------------------------------------------------
 >
 > _______________________________________________
 > NetworkManager-list mailing list
 > NetworkManager-list gnome org
 > http://mail.gnome.org/mailman/listinfo/networkmanager-list
_______________________________________________
NetworkManager-list mailing list
NetworkManager-list gnome org
http://mail.gnome.org/mailman/listinfo/networkmanager-list


------------------------------------------------------------------------

_______________________________________________
NetworkManager-list mailing list
NetworkManager-list gnome org
http://mail.gnome.org/mailman/listinfo/networkmanager-list



[Date Prev][Date Next]   [Thread Prev][Thread Next]   [Thread Index] [Date Index] [Author Index]