INFO: task kworker/1:1H:52 blocked for more than 143 seconds. Not tainted 6.4.0-rc7-syzkaller-00204-g61dabacdad4e #0 "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. task:kworker/1:1H state:D stack:25456 pid:52 ppid:2 flags:0x00004000 Workqueue: xfs-log/loop3 xlog_ioend_work Call Trace: context_switch kernel/sched/core.c:5343 [inline] __schedule+0x187b/0x4900 kernel/sched/core.c:6669 schedule+0xc3/0x180 kernel/sched/core.c:6745 schedule_timeout+0xb0/0x310 kernel/time/timer.c:2143 ___down_common+0x33e/0x5e0 kernel/locking/semaphore.c:225 __down_common+0x64/0x250 kernel/locking/semaphore.c:246 down+0x84/0xc0 kernel/locking/semaphore.c:63 xfs_buf_lock+0x154/0x4b0 fs/xfs/xfs_buf.c:1119 xfs_buf_item_unpin+0x1cd/0x6c0 fs/xfs/xfs_buf_item.c:581 xfs_trans_committed_bulk+0x346/0x830 fs/xfs/xfs_trans.c:808 xlog_cil_committed+0x26d/0xe40 fs/xfs/xfs_log_cil.c:795 xlog_cil_process_committed+0x159/0x1a0 fs/xfs/xfs_log_cil.c:823 xlog_state_shutdown_callbacks+0x2ba/0x3b0 fs/xfs/xfs_log.c:538 xlog_force_shutdown+0x32c/0x390 fs/xfs/xfs_log.c:3837 xlog_ioend_work+0xad/0x100 fs/xfs/xfs_log.c:1429 process_one_work+0x8a0/0x10e0 kernel/workqueue.c:2408 worker_thread+0xa63/0x1210 kernel/workqueue.c:2555 kthread+0x2b8/0x350 kernel/kthread.c:379 ret_from_fork+0x1f/0x30 arch/x86/entry/entry_64.S:308 INFO: task syz-executor.3:15489 blocked for more than 144 seconds. Not tainted 6.4.0-rc7-syzkaller-00204-g61dabacdad4e #0 "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. task:syz-executor.3 state:D stack:23200 pid:15489 ppid:5031 flags:0x00004004 Call Trace: context_switch kernel/sched/core.c:5343 [inline] __schedule+0x187b/0x4900 kernel/sched/core.c:6669 schedule+0xc3/0x180 kernel/sched/core.c:6745 xlog_wait+0x16e/0x1e0 fs/xfs/xfs_log_priv.h:617 xlog_wait_on_iclog+0x307/0x4e0 fs/xfs/xfs_log.c:926 xfs_log_force_seq+0x1da/0x450 fs/xfs/xfs_log.c:3409 __xfs_trans_commit+0xb38/0x11d0 fs/xfs/xfs_trans.c:1021 xfs_sync_sb_buf+0x14f/0x1e0 fs/xfs/libxfs/xfs_sb.c:1112 xfs_ioc_setlabel fs/xfs/xfs_ioctl.c:1801 [inline] xfs_file_ioctl+0x1313/0x16a0 fs/xfs/xfs_ioctl.c:1899 vfs_ioctl fs/ioctl.c:51 [inline] __do_sys_ioctl fs/ioctl.c:870 [inline] __se_sys_ioctl+0xf1/0x160 fs/ioctl.c:856 do_syscall_x64 arch/x86/entry/common.c:50 [inline] do_syscall_64+0x41/0xc0 arch/x86/entry/common.c:80 entry_SYSCALL_64_after_hwframe+0x63/0xcd RIP: 0033:0x7fc19968c389 RSP: 002b:00007fc19a3c7168 EFLAGS: 00000246 ORIG_RAX: 0000000000000010 RAX: ffffffffffffffda RBX: 00007fc1997abf80 RCX: 00007fc19968c389 RDX: 0000000020000200 RSI: 0000000041009432 RDI: 0000000000000006 RBP: 00007fc1996d7493 R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000246 R12: 0000000000000000 R13: 00007fff4662afef R14: 00007fc19a3c7300 R15: 0000000000022000 Showing all locks held in the system: 1 lock held by rcu_tasks_kthre/13: #0: ffffffff8cf276f0 (rcu_tasks.tasks_gp_mutex){+.+.}-{3:3}, at: rcu_tasks_one_gp+0x29/0xd20 kernel/rcu/tasks.h:518 1 lock held by rcu_tasks_trace/14: #0: ffffffff8cf27ab0 (rcu_tasks_trace.tasks_gp_mutex){+.+.}-{3:3}, at: rcu_tasks_one_gp+0x29/0xd20 kernel/rcu/tasks.h:518 1 lock held by khungtaskd/28: #0: ffffffff8cf27520 (rcu_read_lock){....}-{1:2}, at: rcu_lock_acquire+0x0/0x30 2 locks held by kworker/u4:3/46: #0: ffff8880b993bf98 (&rq->__lock){-.-.}-{2:2}, at: raw_spin_rq_lock_nested+0x2a/0x140 kernel/sched/core.c:558 #1: ffff8880b99287c8 (&per_cpu_ptr(group->pcpu, cpu)->seq){-.-.}-{0:0}, at: psi_task_switch+0x441/0x770 kernel/sched/psi.c:996 2 locks held by kworker/1:1H/52: #0: ffff88802abfbd38 ((wq_completion)xfs-log/loop3){+.+.}-{0:0}, at: process_one_work+0x77e/0x10e0 kernel/workqueue.c:2381 #1: ffffc90000bd7d20 ((work_completion)(&iclog->ic_end_io_work)){+.+.}-{0:0}, at: process_one_work+0x7c8/0x10e0 kernel/workqueue.c:2383 1 lock held by klogd/4437: #0: ffff8880b993bf98 (&rq->__lock){-.-.}-{2:2}, at: raw_spin_rq_lock_nested+0x2a/0x140 kernel/sched/core.c:558 2 locks held by getty/4747: #0: ffff88802ce12098 (&tty->ldisc_sem){++++}-{0:0}, at: tty_ldisc_ref_wait+0x25/0x70 drivers/tty/tty_ldisc.c:243 #1: ffffc900015b02f0 (&ldata->atomic_read_lock){+.+.}-{3:3}, at: n_tty_read+0x6ab/0x1db0 drivers/tty/n_tty.c:2176 1 lock held by syz-executor.1/5028: #0: ffff88808ba460e0 (&type->s_umount_key#50){++++}-{3:3}, at: deactivate_super+0xad/0xf0 fs/super.c:361 1 lock held by syz-executor.4/5037: #0: ffff8880612bc0e0 (&type->s_umount_key#56){++++}-{3:3}, at: deactivate_super+0xad/0xf0 fs/super.c:361 2 locks held by syz-executor.2/5044: #0: ffff888141fd80e0 (&type->s_umount_key#56){++++}-{3:3}, at: deactivate_super+0xad/0xf0 fs/super.c:361 #1: ffffffff8cf2cbf8 (rcu_state.exp_mutex){+.+.}-{3:3}, at: exp_funnel_lock kernel/rcu/tree_exp.h:293 [inline] #1: ffffffff8cf2cbf8 (rcu_state.exp_mutex){+.+.}-{3:3}, at: synchronize_rcu_expedited+0x3a3/0x890 kernel/rcu/tree_exp.h:992 2 locks held by syz-executor.5/5050: #0: ffff88807ddf20e0 (&type->s_umount_key#54){++++}-{3:3}, at: deactivate_super+0xad/0xf0 fs/super.c:361 #1: ffffffff8cf2cbf8 (rcu_state.exp_mutex){+.+.}-{3:3}, at: exp_funnel_lock kernel/rcu/tree_exp.h:325 [inline] #1: ffffffff8cf2cbf8 (rcu_state.exp_mutex){+.+.}-{3:3}, at: synchronize_rcu_expedited+0x46c/0x890 kernel/rcu/tree_exp.h:992 2 locks held by kworker/1:8/5149: #0: ffff888012472538 ((wq_completion)rcu_gp){+.+.}-{0:0}, at: process_one_work+0x77e/0x10e0 kernel/workqueue.c:2381 #1: ffffc90004a8fd20 ((work_completion)(&rew->rew_work)){+.+.}-{0:0}, at: process_one_work+0x7c8/0x10e0 kernel/workqueue.c:2383 2 locks held by kworker/1:17/5736: #0: ffff888012470d38 ((wq_completion)events){+.+.}-{0:0}, at: process_one_work+0x77e/0x10e0 kernel/workqueue.c:2381 #1: ffffc9000bac7d20 ((work_completion)(&pwq->unbound_release_work)){+.+.}-{0:0}, at: process_one_work+0x7c8/0x10e0 kernel/workqueue.c:2383 1 lock held by syz-executor.3/15489: #0: ffff88804784a460 (sb_writers#18){.+.+}-{0:0}, at: mnt_want_write_file+0x5e/0x1f0 fs/namespace.c:438 2 locks held by syz-executor.3/16921: ============================================= NMI backtrace for cpu 0 CPU: 0 PID: 28 Comm: khungtaskd Not tainted 6.4.0-rc7-syzkaller-00204-g61dabacdad4e #0 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 05/27/2023 Call Trace: __dump_stack lib/dump_stack.c:88 [inline] dump_stack_lvl+0x1e7/0x2d0 lib/dump_stack.c:106 nmi_cpu_backtrace+0x498/0x4d0 lib/nmi_backtrace.c:113 nmi_trigger_cpumask_backtrace+0x187/0x300 lib/nmi_backtrace.c:62 trigger_all_cpu_backtrace include/linux/nmi.h:148 [inline] check_hung_uninterruptible_tasks kernel/hung_task.c:222 [inline] watchdog+0xec2/0xf00 kernel/hung_task.c:379 kthread+0x2b8/0x350 kernel/kthread.c:379 ret_from_fork+0x1f/0x30 arch/x86/entry/entry_64.S:308 Sending NMI from CPU 0 to CPUs 1: NMI backtrace for cpu 1 CPU: 1 PID: 16923 Comm: syz-executor.5 Not tainted 6.4.0-rc7-syzkaller-00204-g61dabacdad4e #0 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 05/27/2023 RIP: 0010:__kasan_check_read+0x0/0x20 mm/kasan/shadow.c:31 Code: 41 5c 41 5d 41 5e 41 5f 5d c3 48 c7 c7 88 53 84 8c 48 89 de eb 0a 48 c7 c7 c0 53 84 8c 4c 89 fe e8 65 b4 ca 08 31 db eb d4 90 0f 1e fa 89 f6 48 8b 0c 24 31 d2 e9 2f eb ff ff 66 2e 0f 1f 84 RSP: 0018:ffffc900001e0718 EFLAGS: 00000046 RAX: 0000000000000000 RBX: 0000000000000001 RCX: 1ffff9200003c104 RDX: 0000000000000000 RSI: 0000000000000008 RDI: ffffffff9032b260 RBP: ffffc900001e09d8 R08: dffffc0000000000 R09: fffffbfff206564d R10: 0000000000000000 R11: dffffc0000000001 R12: dffffc0000000000 R13: ffff88807e32e478 R14: ce71a310754e9cd2 R15: ffff88807e32e478 FS: 00007fd671188700(0000) GS:ffff8880b9900000(0000) knlGS:0000000000000000 CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 CR2: 00007fd671189000 CR3: 000000001674a000 CR4: 00000000003506e0 DR0: 0000000000000000 DR1: 0000000000000000 DR2: 0000000000000000 DR3: 0000000000000000 DR6: 00000000fffe0ff0 DR7: 0000000000000400 Call Trace: instrument_atomic_read include/linux/instrumented.h:68 [inline] _test_bit include/asm-generic/bitops/instrumented-non-atomic.h:141 [inline] hlock_class kernel/locking/lockdep.c:228 [inline] lookup_chain_cache_add kernel/locking/lockdep.c:3759 [inline] validate_chain+0x119/0x58f0 kernel/locking/lockdep.c:3815 __lock_acquire+0x1316/0x2070 kernel/locking/lockdep.c:5088 lock_acquire+0x1e3/0x520 kernel/locking/lockdep.c:5705 __raw_spin_lock_irqsave include/linux/spinlock_api_smp.h:110 [inline] _raw_spin_lock_irqsave+0xd5/0x120 kernel/locking/spinlock.c:162 debug_object_deactivate+0x65/0x420 lib/debugobjects.c:774 debug_hrtimer_deactivate kernel/time/hrtimer.c:425 [inline] debug_deactivate+0x1b/0x1f0 kernel/time/hrtimer.c:481 __run_hrtimer kernel/time/hrtimer.c:1653 [inline] __hrtimer_run_queues+0x321/0xd10 kernel/time/hrtimer.c:1749 hrtimer_interrupt+0x396/0x980 kernel/time/hrtimer.c:1811 local_apic_timer_interrupt arch/x86/kernel/apic/apic.c:1095 [inline] __sysvec_apic_timer_interrupt+0x13f/0x480 arch/x86/kernel/apic/apic.c:1112 sysvec_apic_timer_interrupt+0x90/0xb0 arch/x86/kernel/apic/apic.c:1106 asm_sysvec_apic_timer_interrupt+0x1a/0x20 arch/x86/include/asm/idtentry.h:645 RIP: 0010:console_trylock_spinning+0x3b8/0x460 Code: ed 0f 84 48 ff ff ff e8 f6 d2 1c 00 fb 31 db eb 45 e8 ec d2 1c 00 e8 27 9b 41 09 4d 85 ed 74 cd e8 dd d2 1c 00 fb f3 0f 1e fa 01 00 00 00 48 c7 c7 40 32 e0 8c 31 f6 ba 01 00 00 00 31 c9 41 RSP: 0018:ffffc9000558f6c0 EFLAGS: 00000246 RAX: ffffffff816eb213 RBX: 0000000000000000 RCX: 0000000000040000 RDX: ffffc90013174000 RSI: 000000000003ffff RDI: 0000000000040000 RBP: ffffc9000558f788 R08: ffffffff816eb1cc R09: fffffbfff2065660 R10: 0000000000000000 R11: dffffc0000000001 R12: 1ffff92000ab1ed8 R13: 0000000000000200 R14: 0000000000000046 R15: dffffc0000000000 vprintk_emit+0xbc/0x1f0 kernel/printk/printk.c:2306 _printk+0xd5/0x120 kernel/printk/printk.c:2328 reiserfs_info+0x113/0x160 fs/reiserfs/prints.c:303 read_super_block+0x6af/0x800 fs/reiserfs/super.c:1669 reiserfs_fill_super+0x912/0x2620 fs/reiserfs/super.c:1966 mount_bdev+0x2d0/0x3f0 fs/super.c:1380 legacy_get_tree+0xef/0x190 fs/fs_context.c:610 vfs_get_tree+0x8c/0x270 fs/super.c:1510 do_new_mount+0x28f/0xae0 fs/namespace.c:3039 do_mount fs/namespace.c:3382 [inline] __do_sys_mount fs/namespace.c:3591 [inline] __se_sys_mount+0x2d9/0x3c0 fs/namespace.c:3568 do_syscall_x64 arch/x86/entry/common.c:50 [inline] do_syscall_64+0x41/0xc0 arch/x86/entry/common.c:80 entry_SYSCALL_64_after_hwframe+0x63/0xcd RIP: 0033:0x7fd67048d8ba Code: 48 c7 c2 b8 ff ff ff f7 d8 64 89 02 b8 ff ff ff ff eb d2 e8 b8 04 00 00 0f 1f 84 00 00 00 00 00 49 89 ca b8 a5 00 00 00 0f 05 <48> 3d 01 f0 ff ff 73 01 c3 48 c7 c1 b8 ff ff ff f7 d8 64 89 01 48 RSP: 002b:00007fd671187f88 EFLAGS: 00000202 ORIG_RAX: 00000000000000a5 RAX: ffffffffffffffda RBX: 0000000000001117 RCX: 00007fd67048d8ba RDX: 0000000020000540 RSI: 0000000020000140 RDI: 00007fd671187fe0 RBP: 00007fd671188020 R08: 00007fd671188020 R09: 000000000120c083 R10: 000000000120c083 R11: 0000000000000202 R12: 0000000020000540 R13: 0000000020000140 R14: 00007fd671187fe0 R15: 0000000020000380