connecting to any wifi fails (no error message)

Bug #1092959 reported by Jiří Procházka
6
This bug affects 1 person
Affects Status Importance Assigned to Milestone
wicd
New
Undecided
Unassigned

Bug Description

Connecting to any wifi fails (no error message) - but not if I specify static IP. I use wicd-gtk, the progress bar just disappears the list of APs comes back without being connected or getting an error message.
Not sure it is Wicd problem, I'd be glad of any help.

software versions:
dhcpcd 5.6.3
wicd 1.7.2.4 (bzr-r768)
iwconfig Wireless-Tools version 29
wpa_supplicant v1.0

Distro: Archlinux
This is the /var/log/everything.log of the attempt to connect:
Dec 21 18:23:02 hakunin dhcpcd[8701]: sending commands to master dhcpcd process
Dec 21 18:23:02 hakunin dhcpcd[757]: control command: /usr/sbin/dhcpcd -k wlan0
Dec 21 18:23:02 hakunin dhcpcd[757]: wlan0: removing interface
Dec 21 18:23:02 hakunin kernel: [1030674.135654] ADDRCONF(NETDEV_UP): wlan0: link is not ready
Dec 21 18:23:02 hakunin dhcpcd[8714]: sending commands to master dhcpcd process
Dec 21 18:23:02 hakunin dhcpcd[757]: wlan0: waiting for carrier
Dec 21 18:23:02 hakunin dhcpcd[757]: control command: /usr/sbin/dhcpcd -k eth0
Dec 21 18:23:02 hakunin dhcpcd[757]: eth0: removing interface
Dec 21 18:23:02 hakunin kernel: [1030674.746370] e1000e 0000:00:19.0: irq 47 for MSI/MSI-X
Dec 21 18:23:02 hakunin kernel: [1030674.847193] e1000e 0000:00:19.0: irq 47 for MSI/MSI-X
Dec 21 18:23:02 hakunin kernel: [1030674.847780] ADDRCONF(NETDEV_UP): eth0: link is not ready
Dec 21 18:23:02 hakunin dhcpcd[8748]: sending commands to master dhcpcd process
Dec 21 18:23:03 hakunin dhcpcd[757]: eth0: waiting for carrier
Dec 21 18:23:03 hakunin dhcpcd[757]: control command: /usr/sbin/dhcpcd -k wlan0
Dec 21 18:23:03 hakunin dhcpcd[757]: wlan0: removing interface
Dec 21 18:23:03 hakunin kernel: [1030674.955200] ADDRCONF(NETDEV_UP): wlan0: link is not ready
Dec 21 18:23:03 hakunin dhcpcd[757]: wlan0: waiting for carrier
Dec 21 18:23:05 hakunin kernel: [1030677.124757] wlan0: authenticate with 80:b6:86:34:b2:b8
Dec 21 18:23:05 hakunin kernel: [1030677.124795] wlan0: send auth to 80:b6:86:34:b2:b8 (try 1/3)
Dec 21 18:23:05 hakunin kernel: [1030677.126661] wlan0: authenticated
Dec 21 18:23:05 hakunin kernel: [1030677.127369] wlan0: associating with AP with corrupt beacon
Dec 21 18:23:05 hakunin kernel: [1030677.128316] wlan0: associate with 80:b6:86:34:b2:b8 (try 1/3)
Dec 21 18:23:05 hakunin kernel: [1030677.131071] wlan0: RX AssocResp from 80:b6:86:34:b2:b8 (capab=0x411 status=0 aid=1)
Dec 21 18:23:05 hakunin kernel: [1030677.131079] wlan0: associated
Dec 21 18:23:05 hakunin kernel: [1030677.133430] ADDRCONF(NETDEV_CHANGE): wlan0: link becomes ready
Dec 21 18:23:05 hakunin dhcpcd[757]: wlan0: carrier acquired
Dec 21 18:23:05 hakunin dhcpcd[757]: wlan0: sending IPv6 Router Solicitation
Dec 21 18:23:05 hakunin dhcpcd[757]: wlan0: sendmsg: Cannot assign requested address
Dec 21 18:23:05 hakunin dhcpcd[757]: wlan0: broadcasting for a lease
Dec 21 18:23:05 hakunin dhcpcd[757]: wlan0: offered 10.0.0.144 from 10.0.0.138
Dec 21 18:23:05 hakunin dhcpcd[757]: wlan0: acknowledged 10.0.0.144 from 10.0.0.138
Dec 21 18:23:05 hakunin dhcpcd[757]: wlan0: checking for 10.0.0.144
Dec 21 18:23:06 hakunin dhcpcd[8802]: sending commands to master dhcpcd process
Dec 21 18:23:06 hakunin dhcpcd[757]: control command: /usr/sbin/dhcpcd -h hakunin --noipv4ll wlan0
Dec 21 18:23:06 hakunin dhcpcd[8808]: sending commands to master dhcpcd process
Dec 21 18:23:06 hakunin dhcpcd[757]: control command: /usr/sbin/dhcpcd -k wlan0
Dec 21 18:23:06 hakunin dhcpcd[757]: wlan0: removing interface
Dec 21 18:23:06 hakunin kernel: [1030678.432491] wlan0: deauthenticating from 80:b6:86:34:b2:b8 by local choice (reason=3)
Dec 21 18:23:06 hakunin kernel: [1030678.434145] cfg80211: Calling CRDA to update world regulatory domain
Dec 21 18:23:06 hakunin kernel: [1030678.503451] ADDRCONF(NETDEV_UP): wlan0: link is not ready
Dec 21 18:23:06 hakunin dhcpcd[8823]: sending commands to master dhcpcd process
Dec 21 18:23:06 hakunin dhcpcd[757]: wlan0: waiting for carrier
Dec 21 18:23:06 hakunin dhcpcd[757]: control command: /usr/sbin/dhcpcd -k eth0
Dec 21 18:23:06 hakunin dhcpcd[757]: eth0: removing interface
Dec 21 18:23:07 hakunin kernel: [1030679.129389] e1000e 0000:00:19.0: irq 47 for MSI/MSI-X
Dec 21 18:23:07 hakunin kernel: [1030679.230137] e1000e 0000:00:19.0: irq 47 for MSI/MSI-X
Dec 21 18:23:07 hakunin kernel: [1030679.230428] ADDRCONF(NETDEV_UP): eth0: link is not ready
Dec 21 18:23:07 hakunin dhcpcd[757]: eth0: waiting for carrier

