Skip to content

Instantly share code, notes, and snippets.

@sorjef
Created March 18, 2016 10:17
Show Gist options
  • Save sorjef/d238dd713f49347a88a5 to your computer and use it in GitHub Desktop.
Save sorjef/d238dd713f49347a88a5 to your computer and use it in GitHub Desktop.
Leddar on Linux x86-64. Working
*************************************************
* Welcome to the LeddarC Demonstration Program! *
*************************************************
Main Menu
1. Connect
2. Connect to single USB sensor
3. List Sensors
4. Replay Record
5. Configure Recording
6. Quit
[timestamp] [threadID] facility level [function call] <message>
--------------------------------------------------------------------------------
[ 0.000019] [00000bce] libusbx: debug [libusb_init] created default context
[ 0.000081] [00000bce] libusbx: debug [libusb_init] libusbx v1.0.17.10830
[ 0.000133] [00000bce] libusbx: debug [find_usbfs_path] found usbfs at /dev/bus/usb
[ 0.000166] [00000bce] libusbx: debug [op_init] bulk continuation flag supported
[ 0.000180] [00000bce] libusbx: debug [op_init] zero length packet flag supported
[ 0.000203] [00000bce] libusbx: debug [op_init] sysfs can relate devices
[ 0.000215] [00000bce] libusbx: debug [op_init] sysfs has complete descriptors
[ 0.000464] [00000bcf] libusbx: debug [linux_udev_event_thread_main] udev event thread entering.
[ 0.000754] [00000bce] libusbx: debug [linux_get_device_address] getting address for device: usb1 detached: 0
[ 0.000777] [00000bce] libusbx: debug [linux_get_device_address] scan usb1
[ 0.000831] [00000bce] libusbx: debug [linux_get_device_address] bus=1 dev=1
[ 0.000847] [00000bce] libusbx: debug [linux_enumerate_device] busnum 1 devaddr 1 session_id 257
[ 0.000858] [00000bce] libusbx: debug [linux_enumerate_device] allocating new device for 1/1 (session 257)
[ 0.000966] [00000bce] libusbx: debug [linux_get_device_address] getting address for device: 1-1 detached: 0
[ 0.000982] [00000bce] libusbx: debug [linux_get_device_address] scan 1-1
[ 0.001026] [00000bce] libusbx: debug [linux_get_device_address] bus=1 dev=5
[ 0.001041] [00000bce] libusbx: debug [linux_enumerate_device] busnum 1 devaddr 5 session_id 261
[ 0.001052] [00000bce] libusbx: debug [linux_enumerate_device] allocating new device for 1/5 (session 261)
[ 0.001097] [00000bce] libusbx: debug [linux_get_parent_info] Dev 0x154d310 (1-1) has parent 0x154d250 (usb1) port 1
[ 0.001159] [00000bce] libusbx: debug [linux_get_device_address] getting address for device: usb2 detached: 0
[ 0.001174] [00000bce] libusbx: debug [linux_get_device_address] scan usb2
[ 0.001216] [00000bce] libusbx: debug [linux_get_device_address] bus=2 dev=1
[ 0.001231] [00000bce] libusbx: debug [linux_enumerate_device] busnum 2 devaddr 1 session_id 513
[ 0.001242] [00000bce] libusbx: debug [linux_enumerate_device] allocating new device for 2/1 (session 513)
[ 0.001323] [00000bce] libusbx: debug [usbi_add_pollfd] add fd 9 events 1
[ 0.001342] [00000bce] libusbx: debug [usbi_add_pollfd] add fd 11 events 1
[ 0.001356] [00000bce] libusbx: debug [usbi_io_init] using timerfd for timeouts
[ 0.001367] [00000bce] libusbx: debug [usbi_add_pollfd] add fd 13 events 1
[ 0.001382] [00000bce] libusbx: debug [libusb_get_device_list]
[ 0.001404] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.001415] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.001428] [00000bce] libusbx: debug [libusb_open] open 1.5
[ 0.001452] [00000bce] libusbx: debug [usbi_add_pollfd] add fd 14 events 4
[ 0.001475] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.001514] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.001527] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.002292] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.002327] [00000bce] libusbx: debug [reap_for_handle] urb type=2 status=0 transferred=232
[ 0.002340] [00000bce] libusbx: debug [handle_control_completion] handling completion status 0
[ 0.002406] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.002434] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x154dae8 has callback 0x7f78b56467f0
[ 0.002447] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=232
[ 0.002510] [00000bce] libusbx: debug [libusb_close]
[ 0.002537] [00000bce] libusbx: debug [usbi_remove_pollfd] remove fd 14
[ 0.002561] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.002579] [00000bce] libusbx: debug [libusb_get_device_list]
[ 0.002594] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.002622] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.002634] [00000bce] libusbx: debug [libusb_open] open 1.5
[ 0.002658] [00000bce] libusbx: debug [usbi_add_pollfd] add fd 14 events 4
[ 0.002675] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.002706] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.002723] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.003403] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.003442] [00000bce] libusbx: debug [reap_for_handle] urb type=2 status=0 transferred=232
[ 0.003455] [00000bce] libusbx: debug [handle_control_completion] handling completion status 0
[ 0.003467] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.003480] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x154dae8 has callback 0x7f78b56467f0
[ 0.003492] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=232
[ 0.003541] [00000bce] libusbx: debug [libusb_get_device_list]
[ 0.003579] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.003599] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.003609] [00000bce] libusbx: debug [libusb_open] open 1.5
[ 0.003634] [00000bce] libusbx: debug [usbi_add_pollfd] add fd 15 events 4
[ 0.003657] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.003780] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.003797] [00000bce] libusbx: debug [handle_events] poll() 5 fds with timeout in 60000ms
[ 0.006152] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.006192] [00000bce] libusbx: debug [reap_for_handle] urb type=2 status=0 transferred=232
[ 0.006205] [00000bce] libusbx: debug [handle_control_completion] handling completion status 0
[ 0.006216] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.006228] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x154dae8 has callback 0x7f78b56467f0
[ 0.006238] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=232
[ 0.006252] [00000bce] libusbx: debug [libusb_close]
[ 0.006276] [00000bce] libusbx: debug [usbi_remove_pollfd] remove fd 15
[ 0.006311] [00000bce] libusbx: debug [libusb_close]
[ 0.006323] [00000bce] libusbx: debug [usbi_remove_pollfd] remove fd 14
Found 1 sensors of type USB
0 : [ ??????????????? ]
[ 0.006406] [00000bce] libusbx: debug [libusb_get_device_list]
[ 0.006422] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.006433] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.006442] [00000bce] libusbx: debug [libusb_open] open 1.5
[ 0.006467] [00000bce] libusbx: debug [usbi_add_pollfd] add fd 14 events 4
[ 0.006490] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.006588] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.006613] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.007142] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.007173] [00000bce] libusbx: debug [reap_for_handle] urb type=2 status=0 transferred=232
[ 0.007183] [00000bce] libusbx: debug [handle_control_completion] handling completion status 0
[ 0.007193] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.007205] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x154d1c8 has callback 0x7f78b56467f0
[ 0.007209] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=232
[ 0.007209] [00000bce] libusbx: debug [libusb_get_device_list]
[ 0.007209] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.007209] [00000bce] libusbx: debug [libusb_get_device_descriptor]
[ 0.007209] [00000bce] libusbx: debug [libusb_open] open 1.5
[ 0.007209] [00000bce] libusbx: debug [usbi_add_pollfd] add fd 15 events 4
[ 0.007209] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.007209] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.007658] [00000bce] libusbx: debug [handle_events] poll() 5 fds with timeout in 60000ms
[ 0.008096] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.008155] [00000bce] libusbx: debug [reap_for_handle] urb type=2 status=0 transferred=232
[ 0.008165] [00000bce] libusbx: debug [handle_control_completion] handling completion status 0
[ 0.008175] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.008186] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x154d1c8 has callback 0x7f78b56467f0
[ 0.008195] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=232
[ 0.008208] [00000bce] libusbx: debug [libusb_close]
[ 0.008219] [00000bce] libusbx: debug [usbi_remove_pollfd] remove fd 15
[ 0.008429] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.008457] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 8
[ 0.008506] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.008517] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.008751] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.008770] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=8
[ 0.008781] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.008791] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.008800] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.008810] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155cd58 has callback 0x7f78b56467f0
[ 0.008819] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=8
[ 0.008834] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.008845] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.008874] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.008885] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.009153] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.009187] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=64
[ 0.009198] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.009208] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.009218] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.009228] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155cd58 has callback 0x7f78b56467f0
[ 0.009238] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=64
[ 0.009264] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.009278] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 176
[ 0.009304] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.009327] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.009684] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.009715] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=176
[ 0.009726] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.009736] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.009745] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.009756] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155cd58 has callback 0x7f78b56467f0
[ 0.009766] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=176
[ 0.009950] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.009982] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 50
[ 0.010007] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.010018] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.010266] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.010344] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=50
[ 0.010369] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.010407] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.010421] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.010438] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155ddd8 has callback 0x7f78b56467f0
[ 0.010454] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=50
[ 0.010474] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.010487] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.010514] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.010538] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.010752] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.010780] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=64
[ 0.010791] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.010802] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.010818] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.010829] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155ddd8 has callback 0x7f78b56467f0
[ 0.010841] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=64
[ 0.010859] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.010872] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 162
[ 0.010892] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.010903] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.011258] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.011288] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=162
[ 0.011300] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.011311] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.011321] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.011332] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155ddd8 has callback 0x7f78b56467f0
[ 0.011342] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=162
[ 0.011394] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.011407] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.011432] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.011444] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.011930] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.011951] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.011962] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.011972] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.011981] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.011992] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155eb08 has callback 0x7f78b56467f0
[ 0.012013] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.012034] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.012051] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.012071] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.012083] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.012293] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.012310] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.012343] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.012354] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.012364] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.012374] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.012384] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.012400] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.012411] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.012442] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.012454] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.012628] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.012654] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.012665] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.012674] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.012683] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.012693] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.012703] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.012715] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.012734] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.012755] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.012771] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.012975] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.013003] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.013014] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.013028] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.013041] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.013054] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.013063] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.013086] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.013099] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.013120] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.013130] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.013315] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.013333] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.013343] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.013360] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.013369] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.013380] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.013390] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.013402] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.013413] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.013433] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.013444] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.013769] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.013786] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.013795] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.013806] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.013823] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.013834] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.013843] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.013859] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.013873] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.013899] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.013910] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.014105] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.014122] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.014132] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.014141] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.014150] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.014161] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.014170] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.014183] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.014202] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.014226] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.014236] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.014462] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.014479] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.014488] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.014497] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.014507] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.014528] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.014537] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.014554] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.014565] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.014589] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.014611] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.014780] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.014806] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.014816] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.014828] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.014838] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.014849] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.014858] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.014871] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.014891] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.014921] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.014956] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.015091] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.015107] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.015118] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.015128] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.015137] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.015156] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.015165] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.015179] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.015196] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.015217] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.015233] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.015757] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.015773] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.015782] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.015792] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.015801] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.015811] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.015820] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.015835] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.015854] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.015876] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.015889] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.016377] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.016395] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.016404] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.016415] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.016433] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.016444] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.016454] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.016472] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.016484] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.016508] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.016519] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.016730] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.016758] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.016769] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.016782] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.016794] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.016809] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.016824] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.016839] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.016860] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.016882] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.016899] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.017391] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.017408] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.017417] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.017426] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.017435] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.017446] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.017465] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.017480] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.017493] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.017512] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.017524] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.017732] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.017757] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.017767] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.017776] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.017786] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.017797] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.017812] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.017853] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.017870] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.017895] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.017928] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.018466] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.018485] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.018496] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.018516] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.018528] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.018545] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.018555] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.018571] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.018588] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.018610] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.018621] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.019071] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.019089] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.019100] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.019110] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.019119] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.019130] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.019139] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.019152] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.019164] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.019182] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.019204] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.019429] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.019453] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.019491] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.019507] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.019529] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.019561] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.019611] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.019637] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.019650] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.019779] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.019818] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.019996] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.020038] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.020055] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.020074] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.020084] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.020095] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.020109] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.020125] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.020138] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.020164] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.020195] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.020596] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.020613] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.020624] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.020634] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.020673] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.020746] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.020790] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.020813] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.020831] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.020861] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.020878] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.021074] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.021095] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.021110] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.021119] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.021128] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.021140] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.021218] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.021243] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.021271] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.021299] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.021333] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.021634] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.021658] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.021670] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.021684] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.021696] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.021715] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.021725] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.021739] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.021751] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.021782] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.021799] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.022066] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.022089] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.022100] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.022110] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.022120] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.022129] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.022140] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.022153] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.022166] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.022197] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.022209] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.022422] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.022439] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.022457] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.022467] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.022477] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.022488] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.022497] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.022511] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.022522] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.022541] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.022561] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.022814] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.022832] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.022844] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.022859] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.022873] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.022890] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.022904] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.022930] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.022942] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.022961] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.022972] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.023425] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.023443] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.023462] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.023472] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.023483] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.023496] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.023506] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.023521] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.023542] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.023560] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.023571] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.023809] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.023833] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.023844] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.023856] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.023866] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.023885] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.023895] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.023916] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.023927] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.023948] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.023963] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.024198] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.024217] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.024229] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.024248] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.024258] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.024269] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.024278] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.024293] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.024311] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.024331] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.024383] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.024529] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.024546] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.024556] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.024565] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.024582] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.024593] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.024606] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.024619] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.024629] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.024647] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.024720] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.024989] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.025005] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.025016] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.025032] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.025042] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.025052] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.025066] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.025085] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.025106] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.025127] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.025145] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.025315] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.025338] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.025348] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.025357] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.025370] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.025382] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.025396] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.025411] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.025421] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.025440] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.025463] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.025629] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.025656] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.025666] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.025675] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.025684] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.025695] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.025704] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.025718] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.025737] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 17
[ 0.025756] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.025766] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.025935] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.025952] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=17
[ 0.025962] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.025972] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.025984] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.025996] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.026009] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=17
[ 0.026026] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.026048] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.026068] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.026084] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.026289] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.026339] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.026365] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.026406] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.026459] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.026498] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155dea8 has callback 0x7f78b56467f0
[ 0.026512] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
[ 0.026571] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.026583] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 8
[ 0.026613] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.026631] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.026780] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.026803] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=8
[ 0.026812] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.026823] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.026836] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.026850] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155ed18 has callback 0x7f78b56467f0
[ 0.026864] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=8
[ 0.026886] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.026898] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.026924] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.026940] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.027268] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.027286] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=64
[ 0.027298] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.027315] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.027324] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.027335] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155ed18 has callback 0x7f78b56467f0
[ 0.027344] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=64
[ 0.027357] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.027368] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 96
[ 0.027386] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.027397] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.027776] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.027793] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=96
[ 0.027804] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.027813] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.027825] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.027863] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155ed18 has callback 0x7f78b56467f0
[ 0.027876] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=96
[ 0.027910] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.027927] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 8
[ 0.027961] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.027975] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.028151] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.028170] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=8
[ 0.028180] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.028192] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.028203] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.028214] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155ef48 has callback 0x7f78b56467f0
[ 0.028224] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=8
[ 0.028238] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.028249] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.028292] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.028309] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.028606] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.028625] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=64
[ 0.028635] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.028646] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.028666] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.028678] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155ef48 has callback 0x7f78b56467f0
[ 0.028691] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=64
[ 0.028709] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.028720] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.028756] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.028806] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.028960] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.028976] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=28
[ 0.028996] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.029011] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.029020] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.029031] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155ef48 has callback 0x7f78b56467f0
[ 0.029043] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=28
[ 0.029076] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.029088] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 8
[ 0.029115] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.029127] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.029285] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.029304] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=8
[ 0.029318] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.029329] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.029342] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.029353] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155f038 has callback 0x7f78b56467f0
[ 0.029373] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=8
[ 0.029391] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.029402] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.029469] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.029481] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.030256] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.030289] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=64
[ 0.030301] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.030312] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.030323] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.030334] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155f038 has callback 0x7f78b56467f0
[ 0.030345] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=64
[ 0.030369] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.030382] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 951
[ 0.030413] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.030428] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.031810] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.031847] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=951
[ 0.031858] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.031869] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.031879] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.031891] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x155f038 has callback 0x7f78b56467f0
[ 0.031902] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=951
[ 0.031981] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.031997] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 18
[ 0.032047] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.032066] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.032651] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.032671] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=18
[ 0.032682] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.032701] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.032712] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.032725] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x1560ba8 has callback 0x7f78b56467f0
[ 0.032740] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=18
[ 0.032760] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 0.032787] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 0.032821] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 0.032842] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 0.033064] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 0.033083] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=25
[ 0.033103] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 0.033113] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 0.033127] [00000bce] libusbx: debug [disarm_timerfd]
[ 0.033165] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x1560ba8 has callback 0x7f78b56467f0
[ 0.033180] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=25
Address AF16001
Connected Menu
1. Read Data
2. Read Configuration
3. Change Configuration
4. Start Recording
5. Disconnect
1
Press a key to start reading data and press a key again to stop.
a[ 2.616175] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.616234] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 20
[ 2.616284] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.616300] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.616706] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 2.616748] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=20
[ 2.616762] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.616776] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.616790] [00000bce] libusbx: debug [disarm_timerfd]
[ 2.616806] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x15617d8 has callback 0x7f78b56467f0
[ 2.616820] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=20
[ 2.616838] [00000bce] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.616852] [00000bce] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 64
[ 2.616918] [00000bce] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.616953] [00000bce] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.617205] [00000bce] libusbx: debug [handle_events] poll() returned 1
[ 2.617239] [00000bce] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=16
[ 2.617258] [00000bce] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.617274] [00000bce] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.617305] [00000bce] libusbx: debug [disarm_timerfd]
[ 2.617362] [00000bce] libusbx: debug [usbi_handle_transfer_completion] transfer 0x15617d8 has callback 0x7f78b56467f0
[ 2.617379] [00000bce] libusbx: debug [sync_transfer_cb] actual_length=16
[ 2.617822] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.617855] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.617949] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.617988] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.618327] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.618366] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=8
[ 2.618380] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.618392] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.618404] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.618418] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009a58 has callback 0x7f78b56467f0
[ 2.618430] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=8
[ 2.618445] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.618457] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.618482] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.618508] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.623761] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.623828] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.623844] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.623858] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.623871] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.623889] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009a58 has callback 0x7f78b56467f0
[ 2.623907] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.623961] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.623978] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.624012] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.624027] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.625686] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.625718] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.625737] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.625752] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.625764] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.625791] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009a58 has callback 0x7f78b56467f0
[ 2.625805] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.92 3.46 3.47 3.57 3.52 3.52 3.49 3.43 3.26 3.34 3.48 3.53
[ 2.626144] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.626161] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.626390] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.626415] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.636009] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.636070] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.636083] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.636095] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.636108] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.636123] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.636135] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.636160] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.636173] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.636201] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.636215] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.636593] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.636679] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.636695] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.636707] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.636720] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.636735] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.636746] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.82 3.37 3.51 3.55 3.57 3.53 3.50 3.44 3.26 3.38 3.49 3.48
[ 2.636824] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.636845] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.636884] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.636906] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.648399] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.648461] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.648474] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.648487] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.648500] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.648506] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.648506] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.648506] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.648506] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.648506] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.648895] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.649193] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.649218] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.649230] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.649242] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.649254] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.649267] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.649279] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.97 3.37 3.56 3.58 3.56 3.51 3.49 3.45 3.25 3.37 3.50 3.53
[ 2.649368] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.649382] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.649479] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.649500] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.660508] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.660562] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.660573] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.660584] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.660595] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.660609] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.660620] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.660643] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.660655] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.660681] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.660693] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.661085] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.661111] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.661134] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.661145] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.661158] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.661170] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.661180] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.87 3.39 3.57 3.54 3.59 3.50 3.48 3.43 3.25 3.32 3.46 3.54
[ 2.661296] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.661360] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.661389] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.661406] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.672767] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.672833] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.672846] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.672858] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.672871] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.672886] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.672898] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.672922] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.672935] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.672963] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.672977] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.674580] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.674608] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.674633] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.674646] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.674657] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.674671] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.674682] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.94 3.41 3.58 3.56 3.55 3.54 3.48 3.44 3.27 3.33 3.51 3.57
[ 2.674748] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.674761] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.674789] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.674803] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.684882] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.684936] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.684951] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.684965] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.684979] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.684995] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.685007] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.685032] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.685047] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.685076] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.685091] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.685478] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.685520] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.685535] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.685547] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.685561] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.685576] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.685590] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.81 3.37 3.53 3.59 3.56 3.51 3.48 3.42 3.23 3.32 3.48 3.52
[ 2.685787] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.685809] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.685840] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.685855] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.697302] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.697369] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.697385] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.697400] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.697414] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.697431] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.697445] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.697473] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.697489] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.697523] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.697540] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.699017] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.699060] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.699073] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.699085] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.699097] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.699116] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.699132] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.95 3.37 3.52 3.54 3.58 3.53 3.49 3.43 3.24 3.33 3.51 3.54
[ 2.699212] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.699226] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.699254] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.699268] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.709388] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.709444] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.709456] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.709465] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.709476] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.709489] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.709498] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.709528] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.709540] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.709576] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.709588] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.710006] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.710031] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.710052] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.710063] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.710073] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.710084] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.710093] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.90 3.38 3.53 3.55 3.55 3.54 3.51 3.43 3.24 3.34 3.50 3.56
[ 2.710152] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.710172] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.710198] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.710210] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.721616] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.721683] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.721698] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.721711] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.721725] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.721742] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.721755] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.721783] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.721798] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.721829] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.721845] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.722292] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.722362] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.722387] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.722401] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.722414] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.722428] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.722441] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.80 3.39 3.52 3.60 3.58 3.52 3.47 3.44 3.28 3.36 3.46 3.54
[ 2.722576] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.722602] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.722636] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.722654] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.733923] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.733992] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.734007] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.734021] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.734035] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.734051] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.734067] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.734094] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.734109] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.734142] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.734158] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.734652] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.734716] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.734758] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.734781] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.734795] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.734811] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.734823] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.81 3.38 3.56 3.57 3.54 3.51 3.48 3.42 3.29 3.35 3.46 3.50
[ 2.734931] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.734965] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.735073] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.735162] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.746577] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.746634] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.746646] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.746657] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.746668] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.746682] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.746693] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.746715] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.746727] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.746753] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.746767] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.747807] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.747827] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.747837] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.747847] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.747866] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.747878] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.747887] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.85 3.37 3.49 3.52 3.56 3.53 3.47 3.43 3.27 3.32 3.48 3.52
[ 2.747942] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.747954] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.747977] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.747998] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.758239] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.758288] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.758303] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.758316] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.758329] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.758345] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.758358] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.758382] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.758397] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.758426] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.758444] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.758941] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.759009] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.759042] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.759055] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.759083] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.759101] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.759130] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.98 3.32 3.55 3.58 3.55 3.51 3.49 3.44 3.24 3.31 3.48 3.53
[ 2.759208] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.759252] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.759279] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.759296] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.770665] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.770732] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.770748] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.770762] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.770775] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.770793] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.770806] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.770833] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.770848] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.770880] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.770895] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.771333] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.771364] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.771382] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.771402] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.771415] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.771444] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.771458] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.87 3.39 3.56 3.52 3.55 3.53 3.48 3.44 3.25 3.32 3.48 3.51
[ 2.771529] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.771545] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.771575] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.771590] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.782700] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.782768] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.782783] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.782796] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.782810] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.782826] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.782839] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.782869] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.782883] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.782916] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.782934] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.783395] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.783425] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.783452] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.783466] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.783479] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.783537] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.783599] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.75 3.41 3.55 3.53 3.56 3.51 3.49 3.45 3.27 3.34 3.48 3.58
[ 2.783683] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.783697] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.783828] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.783848] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.795052] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.795126] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.795147] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.795167] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.795187] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.795211] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.795230] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.795264] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.795286] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.795331] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.795378] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.795944] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.795990] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.796021] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.796047] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.796067] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.796113] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.796138] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.83 3.48 3.52 3.55 3.55 3.51 3.49 3.42 3.27 3.36 3.49 3.52
[ 2.796315] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.796354] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.796404] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.796452] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.807514] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.807581] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.807595] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.807607] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.807620] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.807623] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.807623] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.807781] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.807796] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.807827] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.807842] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.808927] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.808956] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.808967] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.808980] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.808991] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.809015] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.809026] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
1.01 3.37 3.53 3.57 3.54 3.52 3.48 3.42 3.26 3.34 3.49 3.52
[ 2.809138] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.809205] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.809310] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.809338] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.819508] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.819555] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.819569] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.819583] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.819596] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.819612] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.819628] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.819649] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.819666] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.819710] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.819726] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.821243] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.821266] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.821276] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.821287] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.821298] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.821310] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.821320] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.85 3.45 3.56 3.57 3.56 3.52 3.48 3.43 3.27 3.35 3.50 3.54
[ 2.821382] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.821395] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.821420] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.821433] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.832223] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.832277] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.832289] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.832347] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.832389] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.832402] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.832412] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.832435] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.832447] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.832478] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.832500] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.832854] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.832874] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.832885] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.832905] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.832915] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.832926] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.832936] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.95 3.44 3.55 3.56 3.57 3.51 3.47 3.43 3.25 3.33 3.49 3.57
[ 2.833001] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.833013] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.833047] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.833059] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.844212] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.844280] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.844292] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.844303] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.844315] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.844329] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.844339] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.844362] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.844375] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.844402] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.844415] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.844967] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.845009] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.845021] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.845032] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.845045] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.845057] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.845067] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.79 3.38 3.54 3.55 3.56 3.54 3.48 3.42 3.24 3.31 3.47 3.53
[ 2.845132] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.845148] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.845181] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.845199] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.856309] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.856356] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.856370] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.856383] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.856397] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.856413] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.856426] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.856449] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.856463] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.856533] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.856630] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.856984] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.857013] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.857031] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.857043] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.857055] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.857080] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.857093] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.87 3.38 3.55 3.55 3.58 3.52 3.48 3.45 3.25 3.32 3.45 3.56
[ 2.857146] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.857160] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.857189] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.857210] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.868963] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.869031] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.869044] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.869056] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.869069] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.869085] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.869096] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.869128] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.869141] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.869174] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.869188] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.870301] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.870347] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.870360] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.870372] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.870384] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.870398] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.870409] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.86 3.38 3.58 3.58 3.56 3.54 3.47 3.44 3.26 3.33 3.46 3.51
[ 2.870476] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.870490] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.870523] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.870545] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.880819] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.880875] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.880890] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.880904] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.880917] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.880934] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.880948] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.880973] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.880988] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.881019] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.881035] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.882738] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.882778] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.882791] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.882802] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.882815] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.882830] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.882841] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.83 3.41 3.53 3.54 3.58 3.53 3.48 3.43 3.28 3.32 3.50 3.50
[ 2.882904] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.882918] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.882944] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.882957] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.892910] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.892968] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.892983] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.892996] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.893009] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.893026] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.893040] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.893065] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.893080] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.893110] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.893127] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.893607] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.893639] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.893653] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.893667] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.893692] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.893708] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.893721] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
1.02 3.40 3.51 3.54 3.56 3.53 3.48 3.42 3.24 3.33 3.48 3.53
[ 2.893860] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.893879] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.893960] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.893979] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.905063] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.905108] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.905122] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.905135] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.905149] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.905165] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.905178] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.905198] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.905213] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.905240] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.905270] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.905657] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.905696] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.905713] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.905735] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.905749] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.905764] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.905777] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.87 3.39 3.56 3.52 3.57 3.51 3.47 3.42 3.24 3.33 3.47 3.52
[ 2.905839] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.905855] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.905907] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.905928] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.917075] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.917133] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.917145] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.917155] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.917167] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.917181] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.917192] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.917216] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.917228] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.917255] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.917268] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.917653] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.917678] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.917700] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.917711] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.917721] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.917766] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.917786] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.91 3.44 3.56 3.58 3.57 3.50 3.47 3.44 3.24 3.32 3.50 3.54
[ 2.917909] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.917927] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.917962] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.917981] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.929308] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.929364] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.929379] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.929393] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.929406] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.929424] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.929438] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.929463] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.929478] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.929509] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.929525] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.930040] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.930095] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.930110] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.930124] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.930137] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.930165] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.930178] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.83 3.33 3.56 3.54 3.55 3.55 3.48 3.44 3.23 3.33 3.49 3.50
[ 2.930249] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.930265] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.930296] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.930312] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.941199] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.941266] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.941281] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.941295] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.941310] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.941325] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.941338] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.941366] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.941381] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.941412] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.941428] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.941865] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.941895] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.941912] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.941930] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.941943] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.941959] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.941974] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.85 3.40 3.57 3.55 3.55 3.50 3.47 3.44 3.25 3.37 3.51 3.54
[ 2.942071] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.942088] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.942121] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.942144] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.953412] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.953480] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.953497] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.953511] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.953524] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.953540] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.953553] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.953580] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.953596] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.953646] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.953663] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.955120] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.955162] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.955175] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.955187] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.955209] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.955223] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.955247] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
1.11 3.42 3.51 3.55 3.55 3.53 3.48 3.42 3.26 3.36 3.48 3.51
[ 2.955328] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.955345] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.955378] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.955396] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.965685] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.965738] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.965752] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.965766] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.965779] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.965796] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.965808] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.965832] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.965847] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.965877] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.965892] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.966355] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.966385] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.966399] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.966413] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.966428] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.966456] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.966470] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.85 3.34 3.55 3.54 3.55 3.48 3.48 3.47 3.25 3.34 3.50 3.54
[ 2.966531] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.966546] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.966582] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.966612] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.977888] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.977978] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.978033] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.978106] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.978123] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.978140] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.978153] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.978179] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.978194] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.978242] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.978257] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.978683] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.978708] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.978725] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.978740] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.978751] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.978765] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.978776] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.93 3.32 3.53 3.54 3.56 3.51 3.48 3.44 3.24 3.34 3.48 3.54
[ 2.978834] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.978847] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.978874] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.978888] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.989992] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.990030] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=456
[ 2.990042] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.990052] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.990063] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.990076] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.990087] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=456
[ 2.990105] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.990116] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.990140] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.990164] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
[ 2.990573] [00000bd0] libusbx: debug [handle_events] poll() returned 1
[ 2.990598] [00000bd0] libusbx: debug [reap_for_handle] urb type=3 status=0 transferred=80
[ 2.990611] [00000bd0] libusbx: debug [handle_bulk_completion] handling completion status 0 of bulk urb 1/1
[ 2.990627] [00000bd0] libusbx: debug [handle_bulk_completion] last URB in transfer --> complete!
[ 2.990642] [00000bd0] libusbx: debug [disarm_timerfd]
[ 2.990666] [00000bd0] libusbx: debug [usbi_handle_transfer_completion] transfer 0x7f78ac009b88 has callback 0x7f78b56467f0
[ 2.990677] [00000bd0] libusbx: debug [sync_transfer_cb] actual_length=80
0.79 3.40 3.59 3.60 3.55 3.51 3.48 3.43 3.26 3.37 3.49 3.54
[ 2.990729] [00000bd0] libusbx: debug [add_to_flying_list] arm timerfd for timeout in 1000ms (first in line)
[ 2.990742] [00000bd0] libusbx: debug [submit_bulk_transfer] need 1 urbs for new transfer with length 10000
[ 2.990766] [00000bd0] libusbx: debug [libusb_handle_events_timeout_completed] doing our own event handling
[ 2.990809] [00000bd0] libusbx: debug [handle_events] poll() 4 fds with timeout in 60000ms
Sign up for free to join this conversation on GitHub. Already have an account? Sign in to comment