Flood of hub_ext_port_status failed (err = -71) messages

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

 



I have a 5-port USB 2.0 hub attached to a USB 3.0 host by a long length
of Cat 5e cable (via a pair of cheap USB<->Cat5e adapters from eBay)
that only works at full speed and doesn't stay connected all the time.

This wouldn't be a problem except that the kernel can get stuck in a
loop with the "URB transfer length is wrong, xHC issue?" error.

The message "hub_ext_port_status failed (err = -71)" in particular can
occur 70+ times for every instance of this error. There's no guarantee
that it will ever disconnect the device and stop doing this, it has
previously suddenly started generating 30MB/minute of log messages for
30 minutes until I unplugged the device.

Would it be ok to rate limit both of these messages to reduce the impact
of poor connections?

2016-06-17T09:56:09.219+01:00 <warning> kernel: xhci_hcd 0000:00:14.0: URB transfer length is wrong, xHC issue? req. len = 4, act. len = 4294967292
2016-06-17T09:56:09.219+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = 0)
2016-06-17T09:56:09.219+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.219+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.219+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.219+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.219+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.220+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.223+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.224+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.224+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.224+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.224+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:09.224+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)

2016-06-17T09:56:09.224+01:00 <info> kernel: usb 1-13: USB disconnect, device number 46
2016-06-17T09:56:09.224+01:00 <err> kernel: hub 1-13:1.0: activate --> -19
2016-06-17T09:56:09.499+01:00 <info> kernel: usb 1-13: new full-speed USB device number 47 using xhci_hcd
2016-06-17T09:56:09.795+01:00 <info> kernel: usb 1-13: new full-speed USB device number 48 using xhci_hcd
2016-06-17T09:56:09.920+01:00 <err> kernel: usb 1-13: device descriptor read/all, error -71
2016-06-17T09:56:10.223+01:00 <info> kernel: usb 1-13: new full-speed USB device number 50 using xhci_hcd
2016-06-17T09:56:10.351+01:00 <err> kernel: usb 1-13: device descriptor read/all, error -71
2016-06-17T09:56:10.463+01:00 <info> kernel: usb 1-13: new full-speed USB device number 51 using xhci_hcd
2016-06-17T09:56:10.595+01:00 <info> kernel: usb 1-13: not running at top speed; connect to a high speed hub
2016-06-17T09:56:10.599+01:00 <info> kernel: usb 1-13: New USB device found, idVendor=0835, idProduct=8500
2016-06-17T09:56:10.599+01:00 <info> kernel: usb 1-13: New USB device strings: Mfr=1, Product=2, SerialNumber=0
2016-06-17T09:56:10.599+01:00 <info> kernel: usb 1-13: Product: USB2.0 Hub
2016-06-17T09:56:10.600+01:00 <info> kernel: usb 1-13: Manufacturer: Action Star
2016-06-17T09:56:10.600+01:00 <warning> kernel: usb 1-13: ep 0x81 - rounding interval to 1024 microframes, ep desc says 2040 microframes
2016-06-17T09:56:10.600+01:00 <info> kernel: hub 1-13:1.0: USB hub found
2016-06-17T09:56:10.600+01:00 <info> kernel: hub 1-13:1.0: 5 ports detected
2016-06-17T09:56:10.703+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:10.704+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:10.704+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:10.704+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:10.704+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:10.704+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:10.704+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:10.705+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:10.705+01:00 <info> kernel: usb 1-13: USB disconnect, device number 51
2016-06-17T09:56:10.705+01:00 <err> kernel: hub 1-13:1.0: hub_ext_port_status failed (err = -71)
2016-06-17T09:56:10.705+01:00 <err> kernel: hub 1-13:1.0: activate --> -19
2016-06-17T09:56:10.979+01:00 <info> kernel: usb 1-13: new full-speed USB device number 52 using xhci_hcd
2016-06-17T09:56:11.107+01:00 <info> kernel: usb 1-13: not running at top speed; connect to a high speed hub
2016-06-17T09:56:11.107+01:00 <info> kernel: usb 1-13: New USB device found, idVendor=0835, idProduct=8500
2016-06-17T09:56:11.108+01:00 <info> kernel: usb 1-13: New USB device strings: Mfr=1, Product=2, SerialNumber=0
2016-06-17T09:56:11.108+01:00 <info> kernel: usb 1-13: Product: USB2.0 Hub
2016-06-17T09:56:11.108+01:00 <info> kernel: usb 1-13: Manufacturer: Action Star
2016-06-17T09:56:11.108+01:00 <warning> kernel: usb 1-13: ep 0x81 - rounding interval to 1024 microframes, ep desc says 2040 microframes
2016-06-17T09:56:11.108+01:00 <info> kernel: hub 1-13:1.0: USB hub found
2016-06-17T09:56:11.109+01:00 <info> kernel: hub 1-13:1.0: 5 ports detected
2016-06-17T09:56:11.387+01:00 <info> kernel: usb 1-13.1: new full-speed USB device number 53 using xhci_hcd
2016-06-17T09:56:11.475+01:00 <info> kernel: usb 1-13.1: not running at top speed; connect to a high speed hub
2016-06-17T09:56:11.479+01:00 <info> kernel: usb 1-13.1: New USB device found, idVendor=0835, idProduct=8501
2016-06-17T09:56:11.479+01:00 <info> kernel: usb 1-13.1: New USB device strings: Mfr=1, Product=2, SerialNumber=0
2016-06-17T09:56:11.479+01:00 <info> kernel: usb 1-13.1: Product: USB HID
2016-06-17T09:56:11.480+01:00 <info> kernel: usb 1-13.1: Manufacturer: Action Star
2016-06-17T09:56:11.483+01:00 <info> kernel: hid-generic 0003:0835:8501.000D: hiddev0,hidraw0: USB HID v1.11 Device [Action Star USB HID] on usb-0000:00:14.0-13.1/input0
2016-06-17T09:56:11.555+01:00 <info> kernel: usb 1-13.5: new full-speed USB device number 54 using xhci_hcd
2016-06-17T09:56:13.095+01:00 <info> kernel: usb 1-13.5: not running at top speed; connect to a high speed hub
2016-06-17T09:56:13.099+01:00 <info> kernel: usb 1-13.5: New USB device found, idVendor=0835, idProduct=8500
2016-06-17T09:56:13.099+01:00 <info> kernel: usb 1-13.5: New USB device strings: Mfr=1, Product=2, SerialNumber=0
2016-06-17T09:56:13.099+01:00 <info> kernel: usb 1-13.5: Product: USB2.0 Hub
2016-06-17T09:56:13.099+01:00 <info> kernel: usb 1-13.5: Manufacturer: Action Star
2016-06-17T09:56:13.099+01:00 <warning> kernel: usb 1-13.5: ep 0x81 - rounding interval to 1024 microframes, ep desc says 2040 microframes
2016-06-17T09:56:13.099+01:00 <info> kernel: hub 1-13.5:1.0: USB hub found
2016-06-17T09:56:13.099+01:00 <info> kernel: hub 1-13.5:1.0: 5 ports detected
2016-06-17T09:56:13.375+01:00 <info> kernel: usb 1-13.5.1: new full-speed USB device number 55 using xhci_hcd
2016-06-17T09:56:13.463+01:00 <info> kernel: usb 1-13.5.1: not running at top speed; connect to a high speed hub
2016-06-17T09:56:13.467+01:00 <info> kernel: usb 1-13.5.1: New USB device found, idVendor=0835, idProduct=8502
2016-06-17T09:56:13.467+01:00 <info> kernel: usb 1-13.5.1: New USB device strings: Mfr=1, Product=2, SerialNumber=0
2016-06-17T09:56:13.468+01:00 <info> kernel: usb 1-13.5.1: Product: USB HID
2016-06-17T09:56:13.468+01:00 <info> kernel: usb 1-13.5.1: Manufacturer: Action Star
2016-06-17T09:56:13.471+01:00 <info> kernel: hid-generic 0003:0835:8502.000E: hiddev0,hidraw3: USB HID v1.11 Device [Action Star USB HID] on usb-0000:00:14.0-13.5.1/input0

-- 
Simon Arlott
--
To unsubscribe from this list: send the line "unsubscribe linux-usb" in
the body of a message to majordomo@xxxxxxxxxxxxxxx
More majordomo info at  http://vger.kernel.org/majordomo-info.html



[Index of Archives]     [Linux Media]     [Linux Input]     [Linux Audio Users]     [Yosemite News]     [Linux Kernel]     [Linux SCSI]     [Old Linux USB Devel Archive]

  Powered by Linux