Revision history for this message
David Paleino (dpaleino) wrote :

Please enable debugging mode, and attach /var/log/wicd/wicd.log.

Kindly,
David

Revision history for this message
Jiří Procházka (ojirio) wrote :

This is the log:
2012/12/21 18:23:02 :: Connecting to wireless network XYZ
2012/12/21 18:23:02 :: Putting interface down
2012/12/21 18:23:02 :: Releasing DHCP leases...
2012/12/21 18:23:03 :: Setting false IP...
2012/12/21 18:23:03 :: Stopping wpa_supplicant
2012/12/21 18:23:03 :: Flushing the routing table...
2012/12/21 18:23:03 :: Putting interface up...
2012/12/21 18:23:05 :: Attempting to authenticate...
2012/12/21 18:23:06 :: Running DHCP with hostname hakunin
2012/12/21 18:23:06 :: dhcpcd[8802]: sending commands to master dhcpcd process
2012/12/21 18:23:06 ::
2012/12/21 18:23:06 ::
2012/12/21 18:23:06 :: DHCP connection successful
2012/12/21 18:23:06 :: not verifying
2012/12/21 18:23:06 :: Connecting thread exiting.
2012/12/21 18:23:06 :: Sending connection attempt result success

Revision history for this message
David Paleino (dpaleino) wrote :

You haven't enabled debugging mode, please do and re-post the log.

Thanks,
David

Revision history for this message
Jiří Procházka (ojirio) wrote :
Download full text (3.4 KiB)

