Bluetooth: hci1 command 0x0406 tx timeout BUG: workqueue lockup - pool cpus=1 node=0 flags=0x0 nice=0 stuck for 174s! Showing busy workqueues and worker pools: workqueue events: flags=0x0 pwq 2: cpus=1 node=0 flags=0x0 nice=0 active=27/256 refcnt=28 in-flight: 3351:rtc_timer_do_work pending: defense_work_handler, defense_work_handler, defense_work_handler, defense_work_handler, cache_reap, macvlan_process_broadcast, nfc_urelease_event_work, nfc_urelease_event_work, nfc_urelease_event_work, macvlan_process_broadcast, pwq_unbound_release_workfn, nfc_urelease_event_work, nfc_urelease_event_work, nfc_urelease_event_work, macvlan_process_broadcast, macvlan_process_broadcast, macvlan_process_broadcast, macvlan_process_broadcast, nfc_urelease_event_work, nfc_urelease_event_work, nfc_urelease_event_work, hci_cmd_timeout, hci_cmd_timeout, hci_cmd_timeout, hci_cmd_timeout, hci_cmd_timeout pwq 0: cpus=0 node=0 flags=0x0 nice=0 active=1/256 refcnt=2 pending: defense_work_handler workqueue events_unbound: flags=0x2 pwq 4: cpus=0-1 flags=0x4 nice=0 active=4/512 refcnt=7 in-flight: 9316:fsnotify_mark_destroy_workfn fsnotify_mark_destroy_workfn, 9332:fsnotify_connector_destroy_workfn fsnotify_connector_destroy_workfn workqueue events_freezable: flags=0x4 pwq 2: cpus=1 node=0 flags=0x0 nice=0 active=1/256 refcnt=2 pending: update_balloon_stats_func workqueue events_power_efficient: flags=0x80 pwq 2: cpus=1 node=0 flags=0x0 nice=0 active=3/256 refcnt=4 pending: process_srcu, process_srcu, check_lifetime workqueue mm_percpu_wq: flags=0x8 pwq 2: cpus=1 node=0 flags=0x0 nice=0 active=1/256 refcnt=2 pending: vmstat_update workqueue dm_bufio_cache: flags=0x8 pwq 2: cpus=1 node=0 flags=0x0 nice=0 active=1/256 refcnt=2 pending: work_fn workqueue ipv6_addrconf: flags=0x40008 pwq 2: cpus=1 node=0 flags=0x0 nice=0 active=1/1 refcnt=2 pending: addrconf_verify_work workqueue bat_events: flags=0xe000a pwq 4: cpus=0-1 flags=0x4 nice=0 active=1/1 refcnt=11 pending: batadv_iv_send_outstanding_bat_ogm_packet delayed: batadv_iv_send_outstanding_bat_ogm_packet, batadv_nc_worker, batadv_nc_worker, batadv_nc_worker, batadv_nc_worker, batadv_nc_worker, batadv_nc_worker pool 2: cpus=1 node=0 flags=0x0 nice=0 hung=174s workers=5 idle: 8990 18 9179 23 pool 4: cpus=0-1 flags=0x4 nice=0 hung=0s workers=8 idle: 816 2965 22 5 8946 34 INFO: task kworker/u4:6:9316 blocked for more than 140 seconds. Not tainted 4.14.269-syzkaller #0 "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. kworker/u4:6 D29184 9316 2 0x80000000 Workqueue: events_unbound fsnotify_mark_destroy_workfn Call Trace: context_switch kernel/sched/core.c:2811 [inline] __schedule+0x88b/0x1de0 kernel/sched/core.c:3387 schedule+0x8d/0x1b0 kernel/sched/core.c:3431 schedule_timeout+0x80a/0xe90 kernel/time/timer.c:1724 do_wait_for_common kernel/sched/completion.c:91 [inline] __wait_for_common kernel/sched/completion.c:112 [inline] wait_for_common+0x272/0x430 kernel/sched/completion.c:123 __synchronize_srcu+0x10a/0x1d0 kernel/rcu/srcutree.c:898 fsnotify_mark_destroy_workfn+0xed/0x2e0 fs/notify/mark.c:757 process_one_work+0x793/0x14a0 kernel/workqueue.c:2117 worker_thread+0x5cc/0xff0 kernel/workqueue.c:2251 kthread+0x30d/0x420 kernel/kthread.c:232 ret_from_fork+0x24/0x30 arch/x86/entry/entry_64.S:404 INFO: task kworker/u4:7:9332 blocked for more than 140 seconds. Not tainted 4.14.269-syzkaller #0 "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. kworker/u4:7 D29296 9332 2 0x80000000 Workqueue: events_unbound fsnotify_connector_destroy_workfn Call Trace: context_switch kernel/sched/core.c:2811 [inline] __schedule+0x88b/0x1de0 kernel/sched/core.c:3387 schedule+0x8d/0x1b0 kernel/sched/core.c:3431 schedule_timeout+0x80a/0xe90 kernel/time/timer.c:1724 do_wait_for_common kernel/sched/completion.c:91 [inline] __wait_for_common kernel/sched/completion.c:112 [inline] wait_for_common+0x272/0x430 kernel/sched/completion.c:123 __synchronize_srcu+0x10a/0x1d0 kernel/rcu/srcutree.c:898 fsnotify_connector_destroy_workfn+0x49/0xa0 fs/notify/mark.c:156 process_one_work+0x793/0x14a0 kernel/workqueue.c:2117 worker_thread+0x5cc/0xff0 kernel/workqueue.c:2251 kthread+0x30d/0x420 kernel/kthread.c:232 ret_from_fork+0x24/0x30 arch/x86/entry/entry_64.S:404 INFO: task syz-executor.0:10681 blocked for more than 140 seconds. Not tainted 4.14.269-syzkaller #0 "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. syz-executor.0 D28264 10681 7994 0x00000004 Call Trace: context_switch kernel/sched/core.c:2811 [inline] __schedule+0x88b/0x1de0 kernel/sched/core.c:3387 schedule+0x8d/0x1b0 kernel/sched/core.c:3431 schedule_timeout+0x80a/0xe90 kernel/time/timer.c:1724 do_wait_for_common kernel/sched/completion.c:91 [inline] __wait_for_common kernel/sched/completion.c:112 [inline] wait_for_common+0x272/0x430 kernel/sched/completion.c:123 __synchronize_srcu+0x10a/0x1d0 kernel/rcu/srcutree.c:898 debugfs_remove_recursive fs/debugfs/inode.c:744 [inline] debugfs_remove_recursive+0x2e0/0x3b0 fs/debugfs/inode.c:686 kvm_destroy_vm_debugfs arch/x86/kvm/../../../virt/kvm/kvm_main.c:583 [inline] kvm_destroy_vm arch/x86/kvm/../../../virt/kvm/kvm_main.c:764 [inline] kvm_put_kvm+0xec/0xa90 arch/x86/kvm/../../../virt/kvm/kvm_main.c:806 kvm_vm_release+0x3f/0x50 arch/x86/kvm/../../../virt/kvm/kvm_main.c:817 __fput+0x25f/0x7a0 fs/file_table.c:210 task_work_run+0x11f/0x190 kernel/task_work.c:113 tracehook_notify_resume include/linux/tracehook.h:191 [inline] exit_to_usermode_loop+0x1ad/0x200 arch/x86/entry/common.c:164 prepare_exit_to_usermode arch/x86/entry/common.c:199 [inline] syscall_return_slowpath arch/x86/entry/common.c:270 [inline] do_syscall_64+0x4a3/0x640 arch/x86/entry/common.c:297 entry_SYSCALL_64_after_hwframe+0x46/0xbb RIP: 0033:0x7f7f34cf3c8b RSP: 002b:00007ffe150327b0 EFLAGS: 00000293 ORIG_RAX: 0000000000000003 RAX: 0000000000000000 RBX: 0000000000000005 RCX: 00007f7f34cf3c8b RDX: 00007f7f34e58408 RSI: ffffffffffffffff RDI: 0000000000000004 RBP: 00007f7f34e55960 R08: 0000000000000000 R09: 00007f7f34e58410 R10: 00007ffe150328b0 R11: 0000000000000293 R12: 000000000003ee3d R13: 00007ffe150328b0 R14: 00007f7f34e53f60 R15: 0000000000000032 Showing all locks held in the system: 1 lock held by khungtaskd/1533: #0: (tasklist_lock){.+.+}, at: [] debug_show_all_locks+0x7c/0x21a kernel/locking/lockdep.c:4548 2 locks held by kworker/u4:6/9316: #0: ("events_unbound"){+.+.}, at: [] process_one_work+0x6b0/0x14a0 kernel/workqueue.c:2088 #1: ((reaper_work).work){+.+.}, at: [] process_one_work+0x6e6/0x14a0 kernel/workqueue.c:2092 2 locks held by kworker/u4:7/9332: #0: ("events_unbound"){+.+.}, at: [] process_one_work+0x6b0/0x14a0 kernel/workqueue.c:2088 #1: (connector_reaper_work){+.+.}, at: [] process_one_work+0x6e6/0x14a0 kernel/workqueue.c:2092 ============================================= NMI backtrace for cpu 0 CPU: 0 PID: 1533 Comm: khungtaskd Not tainted 4.14.269-syzkaller #0 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 Call Trace: __dump_stack lib/dump_stack.c:17 [inline] dump_stack+0x1b2/0x281 lib/dump_stack.c:58 nmi_cpu_backtrace.cold+0x57/0x93 lib/nmi_backtrace.c:101 nmi_trigger_cpumask_backtrace+0x13a/0x180 lib/nmi_backtrace.c:62 trigger_all_cpu_backtrace include/linux/nmi.h:140 [inline] check_hung_uninterruptible_tasks kernel/hung_task.c:195 [inline] watchdog+0x5b9/0xb40 kernel/hung_task.c:274 kthread+0x30d/0x420 kernel/kthread.c:232 ret_from_fork+0x24/0x30 arch/x86/entry/entry_64.S:404 Sending NMI from CPU 0 to CPUs 1: NMI backtrace for cpu 1 CPU: 1 PID: 3351 Comm: kworker/1:2 Not tainted 4.14.269-syzkaller #0 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 Workqueue: events rtc_timer_do_work task: ffff8880aa654500 task.stack: ffff8880aa590000 RIP: 0010:__rb_erase_augmented include/linux/rbtree_augmented.h:172 [inline] RIP: 0010:rb_erase_cached+0x7b/0x13a0 lib/rbtree.c:477 RSP: 0018:ffff8880aa597b80 EFLAGS: 00000246 RAX: dffffc0000000000 RBX: ffff8880a8e8b378 RCX: 1ffff110151d166f RDX: 1ffff110151d1664 RSI: ffff8880a8e8b318 RDI: ffff8880a8e8b388 RBP: ffff8880a8e8b320 R08: ffff8880a8e8b2a0 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000000 R12: ffff8880a8e8b378 R13: 0000000000000000 R14: 0000000000000000 R15: ffff8880a8e8b318 FS: 0000000000000000(0000) GS:ffff8880ba500000(0000) knlGS:0000000000000000 CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 CR2: 000056168cd3d160 CR3: 0000000094330000 CR4: 00000000003426e0 DR0: 0000000000000000 DR1: 0000000000000000 DR2: 0000000000000000 DR3: 0000000000000000 DR6: 00000000fffe0ff0 DR7: 0000000000000400 Call Trace: timerqueue_del+0x39/0xa0 lib/timerqueue.c:78 rtc_timer_do_work+0x194/0x5a0 drivers/rtc/interface.c:878 process_one_work+0x793/0x14a0 kernel/workqueue.c:2117 worker_thread+0x5cc/0xff0 kernel/workqueue.c:2251 kthread+0x30d/0x420 kernel/kthread.c:232 ret_from_fork+0x24/0x30 arch/x86/entry/entry_64.S:404 Code: ea 03 80 3c 02 00 0f 85 be 0d 00 00 48 85 ed 4d 8b 6c 24 10 74 25 48 b8 00 00 00 00 00 fc ff df 48 89 ea 48 c1 ea 03 80 3c 02 00 <0f> 85 15 0f 00 00 4d 3b 67 08 0f 84 ac 07 00 00 4d 85 ed 0f 84 ---------------- Code disassembly (best guess), 1 bytes skipped: 0: 03 80 3c 02 00 0f add 0xf00023c(%rax),%eax 6: 85 be 0d 00 00 48 test %edi,0x4800000d(%rsi) c: 85 ed test %ebp,%ebp e: 4d 8b 6c 24 10 mov 0x10(%r12),%r13 13: 74 25 je 0x3a 15: 48 b8 00 00 00 00 00 movabs $0xdffffc0000000000,%rax 1c: fc ff df 1f: 48 89 ea mov %rbp,%rdx 22: 48 c1 ea 03 shr $0x3,%rdx 26: 80 3c 02 00 cmpb $0x0,(%rdx,%rax,1) * 2a: 0f 85 15 0f 00 00 jne 0xf45 <-- trapping instruction 30: 4d 3b 67 08 cmp 0x8(%r15),%r12 34: 0f 84 ac 07 00 00 je 0x7e6 3a: 4d 85 ed test %r13,%r13 3d: 0f .byte 0xf 3e: 84 .byte 0x84