On Wed, 2009-03-18 at 13:00 -0400, Dan Williams wrote: > To track this down further, try the following: > > service NetworkManager stop > NM_SERIAL_DEBUG=1 /usr/sbin/NetworkManager --no-daemon > > then make the connection (or try anyway), and wait for failure. Then > copy the NM output and reply with it. That'll show exactly what > statement the modem is locking on.
OK, here's the scenario 1. boot system without GSM modem, login, kill NM service 2. start NM with debug options. 3. Insert GSM modem. NM detects it, tries to activate, fails. NOTE: NM applet menu has a single Mobile Broadband entry 5. Remove modem, wait a while, re-insert. NOTE: NM does not try to activate the modem this time. 6. Activate the modem from NM applet menu -- success. 7. kill NM, save output file 'serial-debug-1.txt'. 8. remove modem, repeat from #2 NOTE - this time its different, there are *two* entries in the menu, each saying "Mobile Broadband (Huawei Technologies E220 HSDPA Modem / E270 HSDPS/HSUPA Modem)". I attach the udevadm output in case that is interesting. 8. Click the 1st menu entry - no success. 9. Click the 2nd menu entry - success. 10. save output file 'serial-debug-2.txt'.
[r...@heron colinc]# NM_SERIAL_DEBUG=1 /usr/sbin/NetworkManager --no-daemon NetworkManager: <info> starting... -- Error received: File exists -- Original message: type=0x14 length=56 flags=<REQUEST,ACK,ATOMIC> sequence-nr=1237399108 pid=4198266 NetworkManager: <WARN> nm_generic_enable_loopback(): error -17 returned from rtnl_addr_add(): Sucess NetworkManager: <info> (eth0): new Ethernet device (driver: 'sis190') NetworkManager: <info> (eth0): exported as /org/freedesktop/Hal/devices/net_00_03_0d_90_44_e8 NetworkManager: <info> (eth0): device state change: 1 -> 2 NetworkManager: <info> (eth0): bringing up device. NetworkManager: <info> (eth0): preparing device. NetworkManager: <info> (eth0): deactivating device (reason: 2). NetworkManager: <info> (ttyUSB0): detected GSM modem via udev capabilities NetworkManager: <info> (ttyUSB0): new Modem device (driver: 'option') NetworkManager: <info> (ttyUSB0): exported as /org/freedesktop/Hal/devices/usb_device_12d1_1003_noserial_if0_serial_usb_0 NetworkManager: <info> (ttyUSB0): device state change: 1 -> 2 NetworkManager: <info> (ttyUSB0): deactivating device (reason: 2). NetworkManager: nm_system_device_flush_ip4_routes_with_iface: assertion `iface_idx >= 0' failed NetworkManager: nm_system_device_flush_ip4_addresses_with_iface: assertion `iface_idx >= 0' failed NetworkManager: <info> (ttyUSB0): device state change: 2 -> 3 NetworkManager: <info> Activation (ttyUSB0) starting connection '3 UK Broadband' NetworkManager: <info> (ttyUSB0): device state change: 3 -> 4 NetworkManager: <info> Activation (ttyUSB0) Stage 1 of 5 (Device Prepare) scheduled... NetworkManager: <info> Activation (ttyUSB0) Stage 1 of 5 (Device Prepare) started... NetworkManager: <debug> [1237399154.397917] nm_serial_device_open(): (ttyUSB0) opening device... NetworkManager: <info> Activation (ttyUSB0) Stage 1 of 5 (Device Prepare) complete. NetworkManager: <debug> [1237399154.518597] nm_serial_debug(): Sending: 'ATZ E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237399154.573359] nm_serial_debug(): Got: 'ATZ E0 V1 X4 &C1 +FCLASS' NetworkManager: <debug> [1237399154.574292] nm_serial_debug(): Got: 'ATZ E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237399154.613400] nm_serial_debug(): Got: 'ATZ E0 V1 X4 &C1 +FCLASS=0 OK ' NetworkManager: <debug> [1237399154.613906] nm_serial_debug(): Sending: 'AT+CPIN? ' NetworkManager: <WARN> check_pin_done(): PIN checking timed out NetworkManager: <info> (ttyUSB0): device state change: 4 -> 9 NetworkManager: <debug> [1237399158.334273] nm_serial_device_close(): Closing device 'ttyUSB0' NetworkManager: <info> Marking connection '3 UK Broadband' invalid. NetworkManager: <info> Activation (ttyUSB0) failed. NetworkManager: <info> (ttyUSB0): device state change: 9 -> 3 NetworkManager: <info> (ttyUSB0): deactivating device (reason: 0). NetworkManager: nm_system_device_flush_ip4_routes_with_iface: assertion `iface_idx >= 0' failed NetworkManager: nm_system_device_flush_ip4_addresses_with_iface: assertion `iface_idx >= 0' failed NetworkManager: <info> (ttyUSB0): now unmanaged NetworkManager: <info> (ttyUSB0): device state change: 3 -> 1 NetworkManager: <info> (ttyUSB0): cleaning up... NetworkManager: <info> (ttyUSB0): taking down device. NetworkManager: <info> (ttyUSB0): detected GSM modem via udev capabilities NetworkManager: <info> (ttyUSB0): new Modem device (driver: 'option') NetworkManager: <info> (ttyUSB0): exported as /org/freedesktop/Hal/devices/usb_device_12d1_1003_noserial_if0_serial_usb_0 NetworkManager: <info> (ttyUSB0): device state change: 1 -> 2 NetworkManager: <info> (ttyUSB0): deactivating device (reason: 2). NetworkManager: nm_system_device_flush_ip4_routes_with_iface: assertion `iface_idx >= 0' failed NetworkManager: nm_system_device_flush_ip4_addresses_with_iface: assertion `iface_idx >= 0' failed NetworkManager: <info> (ttyUSB0): device state change: 2 -> 3 NetworkManager: <info> Activation (ttyUSB0) starting connection '3 UK Broadband' NetworkManager: <info> (ttyUSB0): device state change: 3 -> 4 NetworkManager: <info> Activation (ttyUSB0) Stage 1 of 5 (Device Prepare) scheduled... NetworkManager: <info> Activation (ttyUSB0) Stage 1 of 5 (Device Prepare) started... NetworkManager: <debug> [1237399280.235421] nm_serial_device_open(): (ttyUSB0) opening device... NetworkManager: <info> Activation (ttyUSB0) Stage 1 of 5 (Device Prepare) complete. NetworkManager: <debug> [1237399280.356352] nm_serial_debug(): Sending: 'ATZ E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237399280.416212] nm_serial_debug(): Got: 'ATZ E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237399280.440156] nm_serial_debug(): Got: 'ATZ E0 V1 X4 &C1 +FCLASS=0 OK ' NetworkManager: <debug> [1237399280.442692] nm_serial_debug(): Sending: 'AT+CPIN? ' NetworkManager: <debug> [1237399280.460407] nm_serial_debug(): Got: ' +CPIN: READY OK ' NetworkManager: <debug> [1237399280.461038] nm_serial_debug(): Sending: 'ATZ E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237399280.539372] nm_serial_debug(): Got: ' OK ' NetworkManager: <info> (ttyUSB0): powering up... NetworkManager: <debug> [1237399280.539832] nm_serial_debug(): Sending: 'AT+CFUN=1 ' NetworkManager: <debug> [1237399280.561353] nm_serial_debug(): Got: ' OK ' NetworkManager: <debug> [1237399280.561622] nm_serial_debug(): Sending: 'AT+CGMM ' NetworkManager: <debug> [1237399280.582394] nm_serial_debug(): Got: ' E220 OK ' NetworkManager: <debug> [1237399280.582756] nm_serial_debug(): Sending: 'AT+CREG? ' NetworkManager: <debug> [1237399280.600352] nm_serial_debug(): Got: ' +CREG: 0,1 OK ' NetworkManager: <info> Registered on Home network NetworkManager: <debug> [1237399280.602477] nm_serial_debug(): Sending: 'AT+COPS? ' NetworkManager: <debug> [1237399280.621346] nm_serial_debug(): Got: ' +COPS: 0,0,"3 UK",2 OK ' NetworkManager: <info> Associated with network: +COPS: 0,0,"3 UK",2 NetworkManager: <debug> [1237399280.621491] nm_serial_debug(): Sending: 'ATDT*99# ' NetworkManager: <debug> [1237399280.644445] nm_serial_debug(): Got: ' CONNECT 3600000 ' NetworkManager: <info> Connected, Woo! NetworkManager: <info> Activation (ttyUSB0) Stage 2 of 5 (Device Configure) scheduled... NetworkManager: <info> Activation (ttyUSB0) Stage 2 of 5 (Device Configure) starting... NetworkManager: <info> (ttyUSB0): device state change: 4 -> 5 NetworkManager: <info> Starting pppd connection NetworkManager: <debug> [1237399280.679209] nm_ppp_manager_start(): Command line: /usr/sbin/pppd nodetach lock nodefaultroute ttyUSB0 noipdefault noauth usepeerdns lcp-echo-failure 0 lcp-echo-interval 0 ipparam /org/freedesktop/NetworkManager/PPP/0 plugin /usr/lib/pppd/2.4.4/nm-pppd-plugin.so NetworkManager: <debug> [1237399280.714473] nm_ppp_manager_start(): ppp started with pid 4211 NetworkManager: <info> Activation (ttyUSB0) Stage 2 of 5 (Device Configure) complete. Plugin /usr/lib/pppd/2.4.4/nm-pppd-plugin.so loaded. Using interface ppp0 Connect: ppp0 <--> /dev/ttyUSB0 NetworkManager: <info> (ttyUSB0): device state change: 5 -> 6 CHAP authentication succeeded CHAP authentication succeeded NetworkManager: <info> (ttyUSB0): device state change: 6 -> 7 Could not determine remote IP address: defaulting to 10.64.64.64 local IP address 92.40.77.239 remote IP address 10.64.64.64 primary DNS address 4.2.2.4 secondary DNS address 4.2.2.3 NetworkManager: <info> PPP manager(IP Config Get) reply received. NetworkManager: <info> Activation (ttyUSB0) Stage 4 of 5 (IP Configure Get) scheduled... NetworkManager: <info> Activation (ttyUSB0) Stage 4 of 5 (IP Configure Get) started... NetworkManager: <info> Activation (ttyUSB0) Stage 5 of 5 (IP Configure Commit) scheduled... NetworkManager: <info> Activation (ttyUSB0) Stage 4 of 5 (IP Configure Get) complete. NetworkManager: <info> Activation (ttyUSB0) Stage 5 of 5 (IP Configure Commit) started... NetworkManager: <info> (ttyUSB0): device state change: 7 -> 8 NetworkManager: <info> Policy set '3 UK Broadband' (ppp0) as default for routing and DNS. NetworkManager: <info> Activation (ttyUSB0) successful, device activated. NetworkManager: <info> Activation (ttyUSB0) Stage 5 of 5 (IP Configure Commit) complete. NetworkManager: <info> Sleeping... NetworkManager: <info> (eth0): now unmanaged NetworkManager: <info> (eth0): device state change: 2 -> 1 NetworkManager: <info> (eth0): cleaning up... NetworkManager: <info> (eth0): taking down device. NetworkManager: <info> (ttyUSB0): now unmanaged NetworkManager: <info> (ttyUSB0): device state change: 8 -> 1 NetworkManager: <info> (ttyUSB0): deactivating device (reason: 37). Terminating on signal 15 Connect time 0.3 minutes. Sent 0 bytes, received 0 bytes. NetworkManager: <debug> [1237399297.303614] nm_serial_device_close(): Closing device 'ttyUSB0' Connection terminated. NetworkManager: nm_system_device_flush_ip4_routes_with_iface: assertion `iface_idx >= 0' failed NetworkManager: nm_system_device_flush_ip4_addresses_with_iface: assertion `iface_idx >= 0' failed NetworkManager: <info> (ttyUSB0): cleaning up... NetworkManager: <info> (ttyUSB0): taking down device. NetworkManager: <debug> [1237399299.333311] ensure_killed(): waiting for ppp pid 4211 to exit NetworkManager: <debug> [1237399299.333621] ensure_killed(): ppp pid 4211 cleaned up ^CNetworkManager: <WARN> nm_signal_handler(): Caught signal 2, shutting down normally. NetworkManager: <info> exiting (success) [r...@heron colinc]#
P: /devices/LNXSYSTM:00/LNXPWRBN:00/input/input0/event0 N: input/event0 P: /devices/LNXSYSTM:00/device:00/PNP0A03:00/device:0c/device:0d/input/input9/event9 N: input/event9 P: /devices/LNXSYSTM:00/device:00/PNP0C0C:00/input/input1/event1 N: input/event1 P: /devices/LNXSYSTM:00/device:00/PNP0C0D:00/input/input3/event3 N: input/event3 P: /devices/LNXSYSTM:00/device:00/PNP0C0E:00/input/input2/event2 N: input/event2 P: /devices/pci0000:00/0000:00:02.5/host0/target0:0:0/0:0:0:0/block/sr0 N: sr0 S: scd0 S: disk/by-path/pci-0000:00:02.5-scsi-0:0:0:0 S: cdrom S: cdrw S: dvd S: dvdrw E: ID_CDROM=1 E: ID_CDROM_CD_R=1 E: ID_CDROM_CD_RW=1 E: ID_CDROM_DVD=1 E: ID_CDROM_DVD_R=1 E: ID_CDROM_DVD_RW=1 E: ID_CDROM_DVD_RAM=1 E: ID_CDROM_DVD_PLUS_R=1 E: ID_CDROM_DVD_PLUS_RW=1 E: ID_CDROM_DVD_PLUS_R_DL=1 E: ID_CDROM_MRW=1 E: ID_CDROM_MRW_W=1 E: ID_PATH=pci-0000:00:02.5-scsi-0:0:0:0 E: GENERATED=1 P: /devices/pci0000:00/0000:00:02.5/host0/target0:0:0/0:0:0:0/bsg/0:0:0:0 N: bsg/0:0:0:0 P: /devices/pci0000:00/0000:00:02.5/host0/target0:0:0/0:0:0:0/scsi_generic/sg0 N: sg0 P: /devices/pci0000:00/0000:00:03.0/usb2 N: bus/usb/002/001 P: /devices/pci0000:00/0000:00:03.0/usb2/2-0:1.0/usb_endpoint/usbdev2.1_ep81 N: usbdev2.1_ep81 P: /devices/pci0000:00/0000:00:03.0/usb2/2-2 N: bus/usb/002/002 P: /devices/pci0000:00/0000:00:03.0/usb2/2-2/2-2:1.0/input/input7/event7 N: input/event7 S: input/by-id/usb-PIXART_USB_OPTICAL_MOUSE-event-mouse S: input/by-path/pci-0000:00:03.0-usb-0:2:1.0-event-mouse E: ID_VENDOR=PIXART E: ID_MODEL=USB_OPTICAL_MOUSE E: ID_REVISION=0100 E: ID_SERIAL=PIXART_USB_OPTICAL_MOUSE E: ID_TYPE=hid E: ID_BUS=usb E: ID_CLASS=mouse E: ID_PATH=pci-0000:00:03.0-usb-0:2:1.0 P: /devices/pci0000:00/0000:00:03.0/usb2/2-2/2-2:1.0/input/input7/mouse2 N: input/mouse2 S: input/by-id/usb-PIXART_USB_OPTICAL_MOUSE-mouse S: input/by-path/pci-0000:00:03.0-usb-0:2:1.0-mouse E: ID_VENDOR=PIXART E: ID_MODEL=USB_OPTICAL_MOUSE E: ID_REVISION=0100 E: ID_SERIAL=PIXART_USB_OPTICAL_MOUSE E: ID_TYPE=hid E: ID_BUS=usb E: ID_CLASS=mouse E: ID_PATH=pci-0000:00:03.0-usb-0:2:1.0 P: /devices/pci0000:00/0000:00:03.0/usb2/2-2/2-2:1.0/usb_endpoint/usbdev2.2_ep81 N: usbdev2.2_ep81 P: /devices/pci0000:00/0000:00:03.0/usb2/2-2/usb_endpoint/usbdev2.2_ep00 N: usbdev2.2_ep00 P: /devices/pci0000:00/0000:00:03.0/usb2/usb_endpoint/usbdev2.1_ep00 N: usbdev2.1_ep00 P: /devices/pci0000:00/0000:00:03.0/usbmon/usbmon2 N: usbmon2 P: /devices/pci0000:00/0000:00:03.1/usb3 N: bus/usb/003/001 P: /devices/pci0000:00/0000:00:03.1/usb3/3-0:1.0/usb_endpoint/usbdev3.1_ep81 N: usbdev3.1_ep81 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2 N: bus/usb/003/007 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.0/ttyUSB0/tty/ttyUSB0 N: ttyUSB0 E: ID_NM_MODEM_GSM=1 E: ID_NM_MODEM_PROBED=1 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.0/usb_endpoint/usbdev3.7_ep02 N: usbdev3.7_ep02 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.0/usb_endpoint/usbdev3.7_ep81 N: usbdev3.7_ep81 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.0/usb_endpoint/usbdev3.7_ep82 N: usbdev3.7_ep82 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.1/ttyUSB1/tty/ttyUSB1 N: ttyUSB1 E: ID_NM_MODEM_GSM=1 E: ID_NM_MODEM_PROBED=1 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.1/usb_endpoint/usbdev3.7_ep05 N: usbdev3.7_ep05 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.1/usb_endpoint/usbdev3.7_ep85 N: usbdev3.7_ep85 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.2/host16/target16:0:0/16:0:0:0/block/sr1 N: sr1 S: scd1 S: disk/by-id/usb-HUAWEI_Mass_Storage-0:0 S: disk/by-path/pci-0000:00:03.1-usb-0:2:1.2-scsi-0:0:0:0 S: cdrom1 E: ID_CDROM=1 E: ID_VENDOR=HUAWEI E: ID_MODEL=Mass_Storage E: ID_REVISION=2.31 E: ID_SERIAL=HUAWEI_Mass_Storage-0:0 E: ID_TYPE=cd E: ID_INSTANCE=0:0 E: ID_BUS=usb E: ID_PATH=pci-0000:00:03.1-usb-0:2:1.2-scsi-0:0:0:0 E: GENERATED=1 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.2/host16/target16:0:0/16:0:0:0/bsg/16:0:0:0 N: bsg/16:0:0:0 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.2/host16/target16:0:0/16:0:0:0/scsi_generic/sg3 N: sg3 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.2/usb_endpoint/usbdev3.7_ep04 N: usbdev3.7_ep04 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/3-2:1.2/usb_endpoint/usbdev3.7_ep83 N: usbdev3.7_ep83 P: /devices/pci0000:00/0000:00:03.1/usb3/3-2/usb_endpoint/usbdev3.7_ep00 N: usbdev3.7_ep00 P: /devices/pci0000:00/0000:00:03.1/usb3/usb_endpoint/usbdev3.1_ep00 N: usbdev3.1_ep00 P: /devices/pci0000:00/0000:00:03.1/usbmon/usbmon3 N: usbmon3 P: /devices/pci0000:00/0000:00:03.3/usb1 N: bus/usb/001/001 P: /devices/pci0000:00/0000:00:03.3/usb1/1-0:1.0/usb_endpoint/usbdev1.1_ep81 N: usbdev1.1_ep81 P: /devices/pci0000:00/0000:00:03.3/usb1/1-6 N: bus/usb/001/003 P: /devices/pci0000:00/0000:00:03.3/usb1/1-6/1-6:1.0/host4/target4:0:0/4:0:0:0/block/sdb N: sdb S: disk/by-id/usb-Generic-_Multi-Card_20060413092100000-0:0 S: disk/by-path/pci-0000:00:03.3-usb-0:6:1.0-scsi-0:0:0:0 E: ID_VENDOR=Generic- E: ID_MODEL=Multi-Card E: ID_REVISION=1.00 E: ID_SERIAL=Generic-_Multi-Card_20060413092100000-0:0 E: ID_SERIAL_SHORT=20060413092100000 E: ID_TYPE=disk E: ID_INSTANCE=0:0 E: ID_BUS=usb E: ID_PATH=pci-0000:00:03.3-usb-0:6:1.0-scsi-0:0:0:0 P: /devices/pci0000:00/0000:00:03.3/usb1/1-6/1-6:1.0/host4/target4:0:0/4:0:0:0/bsg/4:0:0:0 N: bsg/4:0:0:0 P: /devices/pci0000:00/0000:00:03.3/usb1/1-6/1-6:1.0/host4/target4:0:0/4:0:0:0/scsi_generic/sg2 N: sg2 P: /devices/pci0000:00/0000:00:03.3/usb1/1-6/1-6:1.0/usb_endpoint/usbdev1.3_ep01 N: usbdev1.3_ep01 P: /devices/pci0000:00/0000:00:03.3/usb1/1-6/1-6:1.0/usb_endpoint/usbdev1.3_ep82 N: usbdev1.3_ep82 P: /devices/pci0000:00/0000:00:03.3/usb1/1-6/usb_endpoint/usbdev1.3_ep00 N: usbdev1.3_ep00 P: /devices/pci0000:00/0000:00:03.3/usb1/usb_endpoint/usbdev1.1_ep00 N: usbdev1.1_ep00 P: /devices/pci0000:00/0000:00:03.3/usbmon/usbmon1 N: usbmon1 P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/block/sda N: sda S: disk/by-id/scsi-SATA_WDC_WD2500BEVS-_WD-WXC208776085 S: disk/by-id/ata-WDC_WD2500BEVS-22UST0_WD-WXC208776085 S: disk/by-path/pci-0000:00:05.0-scsi-0:0:0:0 E: ID_VENDOR=ATA E: ID_MODEL=WDC_WD2500BEVS-2 E: ID_REVISION=01.0 E: ID_SERIAL=SATA_WDC_WD2500BEVS-_WD-WXC208776085 E: ID_SERIAL_SHORT=WD-WXC208776085 E: ID_TYPE=disk E: ID_BUS=scsi E: ID_ATA_COMPAT=WDC_WD2500BEVS-22UST0_WD-WXC208776085 E: ID_PATH=pci-0000:00:05.0-scsi-0:0:0:0 P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/block/sda/sda1 N: sda1 S: disk/by-id/scsi-SATA_WDC_WD2500BEVS-_WD-WXC208776085-part1 S: disk/by-id/ata-WDC_WD2500BEVS-22UST0_WD-WXC208776085-part1 S: disk/by-path/pci-0000:00:05.0-scsi-0:0:0:0-part1 S: disk/by-uuid/A0A80370A803446E S: disk/by-label/Recovery E: ID_VENDOR=ATA E: ID_MODEL=WDC_WD2500BEVS-2 E: ID_REVISION=01.0 E: ID_SERIAL=SATA_WDC_WD2500BEVS-_WD-WXC208776085 E: ID_SERIAL_SHORT=WD-WXC208776085 E: ID_TYPE=disk E: ID_BUS=scsi E: ID_ATA_COMPAT=WDC_WD2500BEVS-22UST0_WD-WXC208776085 E: ID_PATH=pci-0000:00:05.0-scsi-0:0:0:0 E: ID_FS_USAGE=filesystem E: ID_FS_TYPE=ntfs E: ID_FS_VERSION=3.1 E: ID_FS_UUID=A0A80370A803446E E: ID_FS_UUID_ENC=A0A80370A803446E E: ID_FS_LABEL=Recovery E: ID_FS_LABEL_ENC=Recovery E: ID_FS_LABEL_SAFE=Recovery P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/block/sda/sda2 N: sda2 S: disk/by-id/scsi-SATA_WDC_WD2500BEVS-_WD-WXC208776085-part2 S: disk/by-id/ata-WDC_WD2500BEVS-22UST0_WD-WXC208776085-part2 S: disk/by-path/pci-0000:00:05.0-scsi-0:0:0:0-part2 S: disk/by-uuid/02A0065FA0065995 S: disk/by-label/System E: ID_VENDOR=ATA E: ID_MODEL=WDC_WD2500BEVS-2 E: ID_REVISION=01.0 E: ID_SERIAL=SATA_WDC_WD2500BEVS-_WD-WXC208776085 E: ID_SERIAL_SHORT=WD-WXC208776085 E: ID_TYPE=disk E: ID_BUS=scsi E: ID_ATA_COMPAT=WDC_WD2500BEVS-22UST0_WD-WXC208776085 E: ID_PATH=pci-0000:00:05.0-scsi-0:0:0:0 E: ID_FS_USAGE=filesystem E: ID_FS_TYPE=ntfs E: ID_FS_VERSION=3.1 E: ID_FS_UUID=02A0065FA0065995 E: ID_FS_UUID_ENC=02A0065FA0065995 E: ID_FS_LABEL=System E: ID_FS_LABEL_ENC=System E: ID_FS_LABEL_SAFE=System P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/block/sda/sda3 N: sda3 S: disk/by-id/scsi-SATA_WDC_WD2500BEVS-_WD-WXC208776085-part3 S: disk/by-id/ata-WDC_WD2500BEVS-22UST0_WD-WXC208776085-part3 S: disk/by-path/pci-0000:00:05.0-scsi-0:0:0:0-part3 S: disk/by-uuid/486C0C326C0C1D76 S: disk/by-label/Vista E: ID_VENDOR=ATA E: ID_MODEL=WDC_WD2500BEVS-2 E: ID_REVISION=01.0 E: ID_SERIAL=SATA_WDC_WD2500BEVS-_WD-WXC208776085 E: ID_SERIAL_SHORT=WD-WXC208776085 E: ID_TYPE=disk E: ID_BUS=scsi E: ID_ATA_COMPAT=WDC_WD2500BEVS-22UST0_WD-WXC208776085 E: ID_PATH=pci-0000:00:05.0-scsi-0:0:0:0 E: ID_FS_USAGE=filesystem E: ID_FS_TYPE=ntfs E: ID_FS_VERSION=3.1 E: ID_FS_UUID=486C0C326C0C1D76 E: ID_FS_UUID_ENC=486C0C326C0C1D76 E: ID_FS_LABEL=Vista E: ID_FS_LABEL_ENC=Vista E: ID_FS_LABEL_SAFE=Vista P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/block/sda/sda4 N: sda4 S: disk/by-id/scsi-SATA_WDC_WD2500BEVS-_WD-WXC208776085-part4 S: disk/by-id/ata-WDC_WD2500BEVS-22UST0_WD-WXC208776085-part4 S: disk/by-path/pci-0000:00:05.0-scsi-0:0:0:0-part4 E: ID_VENDOR=ATA E: ID_MODEL=WDC_WD2500BEVS-2 E: ID_REVISION=01.0 E: ID_SERIAL=SATA_WDC_WD2500BEVS-_WD-WXC208776085 E: ID_SERIAL_SHORT=WD-WXC208776085 E: ID_TYPE=disk E: ID_BUS=scsi E: ID_ATA_COMPAT=WDC_WD2500BEVS-22UST0_WD-WXC208776085 E: ID_PATH=pci-0000:00:05.0-scsi-0:0:0:0 P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/block/sda/sda5 N: sda5 S: disk/by-id/scsi-SATA_WDC_WD2500BEVS-_WD-WXC208776085-part5 S: disk/by-id/ata-WDC_WD2500BEVS-22UST0_WD-WXC208776085-part5 S: disk/by-path/pci-0000:00:05.0-scsi-0:0:0:0-part5 S: disk/by-uuid/e8c1cc77-8e1c-407d-a02b-39d8511229a2 E: ID_VENDOR=ATA E: ID_MODEL=WDC_WD2500BEVS-2 E: ID_REVISION=01.0 E: ID_SERIAL=SATA_WDC_WD2500BEVS-_WD-WXC208776085 E: ID_SERIAL_SHORT=WD-WXC208776085 E: ID_TYPE=disk E: ID_BUS=scsi E: ID_ATA_COMPAT=WDC_WD2500BEVS-22UST0_WD-WXC208776085 E: ID_PATH=pci-0000:00:05.0-scsi-0:0:0:0 E: ID_FS_USAGE=other E: ID_FS_TYPE=swap E: ID_FS_VERSION=2 E: ID_FS_UUID=e8c1cc77-8e1c-407d-a02b-39d8511229a2 E: ID_FS_UUID_ENC=e8c1cc77-8e1c-407d-a02b-39d8511229a2 E: ID_FS_LABEL= E: ID_FS_LABEL_ENC= E: ID_FS_LABEL_SAFE= P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/block/sda/sda6 N: sda6 S: disk/by-id/scsi-SATA_WDC_WD2500BEVS-_WD-WXC208776085-part6 S: disk/by-id/ata-WDC_WD2500BEVS-22UST0_WD-WXC208776085-part6 S: disk/by-path/pci-0000:00:05.0-scsi-0:0:0:0-part6 S: disk/by-uuid/2237bfcb-e203-41d2-ae9f-316338ae7408 S: disk/by-label/\x2f E: ID_VENDOR=ATA E: ID_MODEL=WDC_WD2500BEVS-2 E: ID_REVISION=01.0 E: ID_SERIAL=SATA_WDC_WD2500BEVS-_WD-WXC208776085 E: ID_SERIAL_SHORT=WD-WXC208776085 E: ID_TYPE=disk E: ID_BUS=scsi E: ID_ATA_COMPAT=WDC_WD2500BEVS-22UST0_WD-WXC208776085 E: ID_PATH=pci-0000:00:05.0-scsi-0:0:0:0 E: ID_FS_USAGE=filesystem E: ID_FS_TYPE=ext2 E: ID_FS_VERSION=1.0 E: ID_FS_UUID=2237bfcb-e203-41d2-ae9f-316338ae7408 E: ID_FS_UUID_ENC=2237bfcb-e203-41d2-ae9f-316338ae7408 E: ID_FS_LABEL=/ E: ID_FS_LABEL_ENC=\x2f E: ID_FS_LABEL_SAFE= P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/block/sda/sda7 N: sda7 S: disk/by-id/scsi-SATA_WDC_WD2500BEVS-_WD-WXC208776085-part7 S: disk/by-id/ata-WDC_WD2500BEVS-22UST0_WD-WXC208776085-part7 S: disk/by-path/pci-0000:00:05.0-scsi-0:0:0:0-part7 S: disk/by-uuid/eaf22d92-ba1c-402d-8ffd-044673753b9e S: disk/by-label/\x2f1 E: ID_VENDOR=ATA E: ID_MODEL=WDC_WD2500BEVS-2 E: ID_REVISION=01.0 E: ID_SERIAL=SATA_WDC_WD2500BEVS-_WD-WXC208776085 E: ID_SERIAL_SHORT=WD-WXC208776085 E: ID_TYPE=disk E: ID_BUS=scsi E: ID_ATA_COMPAT=WDC_WD2500BEVS-22UST0_WD-WXC208776085 E: ID_PATH=pci-0000:00:05.0-scsi-0:0:0:0 E: ID_FS_USAGE=filesystem E: ID_FS_TYPE=ext3 E: ID_FS_VERSION=1.0 E: ID_FS_UUID=eaf22d92-ba1c-402d-8ffd-044673753b9e E: ID_FS_UUID_ENC=eaf22d92-ba1c-402d-8ffd-044673753b9e E: ID_FS_LABEL=/1 E: ID_FS_LABEL_ENC=\x2f1 E: ID_FS_LABEL_SAFE=1 P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/block/sda/sda8 N: sda8 S: disk/by-id/scsi-SATA_WDC_WD2500BEVS-_WD-WXC208776085-part8 S: disk/by-id/ata-WDC_WD2500BEVS-22UST0_WD-WXC208776085-part8 S: disk/by-path/pci-0000:00:05.0-scsi-0:0:0:0-part8 E: ID_VENDOR=ATA E: ID_MODEL=WDC_WD2500BEVS-2 E: ID_REVISION=01.0 E: ID_SERIAL=SATA_WDC_WD2500BEVS-_WD-WXC208776085 E: ID_SERIAL_SHORT=WD-WXC208776085 E: ID_TYPE=disk E: ID_BUS=scsi E: ID_ATA_COMPAT=WDC_WD2500BEVS-22UST0_WD-WXC208776085 E: ID_PATH=pci-0000:00:05.0-scsi-0:0:0:0 E: ID_FS_USAGE=raid E: ID_FS_TYPE=LVM2_member E: ID_FS_VERSION=LVM2 001 E: ID_FS_UUID=m04SQv-JHhI-XEk4-oYJS-XlNw-e1BT-zqjkiw E: ID_FS_UUID_ENC=m04SQv-JHhI-XEk4-oYJS-XlNw-e1BT-zqjkiw E: ID_FS_LABEL= E: ID_FS_LABEL_ENC= E: ID_FS_LABEL_SAFE= P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/bsg/2:0:0:0 N: bsg/2:0:0:0 P: /devices/pci0000:00/0000:00:05.0/host2/target2:0:0/2:0:0:0/scsi_generic/sg1 N: sg1 P: /devices/pci0000:00/0000:00:0f.0/sound/card0/audio N: audio P: /devices/pci0000:00/0000:00:0f.0/sound/card0/controlC0 N: snd/controlC0 P: /devices/pci0000:00/0000:00:0f.0/sound/card0/dsp N: dsp P: /devices/pci0000:00/0000:00:0f.0/sound/card0/hwC0D0 N: snd/hwC0D0 P: /devices/pci0000:00/0000:00:0f.0/sound/card0/mixer N: mixer P: /devices/pci0000:00/0000:00:0f.0/sound/card0/pcmC0D0c N: snd/pcmC0D0c P: /devices/pci0000:00/0000:00:0f.0/sound/card0/pcmC0D0p N: snd/pcmC0D0p P: /devices/platform/i8042/serio0/input/input5/event5 N: input/event5 S: input/by-path/platform-i8042-serio-0-event-kbd E: ID_CLASS=kbd E: ID_SERIAL=noserial E: ID_PATH=platform-i8042-serio-0 P: /devices/platform/i8042/serio4/input/input6/event6 N: input/event6 S: input/by-path/platform-i8042-serio-4-event-mouse E: ID_CLASS=mouse E: ID_SERIAL=noserial E: ID_PATH=platform-i8042-serio-4 P: /devices/platform/i8042/serio4/input/input6/mouse1 N: input/mouse1 S: input/by-path/platform-i8042-serio-4-mouse E: ID_CLASS=mouse E: ID_SERIAL=noserial E: ID_PATH=platform-i8042-serio-4 P: /devices/platform/pcspkr/input/input8/event8 N: input/event8 S: input/by-path/platform-pcspkr-event-spkr E: ID_CLASS=spkr E: ID_SERIAL=noserial E: ID_PATH=platform-pcspkr P: /devices/platform/serial8250/tty/ttyS0 N: ttyS0 P: /devices/platform/serial8250/tty/ttyS1 N: ttyS1 P: /devices/platform/serial8250/tty/ttyS2 N: ttyS2 P: /devices/platform/serial8250/tty/ttyS3 N: ttyS3 P: /devices/pnp0/00:02/rtc/rtc0 N: rtc0 S: rtc P: /devices/virtual/block/dm-0 N: dm-0 P: /devices/virtual/block/dm-1 N: dm-1 P: /devices/virtual/block/dm-2 N: dm-2 P: /devices/virtual/block/ram0 N: ram0 S: ramdisk P: /devices/virtual/block/ram1 N: ram1 S: ram P: /devices/virtual/block/ram10 N: ram10 P: /devices/virtual/block/ram11 N: ram11 P: /devices/virtual/block/ram12 N: ram12 P: /devices/virtual/block/ram13 N: ram13 P: /devices/virtual/block/ram14 N: ram14 P: /devices/virtual/block/ram15 N: ram15 P: /devices/virtual/block/ram2 N: ram2 P: /devices/virtual/block/ram3 N: ram3 P: /devices/virtual/block/ram4 N: ram4 P: /devices/virtual/block/ram5 N: ram5 P: /devices/virtual/block/ram6 N: ram6 P: /devices/virtual/block/ram7 N: ram7 P: /devices/virtual/block/ram8 N: ram8 P: /devices/virtual/block/ram9 N: ram9 P: /devices/virtual/cpuid/cpu0 N: cpu/0/cpuid P: /devices/virtual/cpuid/cpu1 N: cpu/1/cpuid P: /devices/virtual/hidraw/hidraw0 N: hidraw0 P: /devices/virtual/input/input4/event4 N: input/event4 P: /devices/virtual/input/input4/mouse0 N: input/mouse0 P: /devices/virtual/input/mice N: input/mice P: /devices/virtual/mem/full N: full P: /devices/virtual/mem/kmsg N: kmsg P: /devices/virtual/mem/mem N: mem P: /devices/virtual/mem/null N: null S: XOR P: /devices/virtual/mem/oldmem N: oldmem P: /devices/virtual/mem/port N: port P: /devices/virtual/mem/random N: random P: /devices/virtual/mem/urandom N: urandom P: /devices/virtual/mem/zero N: zero P: /devices/virtual/misc/agpgart N: agpgart P: /devices/virtual/misc/cpu_dma_latency N: cpu_dma_latency P: /devices/virtual/misc/device-mapper N: mapper/control P: /devices/virtual/misc/fuse N: fuse P: /devices/virtual/misc/hpet N: hpet P: /devices/virtual/misc/network_latency N: network_latency P: /devices/virtual/misc/network_throughput N: network_throughput P: /devices/virtual/misc/nvram N: nvram P: /devices/virtual/misc/snapshot N: snapshot P: /devices/virtual/msr/msr0 N: cpu/0/msr P: /devices/virtual/msr/msr1 N: cpu/1/msr P: /devices/virtual/ppp/ppp N: ppp R:1 P: /devices/virtual/raw/rawctl N: raw/rawctl P: /devices/virtual/sound/seq N: snd/seq P: /devices/virtual/sound/sequencer N: sequencer P: /devices/virtual/sound/sequencer2 N: sequencer2 P: /devices/virtual/sound/timer N: snd/timer P: /devices/virtual/tty/console N: console P: /devices/virtual/tty/ptmx N: ptmx P: /devices/virtual/tty/tty N: tty P: /devices/virtual/tty/tty0 N: tty0 P: /devices/virtual/tty/tty1 N: tty1 P: /devices/virtual/tty/tty10 N: tty10 P: /devices/virtual/tty/tty11 N: tty11 P: /devices/virtual/tty/tty12 N: tty12 P: /devices/virtual/tty/tty13 N: tty13 P: /devices/virtual/tty/tty14 N: tty14 P: /devices/virtual/tty/tty15 N: tty15 P: /devices/virtual/tty/tty16 N: tty16 P: /devices/virtual/tty/tty17 N: tty17 P: /devices/virtual/tty/tty18 N: tty18 P: /devices/virtual/tty/tty19 N: tty19 P: /devices/virtual/tty/tty2 N: tty2 P: /devices/virtual/tty/tty20 N: tty20 P: /devices/virtual/tty/tty21 N: tty21 P: /devices/virtual/tty/tty22 N: tty22 P: /devices/virtual/tty/tty23 N: tty23 P: /devices/virtual/tty/tty24 N: tty24 P: /devices/virtual/tty/tty25 N: tty25 P: /devices/virtual/tty/tty26 N: tty26 P: /devices/virtual/tty/tty27 N: tty27 P: /devices/virtual/tty/tty28 N: tty28 P: /devices/virtual/tty/tty29 N: tty29 P: /devices/virtual/tty/tty3 N: tty3 P: /devices/virtual/tty/tty30 N: tty30 P: /devices/virtual/tty/tty31 N: tty31 P: /devices/virtual/tty/tty32 N: tty32 P: /devices/virtual/tty/tty33 N: tty33 P: /devices/virtual/tty/tty34 N: tty34 P: /devices/virtual/tty/tty35 N: tty35 P: /devices/virtual/tty/tty36 N: tty36 P: /devices/virtual/tty/tty37 N: tty37 P: /devices/virtual/tty/tty38 N: tty38 P: /devices/virtual/tty/tty39 N: tty39 P: /devices/virtual/tty/tty4 N: tty4 P: /devices/virtual/tty/tty40 N: tty40 P: /devices/virtual/tty/tty41 N: tty41 P: /devices/virtual/tty/tty42 N: tty42 P: /devices/virtual/tty/tty43 N: tty43 P: /devices/virtual/tty/tty44 N: tty44 P: /devices/virtual/tty/tty45 N: tty45 P: /devices/virtual/tty/tty46 N: tty46 P: /devices/virtual/tty/tty47 N: tty47 P: /devices/virtual/tty/tty48 N: tty48 P: /devices/virtual/tty/tty49 N: tty49 P: /devices/virtual/tty/tty5 N: tty5 P: /devices/virtual/tty/tty50 N: tty50 P: /devices/virtual/tty/tty51 N: tty51 P: /devices/virtual/tty/tty52 N: tty52 P: /devices/virtual/tty/tty53 N: tty53 P: /devices/virtual/tty/tty54 N: tty54 P: /devices/virtual/tty/tty55 N: tty55 P: /devices/virtual/tty/tty56 N: tty56 P: /devices/virtual/tty/tty57 N: tty57 P: /devices/virtual/tty/tty58 N: tty58 P: /devices/virtual/tty/tty59 N: tty59 P: /devices/virtual/tty/tty6 N: tty6 P: /devices/virtual/tty/tty60 N: tty60 P: /devices/virtual/tty/tty61 N: tty61 P: /devices/virtual/tty/tty62 N: tty62 P: /devices/virtual/tty/tty63 N: tty63 P: /devices/virtual/tty/tty7 N: tty7 P: /devices/virtual/tty/tty8 N: tty8 P: /devices/virtual/tty/tty9 N: tty9 P: /devices/virtual/usbmon/usbmon0 N: usbmon0 P: /devices/virtual/vc/vcs N: vcs P: /devices/virtual/vc/vcs1 N: vcs1 P: /devices/virtual/vc/vcs2 N: vcs2 P: /devices/virtual/vc/vcs3 N: vcs3 P: /devices/virtual/vc/vcs4 N: vcs4 P: /devices/virtual/vc/vcs5 N: vcs5 P: /devices/virtual/vc/vcs6 N: vcs6 P: /devices/virtual/vc/vcs7 N: vcs7 P: /devices/virtual/vc/vcsa N: vcsa P: /devices/virtual/vc/vcsa1 N: vcsa1 P: /devices/virtual/vc/vcsa2 N: vcsa2 P: /devices/virtual/vc/vcsa3 N: vcsa3 P: /devices/virtual/vc/vcsa4 N: vcsa4 P: /devices/virtual/vc/vcsa5 N: vcsa5 P: /devices/virtual/vc/vcsa6 N: vcsa6 P: /devices/virtual/vc/vcsa7 N: vcsa7
[r...@heron colinc]# NM_SERIAL_DEBUG=1 /usr/sbin/NetworkManager --no-daemon NetworkManager: <info> starting... -- Error received: File exists -- Original message: type=0x14 length=56 flags=<REQUEST,ACK,ATOMIC> sequence-nr=1237399876 pid=4199975 NetworkManager: <WARN> nm_generic_enable_loopback(): error -17 returned from rtnl_addr_add(): Sucess NetworkManager: <info> (eth0): new Ethernet device (driver: 'sis190') NetworkManager: <info> (eth0): exported as /org/freedesktop/Hal/devices/net_00_03_0d_90_44_e8 NetworkManager: <info> (eth0): device state change: 1 -> 2 NetworkManager: <info> (eth0): bringing up device. NetworkManager: <info> (eth0): preparing device. NetworkManager: <info> (eth0): deactivating device (reason: 2). NetworkManager: <info> (ttyUSB1): detected GSM modem via udev capabilities NetworkManager: <info> (ttyUSB1): new Modem device (driver: 'option') NetworkManager: <info> (ttyUSB1): exported as /org/freedesktop/Hal/devices/usb_device_12d1_1003_noserial_if1_serial_usb_1 NetworkManager: <info> (ttyUSB0): detected GSM modem via udev capabilities NetworkManager: <info> (ttyUSB0): new Modem device (driver: 'option') NetworkManager: <info> (ttyUSB0): exported as /org/freedesktop/Hal/devices/usb_device_12d1_1003_noserial_if0_serial_usb_0 NetworkManager: <info> (ttyUSB1): device state change: 1 -> 2 NetworkManager: <info> (ttyUSB1): deactivating device (reason: 2). NetworkManager: nm_system_device_flush_ip4_routes_with_iface: assertion `iface_idx >= 0' failed NetworkManager: nm_system_device_flush_ip4_addresses_with_iface: assertion `iface_idx >= 0' failed NetworkManager: <info> (ttyUSB1): device state change: 2 -> 3 NetworkManager: <info> Activation (ttyUSB1) starting connection '3 UK Broadband' NetworkManager: <info> (ttyUSB1): device state change: 3 -> 4 NetworkManager: <info> Activation (ttyUSB1) Stage 1 of 5 (Device Prepare) scheduled... NetworkManager: <info> Activation (ttyUSB1) Stage 1 of 5 (Device Prepare) started... NetworkManager: <debug> [1237399899.400671] nm_serial_device_open(): (ttyUSB1) opening device... NetworkManager: <info> Activation (ttyUSB1) Stage 1 of 5 (Device Prepare) complete. NetworkManager: <debug> [1237399899.521283] nm_serial_debug(): Sending: 'ATZ E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237399899.575185] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <debug> [1237399906.595996] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ^RSSI:12 ' NetworkManager: <WARN> init_done(): Trying alternate modem initialization (1) NetworkManager: <debug> [1237399910.000767] nm_serial_debug(): Sending: 'ATZ E0 V1 &C1 ' NetworkManager: <info> (ttyUSB0): device state change: 1 -> 2 NetworkManager: <info> (ttyUSB0): deactivating device (reason: 2). NetworkManager: nm_system_device_flush_ip4_routes_with_iface: assertion `iface_idx >= 0' failed NetworkManager: nm_system_device_flush_ip4_addresses_with_iface: assertion `iface_idx >= 0' failed NetworkManager: <debug> [1237399910.096518] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <WARN> init_done(): Trying alternate modem initialization (2) NetworkManager: <debug> [1237399921.001103] nm_serial_debug(): Sending: 'AT&F E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237399921.056948] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <debug> [1237399922.502580] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ^BOOT:82600852,0,0,0,6 ' NetworkManager: <WARN> init_done(): Trying alternate modem initialization (3) NetworkManager: <debug> [1237399932.000624] nm_serial_debug(): Sending: 'AT&F E0 V1 &C1 ' NetworkManager: <debug> [1237399932.036398] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <WARN> init_done(): Trying alternate modem initialization (4) NetworkManager: <debug> [1237399943.000746] nm_serial_debug(): Sending: 'AT&F E0 V1 ' NetworkManager: <debug> [1237399943.022509] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <debug> [1237399952.501019] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ^BOOT:82600852,0,0,0,6 ' NetworkManager: <WARN> init_done(): Trying alternate modem initialization (5) NetworkManager: <debug> [1237399954.001227] nm_serial_debug(): Sending: ' AT&F E0 V1 X4 &C1 +CREG=0 +FCLASS=0 ' NetworkManager: <debug> [1237399954.076836] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <WARN> init_done(): Modem initialization failed NetworkManager: <info> (ttyUSB1): device state change: 4 -> 9 NetworkManager: <debug> [1237399965.000637] nm_serial_device_close(): Closing device 'ttyUSB1' NetworkManager: <info> Marking connection '3 UK Broadband' invalid. NetworkManager: <info> Activation (ttyUSB1) failed. NetworkManager: <info> (ttyUSB0): device state change: 2 -> 3 NetworkManager: <info> (ttyUSB1): device state change: 9 -> 3 NetworkManager: <info> (ttyUSB1): deactivating device (reason: 0). NetworkManager: nm_system_device_flush_ip4_routes_with_iface: assertion `iface_idx >= 0' failed NetworkManager: nm_system_device_flush_ip4_addresses_with_iface: assertion `iface_idx >= 0' failed NetworkManager: <info> Activation (ttyUSB1) starting connection '3 UK Broadband' NetworkManager: <info> (ttyUSB1): device state change: 3 -> 4 NetworkManager: <info> Activation (ttyUSB1) Stage 1 of 5 (Device Prepare) scheduled... NetworkManager: <info> Activation (ttyUSB1) Stage 1 of 5 (Device Prepare) started... NetworkManager: <debug> [1237400312.536730] nm_serial_device_open(): (ttyUSB1) opening device... NetworkManager: <info> Activation (ttyUSB1) Stage 1 of 5 (Device Prepare) complete. NetworkManager: <debug> [1237400312.658422] nm_serial_debug(): Sending: 'ATZ E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237400312.723303] nm_serial_debug(): Got: ' ^BOOT:82600852,0,0,0,6 ' NetworkManager: <debug> [1237400312.724245] nm_serial_debug(): Got: ' ^BOOT:82600852,0,0,0,6 +CME ERROR: operation not allowed ' NetworkManager: <WARN> init_done(): Trying alternate modem initialization (1) NetworkManager: <debug> [1237400323.000876] nm_serial_debug(): Sending: 'ATZ E0 V1 &C1 ' NetworkManager: <debug> [1237400323.028803] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <WARN> init_done(): Trying alternate modem initialization (2) NetworkManager: <debug> [1237400334.001267] nm_serial_debug(): Sending: 'AT&F E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237400334.057419] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <debug> [1237400342.478740] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ^BOOT:82600852,0,0,0,6 ' NetworkManager: <WARN> init_done(): Trying alternate modem initialization (3) NetworkManager: <debug> [1237400345.001617] nm_serial_debug(): Sending: 'AT&F E0 V1 &C1 ' NetworkManager: <debug> [1237400345.031577] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <WARN> init_done(): Trying alternate modem initialization (4) NetworkManager: <debug> [1237400356.000931] nm_serial_debug(): Sending: 'AT&F E0 V1 ' NetworkManager: <debug> [1237400356.025747] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <WARN> init_done(): Trying alternate modem initialization (5) NetworkManager: <debug> [1237400367.001187] nm_serial_debug(): Sending: ' AT&F E0 V1 X4 &C1 +CREG=0 +FCLASS=0 ' NetworkManager: <debug> [1237400367.075047] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ' NetworkManager: <debug> [1237400372.477183] nm_serial_debug(): Got: ' +CME ERROR: operation not allowed ^BOOT:82600852,0,0,0,6 ' NetworkManager: <WARN> init_done(): Modem initialization failed NetworkManager: <info> (ttyUSB1): device state change: 4 -> 9 NetworkManager: <debug> [1237400378.000752] nm_serial_device_close(): Closing device 'ttyUSB1' NetworkManager: <info> Marking connection '3 UK Broadband' invalid. NetworkManager: <info> Activation (ttyUSB1) failed. NetworkManager: <info> (ttyUSB1): device state change: 9 -> 3 NetworkManager: <info> (ttyUSB1): deactivating device (reason: 0). NetworkManager: nm_system_device_flush_ip4_routes_with_iface: assertion `iface_idx >= 0' failed NetworkManager: nm_system_device_flush_ip4_addresses_with_iface: assertion `iface_idx >= 0' failed NetworkManager: <info> Activation (ttyUSB0) starting connection '3 UK Broadband' NetworkManager: <info> (ttyUSB0): device state change: 3 -> 4 NetworkManager: <info> Activation (ttyUSB0) Stage 1 of 5 (Device Prepare) scheduled... NetworkManager: <info> Activation (ttyUSB0) Stage 1 of 5 (Device Prepare) started... NetworkManager: <debug> [1237400388.136668] nm_serial_device_open(): (ttyUSB0) opening device... NetworkManager: <info> Activation (ttyUSB0) Stage 1 of 5 (Device Prepare) complete. NetworkManager: <debug> [1237400388.258453] nm_serial_debug(): Sending: 'ATZ E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237400388.315829] nm_serial_debug(): Got: 'ATZ E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237400388.338532] nm_serial_debug(): Got: 'ATZ E0 V1 X4 &C1 +FCLASS=0 OK ' NetworkManager: <debug> [1237400388.338798] nm_serial_debug(): Sending: 'AT+CPIN? ' NetworkManager: <debug> [1237400388.356813] nm_serial_debug(): Got: ' +CPIN: READY OK ' NetworkManager: <debug> [1237400388.356971] nm_serial_debug(): Sending: 'ATZ E0 V1 X4 &C1 +FCLASS=0 ' NetworkManager: <debug> [1237400388.434524] nm_serial_debug(): Got: ' OK ' NetworkManager: <info> (ttyUSB0): powering up... NetworkManager: <debug> [1237400388.434892] nm_serial_debug(): Sending: 'AT+CFUN=1 ' NetworkManager: <debug> [1237400388.456492] nm_serial_debug(): Got: ' OK ' NetworkManager: <debug> [1237400388.456987] nm_serial_debug(): Sending: 'AT+CGMM ' NetworkManager: <debug> [1237400388.474459] nm_serial_debug(): Got: ' E220 OK ' NetworkManager: <debug> [1237400388.474937] nm_serial_debug(): Sending: 'AT+CREG? ' NetworkManager: <debug> [1237400388.497108] nm_serial_debug(): Got: ' +CREG: 0,1 OK ' NetworkManager: <info> Registered on Home network NetworkManager: <debug> [1237400388.497525] nm_serial_debug(): Sending: 'AT+COPS? ' NetworkManager: <debug> [1237400388.516555] nm_serial_debug(): Got: ' +COPS: 0,0,"3 UK",2 OK ' NetworkManager: <info> Associated with network: +COPS: 0,0,"3 UK",2 NetworkManager: <debug> [1237400388.517482] nm_serial_debug(): Sending: 'ATDT*99# ' NetworkManager: <debug> [1237400388.540513] nm_serial_debug(): Got: ' CONNECT 3600000 ' NetworkManager: <info> Connected, Woo! NetworkManager: <info> Activation (ttyUSB0) Stage 2 of 5 (Device Configure) scheduled... NetworkManager: <info> Activation (ttyUSB0) Stage 2 of 5 (Device Configure) starting... NetworkManager: <info> (ttyUSB0): device state change: 4 -> 5 NetworkManager: <info> Starting pppd connection NetworkManager: <debug> [1237400388.580743] nm_ppp_manager_start(): Command line: /usr/sbin/pppd nodetach lock nodefaultroute ttyUSB0 noipdefault noauth usepeerdns lcp-echo-failure 0 lcp-echo-interval 0 ipparam /org/freedesktop/NetworkManager/PPP/0 plugin /usr/lib/pppd/2.4.4/nm-pppd-plugin.so NetworkManager: <debug> [1237400388.583114] nm_ppp_manager_start(): ppp started with pid 5850 Plugin /usr/lib/pppd/2.4.4/nm-pppd-plugin.so loaded. NetworkManager: <info> Activation (ttyUSB0) Stage 2 of 5 (Device Configure) complete. Using interface ppp0 Connect: ppp0 <--> /dev/ttyUSB0 NetworkManager: <info> (ttyUSB0): device state change: 5 -> 6 CHAP authentication succeeded CHAP authentication succeeded NetworkManager: <info> (ttyUSB0): device state change: 6 -> 7 Could not determine remote IP address: defaulting to 10.64.64.64 local IP address 92.40.15.152 remote IP address 10.64.64.64 primary DNS address 4.2.2.4 secondary DNS address 4.2.2.3 NetworkManager: <info> PPP manager(IP Config Get) reply received. NetworkManager: <info> Activation (ttyUSB0) Stage 4 of 5 (IP Configure Get) scheduled... NetworkManager: <info> Activation (ttyUSB0) Stage 4 of 5 (IP Configure Get) started... NetworkManager: <info> Activation (ttyUSB0) Stage 5 of 5 (IP Configure Commit) scheduled... NetworkManager: <info> Activation (ttyUSB0) Stage 4 of 5 (IP Configure Get) complete. NetworkManager: <info> Activation (ttyUSB0) Stage 5 of 5 (IP Configure Commit) started... NetworkManager: <info> (ttyUSB0): device state change: 7 -> 8 NetworkManager: <info> Policy set '3 UK Broadband' (ppp0) as default for routing and DNS. NetworkManager: <info> Activation (ttyUSB0) successful, device activated. NetworkManager: <info> Activation (ttyUSB0) Stage 5 of 5 (IP Configure Commit) complete. NetworkManager: <info> Sleeping... NetworkManager: <info> (eth0): now unmanaged NetworkManager: <info> (eth0): device state change: 2 -> 1 NetworkManager: <info> (eth0): cleaning up... NetworkManager: <info> (eth0): taking down device. NetworkManager: <info> (ttyUSB1): now unmanaged NetworkManager: <info> (ttyUSB1): device state change: 3 -> 1 NetworkManager: <info> (ttyUSB1): cleaning up... NetworkManager: <info> (ttyUSB1): taking down device. NetworkManager: <info> (ttyUSB0): now unmanaged NetworkManager: <info> (ttyUSB0): device state change: 8 -> 1 NetworkManager: <info> (ttyUSB0): deactivating device (reason: 37). Terminating on signal 15 Connect time 0.1 minutes. Sent 0 bytes, received 0 bytes. NetworkManager: <debug> [1237400396.106597] nm_serial_device_close(): Closing device 'ttyUSB0' Connection terminated. NetworkManager: nm_system_device_flush_ip4_routes_with_iface: assertion `iface_idx >= 0' failed NetworkManager: nm_system_device_flush_ip4_addresses_with_iface: assertion `iface_idx >= 0' failed NetworkManager: <info> (ttyUSB0): cleaning up... NetworkManager: <info> (ttyUSB0): taking down device. NetworkManager: <debug> [1237400398.332256] ensure_killed(): waiting for ppp pid 5850 to exit NetworkManager: <debug> [1237400398.332597] ensure_killed(): ppp pid 5850 cleaned up ^CNetworkManager: <WARN> nm_signal_handler(): Caught signal 2, shutting down normally. NetworkManager: <info> exiting (success) [r...@heron colinc]#
_______________________________________________ NetworkManager-list mailing list NetworkManager-list@gnome.org http://mail.gnome.org/mailman/listinfo/networkmanager-list