Ah sorry, here is a log with the debug enabled:
2012/12/22 17:43:02 :: Connecting to wireless network XYZ
2012/12/22 17:43:02 :: iwconfig wlan0
2012/12/22 17:43:02 :: /usr/sbin/dhcpcd -k wlan0
2012/12/22 17:43:02 :: ifconfig wlan0 0.0.0.0
2012/12/22 17:43:02 :: /usr/sbin/ip route flush dev wlan0
2012/12/22 17:43:02 :: ifconfig wlan0 down
2012/12/22 17:43:02 :: ifconfig wlan0 up
2012/12/22 17:43:02 :: wpa_cli -i wlan0 terminate
2012/12/22 17:43:02 :: /usr/sbin/dhcpcd -k eth0
2012/12/22 17:43:02 :: ifconfig eth0 0.0.0.0
2012/12/22 17:43:02 :: /usr/sbin/ip route flush dev eth0
2012/12/22 17:43:02 :: ifconfig eth0 down
2012/12/22 17:43:03 :: ifconfig eth0 up
2012/12/22 17:43:03 :: wpa_cli -i eth0 terminate
2012/12/22 17:43:03 :: Putting interface down
2012/12/22 17:43:03 :: ifconfig wlan0 down
2012/12/22 17:43:03 :: Releasing DHCP leases...
2012/12/22 17:43:03 :: /usr/sbin/dhcpcd -k wlan0
2012/12/22 17:43:03 :: Setting false IP...
2012/12/22 17:43:03 :: ifconfig wlan0 0.0.0.0
2012/12/22 17:43:03 :: Stopping wpa_supplicant
2012/12/22 17:43:03 :: wpa_cli -i wlan0 terminate
2012/12/22 17:43:03 :: Flushing the routing table...
2012/12/22 17:43:03 :: /usr/sbin/ip route flush dev wlan0
2012/12/22 17:43:03 :: iwconfig wlan0 mode managed
2012/12/22 17:43:03 :: Putting interface up...
2012/12/22 17:43:03 :: ifconfig wlan0 up
2012/12/22 17:43:05 :: enctype is wpa-psk
2012/12/22 17:43:05 :: Attempting to authenticate...
2012/12/22 17:43:05 :: ['wpa_supplicant', '-B', '-i', 'wlan0', '-c', '/var/lib/wicd/configurations/80b68634b2b8', '-Dwext']
2012/12/22 17:43:06 :: ['iwconfig', 'wlan0', 'essid', '--', 'XYZ']
2012/12/22 17:43:06 :: iwconfig wlan0 channel 1
2012/12/22 17:43:06 :: iwconfig wlan0 ap 80:B6:86:35:B2:B7
2012/12/22 17:43:06 :: WPA_CLI RESULT IS DISCONNECTED
2012/12/22 17:43:07 :: WPA_CLI RESULT IS COMPLETED
2012/12/22 17:43:07 :: Running DHCP with hostname hakunin
2012/12/22 17:43:07 :: /usr/sbin/dhcpcd -h hakunin --noipv4ll wlan0
2012/12/22 17:43:07 :: dhcpcd[8223]: sending commands to master dhcpcd process
2012/12/22 17:43:07 ::
2012/12/22 17:43:07 ::
2012/12/22 17:43:07 :: DHCP connection successful
2012/12/22 17:43:07 :: not verifying
2012/12/22 17:43:07 :: Connecting thread exiting.
2012/12/22 17:43:07 :: ifconfig wlan0
2012/12/22 17:43:07 :: IP Address is: None
2012/12/22 17:43:07 :: Sending connection attempt result success
2012/12/22 17:43:07 :: ifconfig eth0
2012/12/22 17:43:07 :: Forced disconnect on
2012/12/22 17:43:07 :: iwconfig wlan0
2012/12/22 17:43:07 :: /usr/sbin/dhcpcd -k wlan0
2012/12/22 17:43:07 :: ifconfig wlan0 0.0.0.0
2012/12/22 17:43:07 :: /usr/sbin/ip route flush dev wlan0
2012/12/22 17:43:07 :: ifconfig wlan0 down
2012/12/22 17:43:07 :: ifconfig wlan0 up
2012/12/22 17:43:07 :: wpa_cli -i wlan0 terminate
2012/12/22 17:43:07 :: /usr/sbin/dhcpcd -k eth0
2012/12/22 17:43:07 :: ifconfig eth0 0.0.0.0
2012/12/22 17:43:07 :: /usr/sbin/ip route flush dev eth0
2012/12/22 17:43:07 :: ifconfig eth0 down
2012/12/22 17:43:07 :: ifconfig eth0 up
2012/12/22 17:43:08 :: wpa_cli -i eth0 terminate
2012/12/22 17:43:09 :: ifconfig wlan0
2012/12/22 17:43:09 :: ifconfig eth0
2012/12/22 17:43:11 :: ifconfig wlan0
2012/12/22 17:43:12 :: ifc...

Read more...

Revision history for this message
Jiří Procházka (ojirio) wrote :

I must say NetworkManager doesn't have this problem, so I think that proves it is a problem specific to Wicd

To post a comment you must log in.
This report contains Public information  
Everyone can see this information.

Other bug subscribers

Remote bug watches

Bug watches keep track of this bug in other bug trackers.