Usb0 link is going down once in a while (LTE)

Installing and Using OpenWrt Network and Wireless Configuration
1

I've successfully installed a snapshot of OpenWRT 23.05 on my Tozed S12 Pro (https://openwrt.org/toh/hwdata/tozed/tozed_s12_pro). Overall, it's running smoothly, but I'm encountering periodic LTE connection drops, typically occurring between 6 to 15 hours.

Protocol: Connected via NCM (QMI not supported)
Connection status: 3ginfo-lite says I'm connected and have signals. But my internet is not working (the data indication light goes off on the router).

When soft rebooting or restarting the network interface via Luci, It says "Network device is not present". But If I hard reboot it (turning it off and on), I'm connected to the internet, but it disconnects automatically after 6-15 hours.

System Log (after the internet goes down)

Thu Feb  8 12:00:44 2024 daemon.notice netifd: Network device 'usb0' link is down
Thu Feb  8 12:00:44 2024 daemon.notice netifd: Network alias 'usb0' link is down
Thu Feb  8 12:00:44 2024 daemon.notice netifd: Interface 'wwan_4' has link connectivity loss
Thu Feb  8 12:00:44 2024 daemon.notice netifd: Interface 'wwan_6' has link connectivity loss
Thu Feb  8 12:00:44 2024 daemon.notice netifd: wwan_4 (5375): udhcpc: received SIGTERM
Thu Feb  8 12:00:44 2024 daemon.notice netifd: wwan_4 (5375): udhcpc: unicasting a release of 100.125.255.200 to 100.125.255.193
Thu Feb  8 12:00:44 2024 daemon.notice netifd: wwan_4 (5375): udhcpc: sending release
Thu Feb  8 12:00:44 2024 daemon.notice netifd: wwan_4 (5375): udhcpc: entering released state
Thu Feb  8 12:00:44 2024 daemon.notice netifd: Interface 'wwan_6' is now down
Thu Feb  8 12:00:44 2024 daemon.notice netifd: wwan_4 (5375): Command failed: ubus call network.interface notify_proto { "action": 0, "link-up": false, "keep": false, "interface": "wwan_4" } (Permission denied)
Thu Feb  8 12:00:44 2024 daemon.notice netifd: Interface 'wwan_4' is now down
Thu Feb  8 12:00:44 2024 daemon.notice netifd: Interface 'wwan_4' is disabled
Thu Feb  8 12:00:45 2024 user.notice mwan3-hotplug[22893]: mwan3 hotplug on wwan_6 not called because interface disabled
Thu Feb  8 12:00:45 2024 daemon.warn odhcpd[2877]: No default route present, overriding ra_lifetime!

Kernal Log (after the internet goes down)

[14876.102566] mt7530-mdio mdio-bus:1f lan1: Link is Down
[14876.108302] br-lan: port 2(lan1) entered disabled state
[14879.369828] mt7530-mdio mdio-bus:1f lan1: Link is Up - 10Mbps/Full - flow control off
[14879.377893] br-lan: port 2(lan1) entered blocking state
[14879.383174] br-lan: port 2(lan1) entered forwarding state
[15525.435436] mt7530-mdio mdio-bus:1f lan1: Link is Down
[15525.441174] br-lan: port 2(lan1) entered disabled state
[15529.124225] mt7530-mdio mdio-bus:1f lan1: Link is Up - 1Gbps/Full - flow control rx/tx
[15529.132270] br-lan: port 2(lan1) entered blocking state
[15529.137491] br-lan: port 2(lan1) entered forwarding state

The USB device (built-in)

