MrRady Posted April 11, 2018 Posted April 11, 2018 I have encoutered some difficulties on carrier detection with network-manager on ethernet port, on lime2, on default kernel, 5.38. On mii-tools and ethtools, carrier is correctly reported. The result, network-manager try to activate connection at boot even cable is not plugged. It's report drivers (sunxi_gmac) does not support carrier detection, as i found in syslog When unplugged, the connection is still active. Apr 11 11:39:03 localhost NetworkManager[491]: <info> [1523439543.5279] NetworkManager (version 1.2.6) is starting... Apr 11 11:39:03 localhost NetworkManager[491]: <info> [1523439543.5321] Read config: /etc/NetworkManager/NetworkManager.conf (lib: zz-override-wifi-powersave-off.conf) (etc: default-wifi-powersave-on.con f) Apr 11 11:39:03 localhost NetworkManager[491]: <info> [1523439543.5894] manager[0x1d650f8]: monitoring kernel firmware directory '/lib/firmware'. Apr 11 11:39:03 localhost NetworkManager[491]: <info> [1523439543.5920] monitoring ifupdown state file '/run/network/ifstate'. Apr 11 11:39:03 localhost NetworkManager[491]: <info> [1523439543.6314] dns-mgr[0x1d56520]: init: dns=default, rc-manager=resolvconf Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3421] init! Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3439] management mode: managed Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3508] devices added (path: /sys/devices/platform/sunxi_gmac/net/eth0, iface: eth0) Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3510] device added (path: /sys/devices/platform/sunxi_gmac/net/eth0, iface: eth0): no ifupdown configuration found. Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3512] devices added (path: /sys/devices/virtual/net/bond0, iface: bond0) Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3513] device added (path: /sys/devices/virtual/net/bond0, iface: bond0): no ifupdown configuration found. Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3515] devices added (path: /sys/devices/virtual/net/lo, iface: lo) Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3516] device added (path: /sys/devices/virtual/net/lo, iface: lo): no ifupdown configuration found. Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3517] end _init. Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3519] settings: loaded plugin ifupdown: (C) 2008 Canonical Ltd. To report bugs please use the NetworkManager mailing list. (/usr/lib/arm-linux-gnueabihf/NetworkManager/libnm-settings-plugin-ifupdown.so) Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3525] settings: loaded plugin keyfile: (c) 2007 - 2015 Red Hat, Inc. To report bugs please use the NetworkManager mailing list. Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3527] (30909152) ... get_connections. Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.3528] (30909152) connections count: 0 Apr 11 11:39:04 localhost NetworkManager[491]: <info> [1523439544.5797] keyfile: new connection /etc/NetworkManager/system-connections/ethernet-eth0 (c6b12eb9-c6cd-4937-b8cf-59efab1b6f35,"ethernet-eth0") Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.0603] keyfile: new connection /etc/NetworkManager/system-connections/GSMCon (5ab76ce5-300a-42c7-9d77-cd1488fa7e3a,"GSMCon") Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4002] settings: hostname: using hostnamed Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4006] settings: hostname changed from (none) to "lime2" Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4021] Using DHCP client 'dhclient' Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4023] manager: WiFi enabled by radio killswitch; enabled by state file Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4026] manager: WWAN enabled by radio killswitch; enabled by state file Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4028] manager: Networking is enabled by state file Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4033] Loaded device plugin: NMVxlanFactory (internal) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4035] Loaded device plugin: NMVlanFactory (internal) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4037] Loaded device plugin: NMVethFactory (internal) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4040] Loaded device plugin: NMTunFactory (internal) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4042] Loaded device plugin: NMMacvlanFactory (internal) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4044] Loaded device plugin: NMIPTunnelFactory (internal) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4046] Loaded device plugin: NMInfinibandFactory (internal) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4048] Loaded device plugin: NMEthernetFactory (internal) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4050] Loaded device plugin: NMBridgeFactory (internal) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.4052] Loaded device plugin: NMBondFactory (internal) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.5134] Loaded device plugin: NMWwanFactory (/usr/lib/arm-linux-gnueabihf/NetworkManager/libnm-device-plugin-wwan.so) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.6734] Loaded device plugin: NMAtmManager (/usr/lib/arm-linux-gnueabihf/NetworkManager/libnm-device-plugin-adsl.so) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.7438] Loaded device plugin: NMWifiFactory (/usr/lib/arm-linux-gnueabihf/NetworkManager/libnm-device-plugin-wifi.so) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.8610] Loaded device plugin: NMBluezManager (/usr/lib/arm-linux-gnueabihf/NetworkManager/libnm-device-plugin-bluetooth.so) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.8713] device (eth0): driver '(null)' does not support carrier detection. Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.8763] device (eth0): driver 'sunxi_gmac' does not support carrier detection. Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.8906] manager: (eth0): new Ethernet device (/org/freedesktop/NetworkManager/Devices/0) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.9090] device (eth0): state change: unmanaged -> unavailable (reason 'managed') [10 20 2] Apr 11 11:39:05 localhost NetworkManager[491]: nm_device_get_device_type: assertion 'NM_IS_DEVICE (self)' failed Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.9616] device (lo): link connected Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.9688] manager: (lo): new Generic device (/org/freedesktop/NetworkManager/Devices/1) Apr 11 11:39:05 localhost NetworkManager[491]: <info> [1523439545.9803] manager: (bond0): new Bond device (/org/freedesktop/NetworkManager/Devices/2) Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.0033] manager: startup complete Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.0933] urfkill disappeared from the bus Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.1036] device (eth0): state change: unavailable -> disconnected (reason 'none') [20 30 0] Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.1117] policy: auto-activating connection 'ethernet-eth0' Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.1316] device (eth0): Activation: starting connection 'ethernet-eth0' (c6b12eb9-c6cd-4937-b8cf-59efab1b6f35) Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.1345] ofono is now available Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.1414] ModemManager available in the bus Apr 11 11:39:06 localhost NetworkManager[491]: <warn> [1523439546.1418] failed to enumerate oFono devices: GDBus.Error:org.freedesktop.DBus.Error.ServiceUnknown: The name org.ofono was not provided by any .service files Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.1463] device (eth0): state change: disconnected -> prepare (reason 'none') [30 40 0] Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.1483] manager: NetworkManager state is now CONNECTING Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.1575] device (eth0): state change: prepare -> config (reason 'none') [40 50 0] Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.1632] device (eth0): state change: config -> ip-config (reason 'none') [50 70 0] Apr 11 11:39:06 localhost NetworkManager[491]: <info> [1523439546.1749] dhcp4 (eth0): activation: beginning transaction (timeout in 45 seconds) Apr 11 11:39:07 localhost NetworkManager[491]: <info> [1523439547.5063] dhcp4 (eth0): dhclient started with pid 605 Apr 11 11:39:13 localhost NetworkManager[491]: <info> [1523439553.8929] manager: WiFi hardware radio set enabled Apr 11 11:39:13 localhost NetworkManager[491]: <info> [1523439553.8932] manager: WWAN hardware radio set enabled Apr 11 11:39:41 localhost NetworkManager[491]: <info> [1523439581.2941] manager: (ttyUSB0): new Broadband device (/org/freedesktop/NetworkManager/Devices/3) Apr 11 11:39:41 localhost NetworkManager[491]: <info> [1523439581.2990] device (ttyUSB0): state change: unmanaged -> unavailable (reason 'managed') [10 20 2] Apr 11 11:39:41 localhost NetworkManager[491]: <info> [1523439581.3115] device (ttyUSB0): modem state 'enabling' Apr 11 11:39:42 localhost NetworkManager[491]: <info> [1523439582.2504] device (ttyUSB0): state change: unavailable -> disconnected (reason 'modem-available') [20 30 58] Apr 11 11:39:42 localhost NetworkManager[491]: <info> [1523439582.2629] policy: auto-activating connection 'GSMCon' Apr 11 11:39:42 localhost NetworkManager[491]: <info> [1523439582.2785] device (ttyUSB0): Activation: starting connection 'GSMCon' (5ab76ce5-300a-42c7-9d77-cd1488fa7e3a) Apr 11 11:39:42 localhost NetworkManager[491]: <info> [1523439582.2828] device (ttyUSB0): state change: disconnected -> prepare (reason 'none') [30 40 0] Apr 11 11:39:42 localhost NetworkManager[491]: <warn> [1523439582.8901] device (ttyUSB0): failed to look up interface index Apr 11 11:39:42 localhost NetworkManager[491]: <info> [1523439582.8919] device (ttyUSB0): state change: prepare -> config (reason 'none') [40 50 0] Apr 11 11:39:42 localhost NetworkManager[491]: <info> [1523439582.8953] device (ttyUSB0): state change: config -> ip-config (reason 'none') [50 70 0] Apr 11 11:39:42 localhost NetworkManager[491]: <warn> [1523439582.9008] device (ttyUSB0): interface ttyUSB1 not up for IP configuration Apr 11 11:39:42 localhost NetworkManager[491]: <info> [1523439582.9033] (ttyUSB0): using modem-specified IP timeout: 20 seconds Apr 11 11:39:42 localhost NetworkManager[491]: <info> [1523439582.9100] ppp-manager: starting PPP connection Apr 11 11:39:42 localhost NetworkManager[491]: <info> [1523439582.9189] ppp-manager: pppd started with pid 846 Apr 11 11:39:42 localhost NetworkManager[491]: Plugin /usr/lib/pppd/2.4.7/nm-pppd-plugin.so loaded. Apr 11 11:39:42 localhost NetworkManager[491]: nm-pppd-plugin-Message: nm-ppp-plugin: (plugin_init): initializing Apr 11 11:39:43 localhost NetworkManager[491]: nm-pppd-plugin-Message: nm-ppp-plugin: (nm_phasechange): status 3 / phase 'serial connection' Apr 11 11:39:43 localhost NetworkManager[491]: nm_device_get_device_type: assertion 'NM_IS_DEVICE (self)' failed Apr 11 11:39:43 localhost NetworkManager[491]: <info> [1523439583.0409] manager: (ppp0): new Generic device (/org/freedesktop/NetworkManager/Devices/4) Apr 11 11:39:43 localhost NetworkManager[491]: Using interface ppp0 Apr 11 11:39:43 localhost NetworkManager[491]: Connect: ppp0 <--> /dev/ttyUSB1 Apr 11 11:39:43 localhost NetworkManager[491]: nm-pppd-plugin-Message: nm-ppp-plugin: (nm_phasechange): status 5 / phase 'establish' Apr 11 11:39:43 localhost NetworkManager[491]: <info> [1523439583.1848] devices added (path: /sys/devices/virtual/net/ppp0, iface: ppp0) Apr 11 11:39:43 localhost NetworkManager[491]: <info> [1523439583.1850] device added (path: /sys/devices/virtual/net/ppp0, iface: ppp0): no ifupdown configuration found. Apr 11 11:39:43 localhost NetworkManager[491]: nm-pppd-plugin-Message: nm-ppp-plugin: (nm_phasechange): status 6 / phase 'authenticate' Apr 11 11:39:43 localhost NetworkManager[491]: nm-pppd-plugin-Message: nm-ppp-plugin: (get_credentials): passwd-hook, requesting credentials... Apr 11 11:39:43 localhost NetworkManager[491]: nm-pppd-plugin-Message: nm-ppp-plugin: (get_credentials): got credentials from NetworkManager Apr 11 11:39:43 localhost NetworkManager[491]: CHAP authentication succeeded: Welcome!! Apr 11 11:39:43 localhost NetworkManager[491]: CHAP authentication succeeded Apr 11 11:39:43 localhost NetworkManager[491]: nm-pppd-plugin-Message: nm-ppp-plugin: (nm_phasechange): status 8 / phase 'network' Apr 11 11:39:43 localhost NetworkManager[491]: Could not determine remote IP address: defaulting to 10.64.64.64 Apr 11 11:39:43 localhost NetworkManager[491]: local IP address 10.228.59.95 Apr 11 11:39:43 localhost NetworkManager[491]: remote IP address 10.64.64.64 Apr 11 11:39:43 localhost NetworkManager[491]: primary DNS address 172.20.2.39 Apr 11 11:39:43 localhost NetworkManager[491]: secondary DNS address 172.20.2.10 Apr 11 11:39:43 localhost NetworkManager[491]: nm-pppd-plugin-Message: nm-ppp-plugin: (nm_phasechange): status 9 / phase 'running' Apr 11 11:39:43 localhost NetworkManager[491]: nm-pppd-plugin-Message: nm-ppp-plugin: (nm_ip_up): ip-up event Apr 11 11:39:43 localhost NetworkManager[491]: nm-pppd-plugin-Message: nm-ppp-plugin: (nm_ip_up): sending IPv4 config to NetworkManager... Apr 11 11:39:43 localhost NetworkManager[491]: <info> [1523439583.5462] ppp-manager: (IPv4 Config Get) reply received. Apr 11 11:39:43 localhost NetworkManager[491]: <error> [1523439583.5820] platform-linux: do-add-ip4-address[6: 10.228.59.95/32,0.0.0.0]: failure 17 (File exists) Apr 11 11:39:43 localhost NetworkManager[491]: <info> [1523439583.5847] device (ttyUSB0): state change: ip-config -> ip-check (reason 'none') [70 80 0] Apr 11 11:39:43 localhost NetworkManager[491]: <info> [1523439583.5946] device (ttyUSB0): state change: ip-check -> secondaries (reason 'none') [80 90 0] Apr 11 11:39:43 localhost NetworkManager[491]: <info> [1523439583.6034] device (ttyUSB0): state change: secondaries -> activated (reason 'none') [90 100 0] Apr 11 11:39:43 localhost NetworkManager[491]: <info> [1523439583.6243] policy: set 'GSMCon' (ppp0) as default for IPv4 routing and DNS Apr 11 11:39:43 localhost NetworkManager[491]: <info> [1523439583.6252] dns-mgr: Writing DNS information to /sbin/resolvconf Apr 11 11:39:43 localhost NetworkManager[491]: <info> [1523439583.7840] device (ttyUSB0): Activation: successful, device activated. Apr 11 11:39:52 localhost NetworkManager[491]: <warn> [1523439592.8910] dhcp4 (eth0): request timed out Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.8913] dhcp4 (eth0): state changed unknown -> timeout Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9105] dhcp4 (eth0): canceled DHCP transaction, DHCP client pid 605 Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9107] dhcp4 (eth0): state changed timeout -> done Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9152] device (eth0): state change: ip-config -> failed (reason 'ip-config-unavailable') [70 120 5] Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9180] manager: NetworkManager state is now CONNECTED_GLOBAL Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9201] manager: NetworkManager state is now CONNECTED_SITE Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9204] manager: NetworkManager state is now CONNECTED_GLOBAL Apr 11 11:39:52 localhost NetworkManager[491]: <warn> [1523439592.9258] device (eth0): Activation: failed for connection 'ethernet-eth0' Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9436] device (eth0): state change: failed -> disconnected (reason 'none') [120 30 0] Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9759] policy: auto-activating connection 'ethernet-eth0' Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9865] device (eth0): Activation: starting connection 'ethernet-eth0' (c6b12eb9-c6cd-4937-b8cf-59efab1b6f35) Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9884] device (eth0): state change: disconnected -> prepare (reason 'none') [30 40 0] Apr 11 11:39:52 localhost NetworkManager[491]: <info> [1523439592.9950] device (eth0): state change: prepare -> config (reason 'none') [40 50 0] Apr 11 11:39:53 localhost NetworkManager[491]: <info> [1523439593.0488] device (eth0): state change: config -> ip-config (reason 'none') [50 70 0] Apr 11 11:39:53 localhost NetworkManager[491]: <info> [1523439593.0546] dhcp4 (eth0): activation: beginning transaction (timeout in 45 seconds) Apr 11 11:39:53 localhost NetworkManager[491]: <info> [1523439593.0637] dhcp4 (eth0): dhclient started with pid 965 Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6136] address 192.168.1.95 Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6139] plen 24 (255.255.255.0) Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6140] gateway 192.168.1.1 Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6141] server identifier 192.168.1.1 Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6142] lease time 86400 Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6144] nameserver '192.168.1.1' Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6145] domain name 'home' Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6146] dhcp4 (eth0): state changed unknown -> bound Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6320] device (eth0): state change: ip-config -> ip-check (reason 'none') [70 80 0] Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6440] device (eth0): state change: ip-check -> secondaries (reason 'none') [80 90 0] Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6517] device (eth0): state change: secondaries -> activated (reason 'none') [90 100 0] Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6670] manager: NetworkManager state is now CONNECTED_LOCAL Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6691] manager: NetworkManager state is now CONNECTED_GLOBAL Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6712] policy: set 'ethernet-eth0' (eth0) as default for IPv4 routing and DNS Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.6800] dns-mgr: Writing DNS information to /sbin/resolvconf Apr 11 11:39:56 localhost NetworkManager[491]: <info> [1523439596.8263] device (eth0): Activation: successful, device activated.
Recommended Posts