INFO: task syz.0.59:6469 blocked for more than 143 seconds.
Not tainted 6.16.0-rc4-syzkaller #0
"echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
task:syz.0.59 state:D stack:28904 pid:6469 tgid:6422 ppid:5820 task_flags:0x400040 flags:0x00004006
Call Trace:
context_switch kernel/sched/core.c:5396 [inline]
__schedule+0x16a2/0x4cb0 kernel/sched/core.c:6785
__schedule_loop kernel/sched/core.c:6863 [inline]
schedule+0x165/0x360 kernel/sched/core.c:6878
schedule_preempt_disabled+0x13/0x30 kernel/sched/core.c:6935
rwsem_down_write_slowpath+0xbec/0x1030 kernel/locking/rwsem.c:1176
__down_write_common kernel/locking/rwsem.c:1304 [inline]
__down_write kernel/locking/rwsem.c:1313 [inline]
down_write_nested+0x1b5/0x200 kernel/locking/rwsem.c:1694
inode_lock_nested include/linux/fs.h:914 [inline]
lock_rename fs/namei.c:3281 [inline]
do_renameat2+0x3dd/0xc50 fs/namei.c:5232
__do_sys_rename fs/namei.c:5333 [inline]
__se_sys_rename fs/namei.c:5331 [inline]
__x64_sys_rename+0x82/0x90 fs/namei.c:5331
do_syscall_x64 arch/x86/entry/syscall_64.c:63 [inline]
do_syscall_64+0xfa/0x3b0 arch/x86/entry/syscall_64.c:94
entry_SYSCALL_64_after_hwframe+0x77/0x7f
RIP: 0033:0x7f315ad8e929
RSP: 002b:00007f315bc95038 EFLAGS: 00000246 ORIG_RAX: 0000000000000052
RAX: ffffffffffffffda RBX: 00007f315afb6160 RCX: 00007f315ad8e929
RDX: 0000000000000000 RSI: 0000200000000000 RDI: 00002000000001c0
RBP: 00007f315ae10b39 R08: 0000000000000000 R09: 0000000000000000
R10: 0000000000000000 R11: 0000000000000246 R12: 0000000000000000
R13: 0000000000000001 R14: 00007f315afb6160 R15: 00007ffefe838988
Showing all locks held in the system:
1 lock held by pool_workqueue_/3:
#0: ffff8880b8639e18 (&rq->__lock){-.-.}-{2:2}, at: raw_spin_rq_lock_nested+0x2a/0x140 kernel/sched/core.c:606
1 lock held by khungtaskd/31:
#0: ffffffff8e13ee20 (rcu_read_lock){....}-{1:3}, at: rcu_lock_acquire include/linux/rcupdate.h:331 [inline]
#0: ffffffff8e13ee20 (rcu_read_lock){....}-{1:3}, at: rcu_read_lock include/linux/rcupdate.h:841 [inline]
#0: ffffffff8e13ee20 (rcu_read_lock){....}-{1:3}, at: debug_show_all_locks+0x2e/0x180 kernel/locking/lockdep.c:6770
2 locks held by getty/5582:
#0: ffff8880358a20a0 (&tty->ldisc_sem){++++}-{0:0}, at: tty_ldisc_ref_wait+0x25/0x70 drivers/tty/tty_ldisc.c:243
#1: ffffc9000332b2f0 (&ldata->atomic_read_lock){+.+.}-{4:4}, at: n_tty_read+0x43e/0x1400 drivers/tty/n_tty.c:2222
3 locks held by syz-executor/6268:
5 locks held by syz.0.59/6424:
#0: ffff888053130428 (sb_writers#25){.+.+}-{0:0}, at: mnt_want_write+0x41/0x90 fs/namespace.c:557
#1: ffff8880574d9fa8 (&sb->s_type->i_mutex_key#29/1){+.+.}-{4:4}, at: inode_lock_nested include/linux/fs.h:914 [inline]
#1: ffff8880574d9fa8 (&sb->s_type->i_mutex_key#29/1){+.+.}-{4:4}, at: filename_create+0x1f9/0x470 fs/namei.c:4148
#2: ffff8880574da390 (&inode->ei_update_lock){+.+.}-{4:4}, at: __bch2_create+0x2f2/0xb90 fs/bcachefs/fs.c:567
#3: ffff888055484398 (&c->btree_trans_barrier){.+.+}-{0:0}, at: srcu_lock_acquire include/linux/srcu.h:161 [inline]
#3: ffff888055484398 (&c->btree_trans_barrier){.+.+}-{0:0}, at: srcu_read_lock include/linux/srcu.h:253 [inline]
#3: ffff888055484398 (&c->btree_trans_barrier){.+.+}-{0:0}, at: bch2_trans_srcu_lock+0xaf/0x220 fs/bcachefs/btree_iter.c:3299
#4: ffff8880554a6710 (&c->gc_lock){.+.+}-{4:4}, at: bch2_btree_update_start+0x542/0x1de0 fs/bcachefs/btree_update_interior.c:1211
2 locks held by syz.0.59/6469:
#0: ffff888053130428 (sb_writers#25){.+.+}-{0:0}, at: mnt_want_write+0x41/0x90 fs/namespace.c:557
#1: ffff8880574d9fa8 (&sb->s_type->i_mutex_key#29/1){+.+.}-{4:4}, at: inode_lock_nested include/linux/fs.h:914 [inline]
#1: ffff8880574d9fa8 (&sb->s_type->i_mutex_key#29/1){+.+.}-{4:4}, at: lock_rename fs/namei.c:3281 [inline]
#1: ffff8880574d9fa8 (&sb->s_type->i_mutex_key#29/1){+.+.}-{4:4}, at: do_renameat2+0x3dd/0xc50 fs/namei.c:5232
1 lock held by dhcpcd/8355:
#0: ffff8880775fb808 (&sb->s_type->i_mutex_key#10){+.+.}-{4:4}, at: inode_lock include/linux/fs.h:869 [inline]
#0: ffff8880775fb808 (&sb->s_type->i_mutex_key#10){+.+.}-{4:4}, at: __sock_release net/socket.c:646 [inline]
#0: ffff8880775fb808 (&sb->s_type->i_mutex_key#10){+.+.}-{4:4}, at: sock_close+0x9b/0x240 net/socket.c:1391
1 lock held by syz.3.291/8949:
#0: ffffffff8e144938 (rcu_state.exp_mutex){+.+.}-{4:4}, at: exp_funnel_lock kernel/rcu/tree_exp.h:336 [inline]
#0: ffffffff8e144938 (rcu_state.exp_mutex){+.+.}-{4:4}, at: synchronize_rcu_expedited+0x3b9/0x730 kernel/rcu/tree_exp.h:998
2 locks held by rm/9027:
=============================================
NMI backtrace for cpu 0
CPU: 0 UID: 0 PID: 31 Comm: khungtaskd Not tainted 6.16.0-rc4-syzkaller #0 PREEMPT(full)
Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 05/07/2025
Call Trace:
dump_stack_lvl+0x189/0x250 lib/dump_stack.c:120
nmi_cpu_backtrace+0x39e/0x3d0 lib/nmi_backtrace.c:113
nmi_trigger_cpumask_backtrace+0x17a/0x300 lib/nmi_backtrace.c:62
trigger_all_cpu_backtrace include/linux/nmi.h:158 [inline]
check_hung_uninterruptible_tasks kernel/hung_task.c:307 [inline]
watchdog+0xfee/0x1030 kernel/hung_task.c:470
kthread+0x711/0x8a0 kernel/kthread.c:464
ret_from_fork+0x3fc/0x770 arch/x86/kernel/process.c:148
ret_from_fork_asm+0x1a/0x30 arch/x86/entry/entry_64.S:245
Sending NMI from CPU 0 to CPUs 1:
NMI backtrace for cpu 1
CPU: 1 UID: 0 PID: 5827 Comm: kworker/u9:3 Not tainted 6.16.0-rc4-syzkaller #0 PREEMPT(full)
Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 05/07/2025
Workqueue: hci6 hci_cmd_timeout
RIP: 0010:format_decode+0x174/0xe30 lib/vsprintf.c:2633
Code: e8 48 c1 e8 03 48 ba 00 00 00 00 00 fc ff df 0f b6 04 10 84 c0 75 59 45 0f b6 6d 00 41 0f b6 04 16 84 c0 75 69 48 8b 44 24 08 <44> 08 28 49 89 c5 b8 f6 d7 00 00 48 0f a3 d8 72 75 e8 f6 45 64 f6
RSP: 0018:ffffc900044bef30 EFLAGS: 00000246
RAX: ffffc900044befd8 RBX: 0000000000000010 RCX: 000000008cb84b00
RDX: dffffc0000000000 RSI: 0000000000000010 RDI: 0000000000000011
RBP: ffffffff8b8b81a7 R08: ffff888027c1da00 R09: 0000000000000002
R10: 0000000000000025 R11: 0000000000000000 R12: 1ffffffff1717034
R13: 0000000000000010 R14: 1ffff92000897dfb R15: ffffffff8b8b81a7
FS: 0000000000000000(0000) GS:ffff888125d84000(0000) knlGS:0000000000000000
CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033
CR2: 00007f44324f5ff8 CR3: 00000000335d2000 CR4: 00000000003526f0
Call Trace:
vsnprintf+0x102/0xf00 lib/vsprintf.c:2817
sprintf+0xd9/0x120 lib/vsprintf.c:3037
print_time kernel/printk/printk.c:1381 [inline]
info_print_prefix+0x155/0x310 kernel/printk/printk.c:1407
record_print_text+0x154/0x430 kernel/printk/printk.c:1456
printk_get_next_message+0x26d/0x7b0 kernel/printk/printk.c:3024
console_emit_next_record kernel/printk/printk.c:3092 [inline]
console_flush_all+0x4ca/0xc40 kernel/printk/printk.c:3226
__console_flush_and_unlock kernel/printk/printk.c:3285 [inline]
console_unlock+0xc4/0x270 kernel/printk/printk.c:3325
vprintk_emit+0x5b7/0x7a0 kernel/printk/printk.c:2450
_printk+0xcf/0x120 kernel/printk/printk.c:2475
bt_err+0x10b/0x160 net/bluetooth/lib.c:296
hci_cmd_timeout+0xff/0x1e0 net/bluetooth/hci_core.c:1475
process_one_work kernel/workqueue.c:3238 [inline]
process_scheduled_works+0xae1/0x17b0 kernel/workqueue.c:3321
worker_thread+0x8a0/0xda0 kernel/workqueue.c:3402
kthread+0x711/0x8a0 kernel/kthread.c:464
ret_from_fork+0x3fc/0x770 arch/x86/kernel/process.c:148
ret_from_fork_asm+0x1a/0x30 arch/x86/entry/entry_64.S:245