T:  Bus=01 Lev=01 Prnt=01 Port=00 Cnt=01 Dev#=  2 Spd=480  MxCh= 0
D:  Ver= 2.00 Cls=00(>ifc ) Sub=00 Prot=00 MxPS=64 #Cfgs=  1
P:  Vendor=1782 ProdID=4055 Rev= 4.04
S:  Manufacturer=Unisoc Phone
S:  Product=Unisoc Phone
S:  SerialNumber=8934622G16284
C:* #Ifs=14 Cfg#= 1 Atr=c0 MxPwr=500mA
A:  FirstIf#= 0 IfCount= 2 Cls=02(comm.) Sub=0d Prot=00
A:  FirstIf#= 2 IfCount= 2 Cls=02(comm.) Sub=0d Prot=00
A:  FirstIf#= 4 IfCount= 2 Cls=02(comm.) Sub=0d Prot=00
A:  FirstIf#= 6 IfCount= 2 Cls=02(comm.) Sub=0d Prot=00
I:* If#= 0 Alt= 0 #EPs= 1 Cls=02(comm.) Sub=0d Prot=00 Driver=cdc_ncm
E:  Ad=82(I) Atr=03(Int.) MxPS=  16 Ivl=32ms
I:  If#= 1 Alt= 0 #EPs= 0 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
I:* If#= 1 Alt= 1 #EPs= 2 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
E:  Ad=81(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=01(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#= 2 Alt= 0 #EPs= 1 Cls=02(comm.) Sub=0d Prot=00 Driver=cdc_ncm
E:  Ad=84(I) Atr=03(Int.) MxPS=  16 Ivl=32ms
I:  If#= 3 Alt= 0 #EPs= 0 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
I:* If#= 3 Alt= 1 #EPs= 2 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
E:  Ad=83(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=02(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#= 4 Alt= 0 #EPs= 1 Cls=02(comm.) Sub=0d Prot=00 Driver=cdc_ncm
E:  Ad=86(I) Atr=03(Int.) MxPS=  16 Ivl=32ms
I:  If#= 5 Alt= 0 #EPs= 0 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
I:* If#= 5 Alt= 1 #EPs= 2 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
E:  Ad=85(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=03(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#= 6 Alt= 0 #EPs= 1 Cls=02(comm.) Sub=0d Prot=00 Driver=cdc_ncm
E:  Ad=88(I) Atr=03(Int.) MxPS=  16 Ivl=32ms
I:  If#= 7 Alt= 0 #EPs= 0 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
I:* If#= 7 Alt= 1 #EPs= 2 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
E:  Ad=87(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=04(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#= 8 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=00 Prot=00 Driver=option
E:  Ad=89(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=05(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#= 9 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=00 Prot=00 Driver=option
E:  Ad=8a(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=06(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#=10 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=00 Prot=00 Driver=option
E:  Ad=8b(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=07(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#=11 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=00 Prot=00 Driver=option
E:  Ad=8c(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=08(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#=12 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=42 Prot=01 Driver=(none)
E:  Ad=09(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=8d(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#=13 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=00 Prot=00 Driver=option
E:  Ad=8e(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=0a(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
2

Is the USB dongle in, exactly, the same USB port it was first identified on?

Sorry. Link shows 1 USB port.

Sounds like insufficient power on the USB bus.
What is the power requirement for the dongle?

3

The USB modem is built-in, but I have no idea about what model it is or the power requirements, Is there a way to find out the model or the power requirements?

Here is the full output of cat /sys/kernel/debug/usb/devices

T:  Bus=01 Lev=00 Prnt=00 Port=00 Cnt=00 Dev#=  1 Spd=480  MxCh= 2
B:  Alloc=  0/800 us ( 0%), #Int=  0, #Iso=  0
D:  Ver= 2.00 Cls=09(hub  ) Sub=00 Prot=01 MxPS=64 #Cfgs=  1
P:  Vendor=1d6b ProdID=0002 Rev= 5.15
S:  Manufacturer=Linux 5.15.114 xhci-hcd
S:  Product=xHCI Host Controller
S:  SerialNumber=1e1c0000.xhci
C:* #Ifs= 1 Cfg#= 1 Atr=e0 MxPwr=  0mA
I:* If#= 0 Alt= 0 #EPs= 1 Cls=09(hub  ) Sub=00 Prot=00 Driver=hub
E:  Ad=81(I) Atr=03(Int.) MxPS=   4 Ivl=256ms

T:  Bus=01 Lev=01 Prnt=01 Port=00 Cnt=01 Dev#=  2 Spd=480  MxCh= 0
D:  Ver= 2.00 Cls=00(>ifc ) Sub=00 Prot=00 MxPS=64 #Cfgs=  1
P:  Vendor=1782 ProdID=4055 Rev= 4.04
S:  Manufacturer=Unisoc Phone
S:  Product=Unisoc Phone
S:  SerialNumber=8934622G16284
C:* #Ifs=14 Cfg#= 1 Atr=c0 MxPwr=500mA
A:  FirstIf#= 0 IfCount= 2 Cls=02(comm.) Sub=0d Prot=00
A:  FirstIf#= 2 IfCount= 2 Cls=02(comm.) Sub=0d Prot=00
A:  FirstIf#= 4 IfCount= 2 Cls=02(comm.) Sub=0d Prot=00
A:  FirstIf#= 6 IfCount= 2 Cls=02(comm.) Sub=0d Prot=00
I:* If#= 0 Alt= 0 #EPs= 1 Cls=02(comm.) Sub=0d Prot=00 Driver=cdc_ncm
E:  Ad=82(I) Atr=03(Int.) MxPS=  16 Ivl=32ms
I:  If#= 1 Alt= 0 #EPs= 0 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
I:* If#= 1 Alt= 1 #EPs= 2 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
E:  Ad=81(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=01(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#= 2 Alt= 0 #EPs= 1 Cls=02(comm.) Sub=0d Prot=00 Driver=cdc_ncm
E:  Ad=84(I) Atr=03(Int.) MxPS=  16 Ivl=32ms
I:  If#= 3 Alt= 0 #EPs= 0 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
I:* If#= 3 Alt= 1 #EPs= 2 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
E:  Ad=83(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=02(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#= 4 Alt= 0 #EPs= 1 Cls=02(comm.) Sub=0d Prot=00 Driver=cdc_ncm
E:  Ad=86(I) Atr=03(Int.) MxPS=  16 Ivl=32ms
I:  If#= 5 Alt= 0 #EPs= 0 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
I:* If#= 5 Alt= 1 #EPs= 2 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
E:  Ad=85(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=03(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#= 6 Alt= 0 #EPs= 1 Cls=02(comm.) Sub=0d Prot=00 Driver=cdc_ncm
E:  Ad=88(I) Atr=03(Int.) MxPS=  16 Ivl=32ms
I:  If#= 7 Alt= 0 #EPs= 0 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
I:* If#= 7 Alt= 1 #EPs= 2 Cls=0a(data ) Sub=00 Prot=01 Driver=cdc_ncm
E:  Ad=87(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=04(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#= 8 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=00 Prot=00 Driver=option
E:  Ad=89(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=05(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#= 9 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=00 Prot=00 Driver=option
E:  Ad=8a(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=06(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#=10 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=00 Prot=00 Driver=option
E:  Ad=8b(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=07(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#=11 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=00 Prot=00 Driver=option
E:  Ad=8c(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=08(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#=12 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=42 Prot=01 Driver=(none)
E:  Ad=09(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=8d(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
I:* If#=13 Alt= 0 #EPs= 2 Cls=ff(vend.) Sub=00 Prot=00 Driver=option
E:  Ad=8e(I) Atr=02(Bulk) MxPS= 512 Ivl=0ms
E:  Ad=0a(O) Atr=02(Bulk) MxPS= 512 Ivl=0ms

T:  Bus=02 Lev=00 Prnt=00 Port=00 Cnt=00 Dev#=  1 Spd=5000 MxCh= 1
B:  Alloc=  0/800 us ( 0%), #Int=  0, #Iso=  0
D:  Ver= 3.00 Cls=09(hub  ) Sub=00 Prot=03 MxPS= 9 #Cfgs=  1
P:  Vendor=1d6b ProdID=0003 Rev= 5.15
S:  Manufacturer=Linux 5.15.114 xhci-hcd
S:  Product=xHCI Host Controller
S:  SerialNumber=1e1c0000.xhci
C:* #Ifs= 1 Cfg#= 1 Atr=e0 MxPwr=  0mA
I:* If#= 0 Alt= 0 #EPs= 1 Cls=09(hub  ) Sub=00 Prot=00 Driver=hub
E:  Ad=81(I) Atr=03(Int.) MxPS=   4 Ivl=256ms
4

Not expecting that. Out of ideas.

5

Have you tried with "usbreset"?

6

when the connection goes down, I try usbreset and it brings up the USB online again, now I have to restart the network interface again to connect to the internet.

Maybe I could automate the above, but there will be network downtime :frowning_face:

What could be the reason behind usb0 going down automatically?

7

Look back in the log farther then next time the connection stops. Is there a "USB Disconnect" before usb0 goes down? usb0 going down is one of the later steps in an LTE connection being lost. It occurs after the kernel driver has lost the modem so it finally shuts down the virtual port.

8

This one happened a few hours ago, take a look at the log timing, exactly at 12:48:01 it disconnects with no prior logs related to the usb0.

Fri Feb  9 11:14:27 2024 kern.info kernel: [27353.053860] mt7530-mdio mdio-bus:1f lan1: Link is Down
Fri Feb  9 11:14:27 2024 kern.info kernel: [27353.059563] br-lan: port 2(lan1) entered disabled state
Fri Feb  9 11:14:27 2024 daemon.notice netifd: Network device 'lan1' link is down
Fri Feb  9 11:14:29 2024 kern.info kernel: [27354.718382] mt7530-mdio mdio-bus:1f lan1: Link is Up - 10Mbps/Full - flow control off
Fri Feb  9 11:14:29 2024 kern.info kernel: [27354.726356] br-lan: port 2(lan1) entered blocking state
Fri Feb  9 11:14:29 2024 kern.info kernel: [27354.731576] br-lan: port 2(lan1) entered forwarding state
Fri Feb  9 11:14:29 2024 daemon.notice netifd: Network device 'lan1' link is up
Fri Feb  9 12:16:42 2024 daemon.err nlbwmon[7167]: Netlink receive failure: Object busy
Fri Feb  9 12:16:42 2024 daemon.err nlbwmon[7167]: Unable to dump conntrack: I/O error
Fri Feb  9 12:27:31 2024 kern.info kernel: [31737.831550] mt7530-mdio mdio-bus:1f lan1: Link is Down
Fri Feb  9 12:27:31 2024 kern.info kernel: [31737.838234] br-lan: port 2(lan1) entered disabled state
Fri Feb  9 12:27:31 2024 daemon.notice netifd: Network device 'lan1' link is down
Fri Feb  9 12:27:34 2024 kern.info kernel: [31740.276869] mt7530-mdio mdio-bus:1f lan1: Link is Up - 1Gbps/Full - flow control rx/tx
Fri Feb  9 12:27:34 2024 kern.info kernel: [31740.284915] br-lan: port 2(lan1) entered blocking state
Fri Feb  9 12:27:34 2024 kern.info kernel: [31740.290135] br-lan: port 2(lan1) entered forwarding state
Fri Feb  9 12:27:34 2024 daemon.notice netifd: Network device 'lan1' link is up
Fri Feb  9 12:48:01 2024 daemon.notice netifd: Network device 'usb0' link is down
Fri Feb  9 12:48:01 2024 daemon.notice netifd: Network alias 'usb0' link is down
Fri Feb  9 12:48:01 2024 daemon.notice netifd: Interface 'wwan_4' has link connectivity loss
Fri Feb  9 12:48:01 2024 daemon.notice netifd: Interface 'wwan_6' has link connectivity loss 
...

Then I logged into the router, reset the USB with usbreset along with a network interface restart, and this is the logs after I reset it

Fri Feb  9 12:48:46 2024 kern.info kernel: [33012.636939] cdc_ncm 1-1:1.0 usb0: unregister 'cdc_ncm' usb-1e1c0000.xhci-1, CDC NCM
Fri Feb  9 12:48:46 2024 kern.info kernel: [33012.838659] cdc_ncm 1-1:1.2 usb1: unregister 'cdc_ncm' usb-1e1c0000.xhci-1, CDC NCM
Fri Feb  9 12:48:47 2024 kern.info kernel: [33012.937846] cdc_ncm 1-1:1.4 usb2: unregister 'cdc_ncm' usb-1e1c0000.xhci-1, CDC NCM
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.038185] cdc_ncm 1-1:1.6 usb3: unregister 'cdc_ncm' usb-1e1c0000.xhci-1, CDC NCM
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.157856] option1 ttyUSB0: GSM modem (1-port) converter now disconnected from ttyUSB0
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.166591] option 1-1:1.8: device disconnected
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.171928] option1 ttyUSB1: GSM modem (1-port) converter now disconnected from ttyUSB1
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.180512] option 1-1:1.9: device disconnected
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.185774] option1 ttyUSB2: GSM modem (1-port) converter now disconnected from ttyUSB2
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.194442] option 1-1:1.10: device disconnected
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.199998] option1 ttyUSB3: GSM modem (1-port) converter now disconnected from ttyUSB3
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.208540] option 1-1:1.11: device disconnected
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.213912] option1 ttyUSB4: GSM modem (1-port) converter now disconnected from ttyUSB4
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.222467] option 1-1:1.13: device disconnected
Fri Feb  9 12:48:47 2024 kern.info kernel: [33013.377852] usb 1-1: reset high-speed USB device number 2 using xhci-mtk
Fri Feb  9 12:48:47 2024 daemon.notice netifd: wwan (30769): Control device not valid
Fri Feb  9 12:48:47 2024 daemon.notice netifd: Interface 'wwan' is now down
Fri Feb  9 12:48:48 2024 user.notice mwan3-hotplug[30768]: mwan3 hotplug on wwan not called because interface disabled
Fri Feb  9 12:48:48 2024 kern.info kernel: [33014.077099] usb 1-1: device firmware changed
Fri Feb  9 12:48:48 2024 kern.info kernel: [33014.082032] usb 1-1: USB disconnect, device number 2
Fri Feb  9 12:48:48 2024 kern.err kernel: [33014.091617] xhci-mtk 1e1c0000.xhci: drop_ep_quirk high-speed ep2in intr, mpkt:16, interval:9/32ms
Fri Feb  9 12:48:48 2024 kern.err kernel: [33014.100684] xhci-mtk 1e1c0000.xhci: drop_ep_quirk high-speed ep4in intr, mpkt:16, interval:9/32ms
Fri Feb  9 12:48:48 2024 kern.err kernel: [33014.109643] xhci-mtk 1e1c0000.xhci: drop_ep_quirk high-speed ep6in intr, mpkt:16, interval:9/32ms
Fri Feb  9 12:48:48 2024 kern.err kernel: [33014.118586] xhci-mtk 1e1c0000.xhci: drop_ep_quirk high-speed ep8in intr, mpkt:16, interval:9/32ms
Fri Feb  9 12:48:48 2024 daemon.warn odhcpd[2667]: No default route present, overriding ra_lifetime!
Fri Feb  9 12:48:48 2024 kern.info kernel: [33014.576447] usb 1-1: new high-speed USB device number 3 using xhci-mtk
Fri Feb  9 12:48:48 2024 kern.info kernel: [33014.798024] cdc_ncm 1-1:1.0: MAC-Address: ca:4a:e0:20:0b:13
Fri Feb  9 12:48:48 2024 kern.info kernel: [33014.805565] cdc_ncm 1-1:1.0 usb0: register 'cdc_ncm' at usb-1e1c0000.xhci-1, CDC NCM, ca:4a:e0:20:0b:13
Fri Feb  9 12:48:48 2024 kern.info kernel: [33014.837806] cdc_ncm 1-1:1.2: MAC-Address: ca:4a:e0:20:0b:13
Fri Feb  9 12:48:48 2024 kern.info kernel: [33014.845406] cdc_ncm 1-1:1.2 usb1: register 'cdc_ncm' at usb-1e1c0000.xhci-1, CDC NCM, ca:4a:e0:20:0b:13
Fri Feb  9 12:48:48 2024 kern.info kernel: [33014.877733] cdc_ncm 1-1:1.4: MAC-Address: ca:4a:e0:20:0b:13
Fri Feb  9 12:48:48 2024 kern.info kernel: [33014.885257] cdc_ncm 1-1:1.4 usb2: register 'cdc_ncm' at usb-1e1c0000.xhci-1, CDC NCM, ca:4a:e0:20:0b:13
Fri Feb  9 12:48:49 2024 kern.info kernel: [33014.917465] cdc_ncm 1-1:1.6: MAC-Address: ca:4a:e0:20:0b:13
Fri Feb  9 12:48:49 2024 kern.info kernel: [33014.925261] cdc_ncm 1-1:1.6 usb3: register 'cdc_ncm' at usb-1e1c0000.xhci-1, CDC NCM, ca:4a:e0:20:0b:13
Fri Feb  9 12:48:49 2024 kern.info kernel: [33014.941563] option 1-1:1.8: GSM modem (1-port) converter detected
Fri Feb  9 12:48:49 2024 kern.info kernel: [33014.948525] usb 1-1: GSM modem (1-port) converter now attached to ttyUSB0
Fri Feb  9 12:48:49 2024 kern.info kernel: [33014.957738] option 1-1:1.9: GSM modem (1-port) converter detected
Fri Feb  9 12:48:49 2024 kern.info kernel: [33014.964911] usb 1-1: GSM modem (1-port) converter now attached to ttyUSB1
Fri Feb  9 12:48:49 2024 kern.info kernel: [33014.973735] option 1-1:1.10: GSM modem (1-port) converter detected
Fri Feb  9 12:48:49 2024 kern.info kernel: [33014.980880] usb 1-1: GSM modem (1-port) converter now attached to ttyUSB2
Fri Feb  9 12:48:49 2024 kern.info kernel: [33014.990007] option 1-1:1.11: GSM modem (1-port) converter detected
Fri Feb  9 12:48:49 2024 kern.info kernel: [33014.997183] usb 1-1: GSM modem (1-port) converter now attached to ttyUSB3
Fri Feb  9 12:48:49 2024 kern.info kernel: [33015.010757] option 1-1:1.13: GSM modem (1-port) converter detected
Fri Feb  9 12:48:49 2024 kern.info kernel: [33015.018075] usb 1-1: GSM modem (1-port) converter now attached to ttyUSB4
Fri Feb  9 12:48:51 2024 daemon.notice netifd: Interface 'wwan' is setting up now
Fri Feb  9 12:48:53 2024 daemon.notice netifd: wwan (31487): WARNING: Variable '+cereg:' does not exist or is not an array/object
Fri Feb  9 12:48:53 2024 daemon.notice netifd: wwan (31487): Unsupported modem
Fri Feb  9 12:48:53 2024 daemon.notice netifd: wwan (31627): Stopping network wwan
Fri Feb  9 12:48:55 2024 daemon.notice netifd: wwan (31627): sending -> AT+SPTZCMD="Y29AGFdhbdvFafFVOPSJ1c2IafrghE="
Fri Feb  9 12:48:57 2024 daemon.notice netifd: wwan (31627): Error running AT-command
Fri Feb  9 12:48:57 2024 daemon.notice netifd: wwan (31627): Failed to disconnect
Fri Feb  9 12:48:57 2024 daemon.notice netifd: Interface 'wwan' is now down
Fri Feb  9 12:48:58 2024 user.notice mwan3-hotplug[31648]: mwan3 hotplug on wwan not called because interface disabled
Fri Feb  9 12:48:58 2024 daemon.warn odhcpd[2667]: No default route present, overriding ra_lifetime!
Fri Feb  9 12:49:02 2024 kern.info kernel: [33028.895933] cdc_ncm 1-1:1.0 usb0: unregister 'cdc_ncm' usb-1e1c0000.xhci-1, CDC NCM
Fri Feb  9 12:49:03 2024 kern.info kernel: [33028.968543] cdc_ncm 1-1:1.2 usb1: unregister 'cdc_ncm' usb-1e1c0000.xhci-1, CDC NCM
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.048814] cdc_ncm 1-1:1.4 usb2: unregister 'cdc_ncm' usb-1e1c0000.xhci-1, CDC NCM
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.099023] cdc_ncm 1-1:1.6 usb3: unregister 'cdc_ncm' usb-1e1c0000.xhci-1, CDC NCM
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.199504] option1 ttyUSB0: GSM modem (1-port) converter now disconnected from ttyUSB0
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.208291] option 1-1:1.8: device disconnected
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.213642] option1 ttyUSB1: GSM modem (1-port) converter now disconnected from ttyUSB1
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.222312] option 1-1:1.9: device disconnected
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.227755] option1 ttyUSB2: GSM modem (1-port) converter now disconnected from ttyUSB2
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.236441] option 1-1:1.10: device disconnected
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.242140] option1 ttyUSB3: GSM modem (1-port) converter now disconnected from ttyUSB3
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.250671] option 1-1:1.11: device disconnected
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.256128] option1 ttyUSB4: GSM modem (1-port) converter now disconnected from ttyUSB4
Fri Feb  9 12:49:03 2024 kern.info kernel: [33029.264657] option 1-1:1.13: device disconnected
Fri Feb  9 12:49:04 2024 kern.info kernel: [33029.938551] usb 1-1: reset high-speed USB device number 3 using xhci-mtk
Fri Feb  9 12:49:04 2024 kern.err kernel: [33030.117628] xhci-mtk 1e1c0000.xhci: drop_ep_quirk high-speed ep2in intr, mpkt:16, interval:9/32ms
Fri Feb  9 12:49:04 2024 kern.err kernel: [33030.126552] xhci-mtk 1e1c0000.xhci: drop_ep_quirk high-speed ep4in intr, mpkt:16, interval:9/32ms
Fri Feb  9 12:49:04 2024 kern.err kernel: [33030.135539] xhci-mtk 1e1c0000.xhci: drop_ep_quirk high-speed ep6in intr, mpkt:16, interval:9/32ms
Fri Feb  9 12:49:04 2024 kern.err kernel: [33030.144532] xhci-mtk 1e1c0000.xhci: drop_ep_quirk high-speed ep8in intr, mpkt:16, interval:9/32ms
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.178178] cdc_ncm 1-1:1.0: MAC-Address: ca:4a:e0:20:0b:13
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.185522] cdc_ncm 1-1:1.0 usb0: register 'cdc_ncm' at usb-1e1c0000.xhci-1, CDC NCM, ca:4a:e0:20:0b:13
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.218103] cdc_ncm 1-1:1.2: MAC-Address: ca:4a:e0:20:0b:13
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.225662] cdc_ncm 1-1:1.2 usb1: register 'cdc_ncm' at usb-1e1c0000.xhci-1, CDC NCM, ca:4a:e0:20:0b:13
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.258318] cdc_ncm 1-1:1.4: MAC-Address: ca:4a:e0:20:0b:13
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.265836] cdc_ncm 1-1:1.4 usb2: register 'cdc_ncm' at usb-1e1c0000.xhci-1, CDC NCM, ca:4a:e0:20:0b:13
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.298275] cdc_ncm 1-1:1.6: MAC-Address: ca:4a:e0:20:0b:13
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.305535] cdc_ncm 1-1:1.6 usb3: register 'cdc_ncm' at usb-1e1c0000.xhci-1, CDC NCM, ca:4a:e0:20:0b:13
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.316713] option 1-1:1.8: GSM modem (1-port) converter detected
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.323873] usb 1-1: GSM modem (1-port) converter now attached to ttyUSB0
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.332322] option 1-1:1.9: GSM modem (1-port) converter detected
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.339390] usb 1-1: GSM modem (1-port) converter now attached to ttyUSB1
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.347744] option 1-1:1.10: GSM modem (1-port) converter detected
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.354558] usb 1-1: GSM modem (1-port) converter now attached to ttyUSB2
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.363045] option 1-1:1.11: GSM modem (1-port) converter detected
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.370179] usb 1-1: GSM modem (1-port) converter now attached to ttyUSB3
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.378392] option 1-1:1.13: GSM modem (1-port) converter detected
Fri Feb  9 12:49:04 2024 kern.info kernel: [33030.385380] usb 1-1: GSM modem (1-port) converter now attached to ttyUSB4
Fri Feb  9 12:49:05 2024 daemon.notice netifd: Interface 'wwan' is setting up now
Fri Feb  9 12:49:08 2024 daemon.notice netifd: wwan (32327): sending -> AT+CFUN=1
Fri Feb  9 12:49:08 2024 daemon.notice netifd: wwan (32327): sending -> AT+CCED=2,8
Fri Feb  9 12:49:09 2024 daemon.notice netifd: wwan (32327): sending -> AT+SPTTYROUTER=1
Fri Feb  9 12:49:10 2024 daemon.notice netifd: wwan (32327): Configuring modem
Fri Feb  9 12:49:10 2024 daemon.notice netifd: wwan (32327): sending -> AT+CGDCONT=1,"IPV4V6"
Fri Feb  9 12:49:11 2024 daemon.notice netifd: wwan (32327): Starting network wwan
Fri Feb  9 12:49:11 2024 daemon.notice netifd: wwan (32327): Connecting modem
Fri Feb  9 12:49:12 2024 daemon.notice netifd: wwan (32327): sending -> AT+SPTZCMD="Y29AGFdhbdvFafFVOPSJ1c2IafrghE="
Fri Feb  9 12:49:15 2024 daemon.notice netifd: wwan (32327): Setting up usb0
Fri Feb  9 12:49:15 2024 daemon.notice netifd: Interface 'wwan' is now up
Fri Feb  9 12:49:15 2024 daemon.notice netifd: Network device 'usb0' link is up
Fri Feb  9 12:49:15 2024 daemon.notice netifd: Network alias 'usb0' link is up
Fri Feb  9 12:49:15 2024 kern.info kernel: [33041.568946] IPv6: ADDRCONF(NETDEV_CHANGE): usb0: link becomes ready
Fri Feb  9 12:49:15 2024 daemon.notice netifd: Interface 'wwan_4' is enabled
Fri Feb  9 12:49:15 2024 daemon.notice netifd: Interface 'wwan_4' has link connectivity
Fri Feb  9 12:49:15 2024 daemon.notice netifd: Interface 'wwan_4' is setting up now
Fri Feb  9 12:49:15 2024 daemon.notice netifd: Interface 'wwan_6' is enabled
Fri Feb  9 12:49:15 2024 daemon.notice netifd: Interface 'wwan_6' has link connectivity
Fri Feb  9 12:49:15 2024 daemon.notice netifd: Interface 'wwan_6' is setting up now
Fri Feb  9 12:49:16 2024 daemon.notice netifd: wwan_4 (32546): udhcpc: started, v1.36.1
Fri Feb  9 12:49:16 2024 daemon.err odhcp6c[32553]: Failed to send RS (Address not available)
Fri Feb  9 12:49:16 2024 daemon.notice netifd: wwan_4 (32546): udhcpc: broadcasting discover
Fri Feb  9 12:49:16 2024 daemon.notice netifd: wwan_4 (32546): udhcpc: broadcasting select for 10.131.128.134, server 10.131.128.133
Fri Feb  9 12:49:16 2024 daemon.notice netifd: wwan_4 (32546): udhcpc: lease of 10.131.128.134 obtained from 10.131.128.133, lease time 86400
Fri Feb  9 12:49:16 2024 daemon.warn odhcpd[2667]: No default route present, overriding ra_lifetime!
Fri Feb  9 12:49:16 2024 user.notice mwan3-hotplug[32469]: mwan3 hotplug on wwan not called because interface disabled
Fri Feb  9 12:49:16 2024 daemon.err odhcp6c[32553]: Failed to send SOLICIT message to ff02::1:2 (Address not available)
Fri Feb  9 12:49:16 2024 daemon.notice netifd: Interface 'wwan_4' is now up
Fri Feb  9 12:49:17 2024 user.notice firewall: Reloading firewall due to ifup of wwan (usb0)
Fri Feb  9 12:49:17 2024 daemon.warn odhcpd[2667]: No default route present, overriding ra_lifetime!
Fri Feb  9 12:49:19 2024 daemon.err uhttpd[3261]: [info] luci: accepted login on / for root from 192.168.1.138
Fri Feb  9 12:49:19 2024 user.notice nlbwmon: Reloading nlbwmon due to ifup of wwan (usb0)
Fri Feb  9 12:49:20 2024 daemon.err nlbwmon[754]: The netlink receive buffer size of 524288 bytes will be capped to 180224 bytes
Fri Feb  9 12:49:20 2024 daemon.err nlbwmon[754]: by the kernel. The net.core.rmem_max sysctl limit needs to be raised to
Fri Feb  9 12:49:20 2024 daemon.err nlbwmon[754]: at least 524288 in order to sucessfully set the desired receive buffer size!
Fri Feb  9 12:49:21 2024 user.notice mwan3-hotplug[747]: mwan3 hotplug on wwan_4 not called because interface disabled
Fri Feb  9 12:49:21 2024 user.notice firewall: Reloading firewall due to ifup of wwan_4 (usb0)
Fri Feb  9 12:49:23 2024 user.notice nlbwmon: Reloading nlbwmon due to ifup of wwan_4 (usb0)
Fri Feb  9 12:49:35 2024 daemon.notice netifd: Interface 'wwan_6' is now up
Fri Feb  9 12:49:36 2024 user.notice mwan3-hotplug[1435]: mwan3 hotplug on wwan_6 not called because interface disabled
Fri Feb  9 12:49:37 2024 user.notice firewall: Reloading firewall due to ifup of wwan_6 (usb0)
Fri Feb  9 12:49:39 2024 user.notice nlbwmon: Reloading nlbwmon due to ifup of wwan_6 (usb0)
Fri Feb  9 12:49:39 2024 daemon.err nlbwmon[1923]: The netlink receive buffer size of 524288 bytes will be capped to 180224 bytes
Fri Feb  9 12:49:39 2024 daemon.err nlbwmon[1923]: by the kernel. The net.core.rmem_max sysctl limit needs to be raised to
Fri Feb  9 12:49:39 2024 daemon.err nlbwmon[1923]: at least 524288 in order to sucessfully set the desired receive buffer size!
Fri Feb  9 12:50:00 2024 daemon.notice netifd: Interface 'wwan_4' is disabled
Fri Feb  9 12:50:00 2024 daemon.notice netifd: Interface 'wwan_6' is disabled
Fri Feb  9 12:50:00 2024 daemon.notice netifd: Network alias '' link is down
Fri Feb  9 12:50:00 2024 daemon.notice netifd: Interface 'wwan_4' has link connectivity loss
Fri Feb  9 12:50:00 2024 daemon.notice netifd: Interface 'wwan_6' has link connectivity loss
Fri Feb  9 12:50:00 2024 daemon.notice netifd: wwan_4 (32546): udhcpc: received SIGTERM
Fri Feb  9 12:50:00 2024 daemon.notice netifd: wwan_4 (32546): udhcpc: unicasting a release of 10.131.128.134 to 10.131.128.133
Fri Feb  9 12:50:00 2024 daemon.notice netifd: wwan_4 (32546): udhcpc: sending release
Fri Feb  9 12:50:00 2024 daemon.notice netifd: wwan_4 (32546): udhcpc: entering released state
Fri Feb  9 12:50:00 2024 daemon.notice netifd: wwan (2050): Stopping network wwan
Fri Feb  9 12:50:00 2024 daemon.notice netifd: Interface 'wwan_6' is now down
Fri Feb  9 12:50:00 2024 daemon.notice netifd: wwan_4 (32546): Command failed: ubus call network.interface notify_proto { "action": 0, "link-up": false, "keep": false, "interface": "wwan_4" } (Permission denied)
Fri Feb  9 12:50:00 2024 daemon.notice netifd: Interface 'wwan_4' is now down
Fri Feb  9 12:50:01 2024 user.notice mwan3-hotplug[2047]: mwan3 hotplug on wwan not called because interface disabled
Fri Feb  9 12:50:01 2024 daemon.notice netifd: wwan (2050): sending -> AT+SPTZCMD="Y29AGFdhbdvFafFVOPSJ1c2IafrghE="
Fri Feb  9 12:50:01 2024 daemon.warn odhcpd[2667]: No default route present, overriding ra_lifetime!
Fri Feb  9 12:50:04 2024 daemon.notice netifd: Network device 'usb0' link is down
Fri Feb  9 12:50:04 2024 daemon.notice netifd: wwan (2050): Command failed: ubus call network.interface notify_proto { "action": 0, "link-up": false, "keep": false, "interface": "wwan" } (Permission denied)
Fri Feb  9 12:50:04 2024 daemon.notice netifd: Interface 'wwan' is now down
Fri Feb  9 12:50:04 2024 daemon.notice netifd: Interface 'wwan' is setting up now
Fri Feb  9 12:50:04 2024 user.notice mwan3-hotplug[2589]: mwan3 hotplug on wwan not called because interface disabled
Fri Feb  9 12:50:05 2024 daemon.warn odhcpd[2667]: No default route present, overriding ra_lifetime!
Fri Feb  9 12:50:07 2024 daemon.notice netifd: wwan (2594): sending -> AT+CFUN=1
Fri Feb  9 12:50:07 2024 daemon.notice netifd: wwan (2594): sending -> AT+CCED=2,8
Fri Feb  9 12:50:08 2024 daemon.notice netifd: wwan (2594): sending -> AT+SPTTYROUTER=1
Fri Feb  9 12:50:09 2024 daemon.notice netifd: wwan (2594): Configuring modem
Fri Feb  9 12:50:09 2024 daemon.notice netifd: wwan (2594): sending -> AT+CGDCONT=1,"IPV4V6"
Fri Feb  9 12:50:10 2024 daemon.notice netifd: wwan (2594): Starting network wwan
Fri Feb  9 12:50:10 2024 daemon.notice netifd: wwan (2594): Connecting modem
Fri Feb  9 12:50:11 2024 daemon.notice netifd: wwan (2594): sending -> AT+SPTZCMD="Y29AGFdhbdvFafFVOPSJ1c2IafrghE="
Fri Feb  9 12:50:13 2024 daemon.notice netifd: wwan (2594): Setting up usb0
Fri Feb  9 12:50:13 2024 daemon.notice netifd: Interface 'wwan' is now up
Fri Feb  9 12:50:13 2024 daemon.notice netifd: Network device 'usb0' link is up
Fri Feb  9 12:50:13 2024 daemon.notice netifd: Network alias 'usb0' link is up
Fri Feb  9 12:50:13 2024 kern.info kernel: [33099.457004] IPv6: ADDRCONF(NETDEV_CHANGE): usb0: link becomes ready
Fri Feb  9 12:50:13 2024 daemon.notice netifd: Interface 'wwan_4' is enabled
Fri Feb  9 12:50:13 2024 daemon.notice netifd: Interface 'wwan_4' has link connectivity
Fri Feb  9 12:50:13 2024 daemon.notice netifd: Interface 'wwan_4' is setting up now
Fri Feb  9 12:50:13 2024 daemon.notice netifd: Interface 'wwan_6' is enabled
Fri Feb  9 12:50:13 2024 daemon.notice netifd: Interface 'wwan_6' has link connectivity
Fri Feb  9 12:50:13 2024 daemon.notice netifd: Interface 'wwan_6' is setting up now

Notice that at 12:50:13 usb0 came up.

9

Okay, after a ton of trial and error, I found out that the culprit is AdBlock.
If I have the AdBlock running for more than 10 hours the USB disconnects.

Moving this to a new topic since it's related to AdBlock now!
Check this topic.