rcu: INFO: rcu_preempt detected expedited stalls on CPUs/tasks: { 1-...D } 2636 jiffies s: 93137 root: 0x2/. rcu: blocking rcu_node structures (internal RCU debug): Sending NMI from CPU 0 to CPUs 1: NMI backtrace for cpu 1 CPU: 1 UID: 0 PID: 2538 Comm: acpid Not tainted 6.12.0-rc4-syzkaller-00052-gc6d9e43954bf #0 Hardware name: Google Google Compute Engine/Google Compute Engine, BIOS Google 09/13/2024 RIP: 0010:io_serial_out+0x8f/0xb0 drivers/tty/serial/8250/8250_port.c:413 Code: 48 8d 7d 40 44 89 e1 48 b8 00 00 00 00 00 fc ff df 48 89 fa d3 e3 48 c1 ea 03 80 3c 02 00 75 1c 66 03 5d 40 44 89 e8 89 da ee <5b> 5d 41 5c 41 5d c3 cc cc cc cc e8 31 f0 0d ff eb a0 e8 ba f0 0d RSP: 0018:ffffc900001b7f58 EFLAGS: 00000002 RAX: 0000000000000034 RBX: 00000000000003f8 RCX: 0000000000000000 RDX: 00000000000003f8 RSI: ffffffff82a08975 RDI: ffffffff93637660 RBP: ffffffff93637620 R08: 0000000000000001 R09: 000000000000001f R10: 0000000000000000 R11: 0000000000000000 R12: 0000000000000000 R13: 0000000000000034 R14: ffffffff82a08910 R15: 0000000000000000 FS: 00007fb98bfb5740(0000) GS:ffff8881f5900000(0000) knlGS:0000000000000000 CS: 0010 DS: 0000 ES: 0000 CR0: 0000000080050033 CR2: 00000000200012b8 CR3: 00000001158b0000 CR4: 00000000003506f0 DR0: 0000000000000000 DR1: 0000000000000000 DR2: 0000000000000000 DR3: 0000000000000000 DR6: 00000000fffe0ff0 DR7: 0000000000000400 Call Trace: serial_out drivers/tty/serial/8250/8250.h:142 [inline] serial8250_console_fifo_write drivers/tty/serial/8250/8250_port.c:3322 [inline] serial8250_console_write+0xf9e/0x17c0 drivers/tty/serial/8250/8250_port.c:3393 console_emit_next_record kernel/printk/printk.c:3092 [inline] console_flush_all+0x800/0xc60 kernel/printk/printk.c:3180 __console_flush_and_unlock kernel/printk/printk.c:3239 [inline] console_unlock+0xd9/0x210 kernel/printk/printk.c:3279 vprintk_emit+0x424/0x6f0 kernel/printk/printk.c:2407 vprintk+0x7f/0xa0 kernel/printk/printk_safe.c:68 _printk+0xc8/0x100 kernel/printk/printk.c:2432 printk_stack_address arch/x86/kernel/dumpstack.c:72 [inline] show_trace_log_lvl+0x1b7/0x3d0 arch/x86/kernel/dumpstack.c:285 sched_show_task kernel/sched/core.c:7604 [inline] sched_show_task+0x3f0/0x5f0 kernel/sched/core.c:7579 show_state_filter+0xee/0x320 kernel/sched/core.c:7649 k_spec drivers/tty/vt/keyboard.c:667 [inline] k_spec+0xed/0x150 drivers/tty/vt/keyboard.c:656 kbd_keycode drivers/tty/vt/keyboard.c:1522 [inline] kbd_event+0xcbd/0x17a0 drivers/tty/vt/keyboard.c:1541 input_handler_events_default+0x116/0x1b0 drivers/input/input.c:2549 input_pass_values+0x777/0x8e0 drivers/input/input.c:126 input_event_dispose drivers/input/input.c:352 [inline] input_handle_event+0xb30/0x14d0 drivers/input/input.c:369 input_event drivers/input/input.c:398 [inline] input_event+0x83/0xa0 drivers/input/input.c:390 hidinput_hid_event+0xa12/0x2410 drivers/hid/hid-input.c:1719 hid_process_event+0x4b7/0x5e0 drivers/hid/hid-core.c:1540 hid_input_array_field+0x535/0x710 drivers/hid/hid-core.c:1652 hid_process_report drivers/hid/hid-core.c:1694 [inline] hid_report_raw_event+0xa02/0x11c0 drivers/hid/hid-core.c:2040 __hid_input_report.constprop.0+0x341/0x440 drivers/hid/hid-core.c:2110 hid_irq_in+0x35e/0x870 drivers/hid/usbhid/hid-core.c:285 __usb_hcd_giveback_urb+0x389/0x6e0 drivers/usb/core/hcd.c:1650 usb_hcd_giveback_urb+0x396/0x450 drivers/usb/core/hcd.c:1734 dummy_timer+0x17f0/0x3930 drivers/usb/gadget/udc/dummy_hcd.c:1993 __run_hrtimer kernel/time/hrtimer.c:1691 [inline] __hrtimer_run_queues+0x20a/0xae0 kernel/time/hrtimer.c:1755 hrtimer_run_softirq+0x17d/0x350 kernel/time/hrtimer.c:1772 handle_softirqs+0x206/0x8d0 kernel/softirq.c:554 __do_softirq kernel/softirq.c:588 [inline] invoke_softirq kernel/softirq.c:428 [inline] __irq_exit_rcu kernel/softirq.c:637 [inline] irq_exit_rcu+0xac/0x110 kernel/softirq.c:649 instr_sysvec_apic_timer_interrupt arch/x86/kernel/apic/apic.c:1049 [inline] sysvec_apic_timer_interrupt+0x90/0xb0 arch/x86/kernel/apic/apic.c:1049 asm_sysvec_apic_timer_interrupt+0x1a/0x20 arch/x86/include/asm/idtentry.h:702 RIP: 0010:free_unref_page+0x572/0xb50 mm/page_alloc.c:2667 Code: 0f 85 0d 05 00 00 48 b8 23 e1 0c 00 00 00 e0 00 49 23 45 00 48 09 e8 4c 09 e0 75 4a 45 85 f6 0f 84 dd fb ff ff 48 83 c4 28 5b <5d> 41 5c 41 5d 41 5e 41 5f c3 cc cc cc cc 89 de 4c 89 ef e8 86 1f RSP: 0018:ffffc9000172f620 EFLAGS: 00000286 RAX: 0000000080000000 RBX: ffff8881319b0000 RCX: 0000000000000000 RDX: 0000000000000001 RSI: 0000000000000004 RDI: 0000000000000001 RBP: 00000000001319b0 R08: 0000000000000000 R09: ffffed103eb28650 R10: ffff8881f5943283 R11: 0000000000000000 R12: ffff8881f5943280 R13: ffffea0004c66c00 R14: ffff88823fff9e00 R15: 0000000000000001 poll_freewait+0x1b7/0x250 fs/select.c:153 do_select+0xeb6/0x17b0 fs/select.c:609 core_sys_select+0x459/0xb80 fs/select.c:678 do_pselect.constprop.0+0x1a0/0x1f0 fs/select.c:760 __do_sys_pselect6 fs/select.c:803 [inline] __se_sys_pselect6 fs/select.c:794 [inline] __x64_sys_pselect6+0x183/0x240 fs/select.c:794 do_syscall_x64 arch/x86/entry/common.c:52 [inline] do_syscall_64+0xcd/0x250 arch/x86/entry/common.c:83 entry_SYSCALL_64_after_hwframe+0x77/0x7f RIP: 0033:0x7fb98c084591 Code: 89 44 24 20 4c 8d 64 24 20 48 89 54 24 28 64 8b 04 25 18 00 00 00 85 c0 75 2d 45 31 c9 4d 89 e0 4c 89 f2 b8 0e 01 00 00 0f 05 <48> 89 c3 48 3d 00 f0 ff ff 76 69 48 8b 05 65 58 0d 00 f7 db 64 89 RSP: 002b:00007ffe21fb9680 EFLAGS: 00000246 ORIG_RAX: 000000000000010e RAX: ffffffffffffffda RBX: 0000000000000000 RCX: 00007fb98c084591 RDX: 0000000000000000 RSI: 00007ffe21fb9778 RDI: 000000000000000e RBP: 0000000000000000 R08: 0000000000000000 R09: 0000000000000000 R10: 0000000000000000 R11: 0000000000000246 R12: 0000000000000000 R13: 000056285c23a178 R14: 0000000000000000 R15: 000000000000000d __schedule_loop kernel/sched/core.c:6767 [inline] schedule+0xe7/0x350 kernel/sched/core.c:6782 schedule_timeout+0x258/0x2a0 kernel/time/timer.c:2591 do_wait_for_common kernel/sched/completion.c:95 [inline] __wait_for_common+0x3e1/0x600 kernel/sched/completion.c:116 wait_for_common kernel/sched/completion.c:127 [inline] wait_for_completion_state+0x1c/0x40 kernel/sched/completion.c:264 call_usermodehelper_exec+0x3c4/0x4d0 kernel/umh.c:442 call_modprobe kernel/module/kmod.c:103 [inline] __request_module+0x3f6/0x6c0 kernel/module/kmod.c:173 dev_load+0x1ff/0x240 net/core/dev_ioctl.c:645 dev_ioctl+0x473/0x10c0 net/core/dev_ioctl.c:709 sock_do_ioctl+0x19e/0x280 net/socket.c:1241 sock_ioctl+0x228/0x6c0 net/socket.c:1346 vfs_ioctl fs/ioctl.c:51 [inline] __do_sys_ioctl fs/ioctl.c:907 [inline] __se_sys_ioctl fs/ioctl.c:893 [inline] __x64_sys_ioctl+0x18f/0x220 fs/ioctl.c:893 do_syscall_x64 arch/x86/entry/common.c:52 [inline] do_syscall_64+0xcd/0x250 arch/x86/entry/common.c:83 entry_SYSCALL_64_after_hwframe+0x77/0x7f RIP: 0033:0x7fe9b790dbfb RSP: 002b:00007ffe922e5d80 EFLAGS: 00000246 ORIG_RAX: 0000000000000010 RAX: ffffffffffffffda RBX: 0000000000000005 RCX: 00007fe9b790dbfb RDX: 00007ffe922e5de0 RSI: 0000000000008933 RDI: 0000000000000005 RBP: 00007ffe922e5de0 R08: 000000000000000a R09: 00007ffe922e6100 R10: 0000000000000000 R11: 0000000000000246 R12: 0000000000000003 R13: 00007fe9b85f4620 R14: 0000000000000000 R15: 0000000000000000 task:kworker/u8:3 state:R running task stack:32568 pid:31306 tgid:31306 ppid:46 flags:0x00004000 Call Trace: __switch_to_asm+0x70/0x70 Showing all locks held in the system: 2 locks held by kworker/u8:3/46: #0: ffff888100089148 ( (wq_completion)events_unbound){+.+.}-{0:0}, at: process_one_work+0x129b/0x1ba0 kernel/workqueue.c:3204 #1: ffffc90000517d80 ((work_completion)(&sub_info->work) ){+.+.}-{0:0} , at: process_one_work+0x921/0x1ba0 kernel/workqueue.c:3205 4 locks held by acpid/2538: #0: ffff88811faaf230 ( &dev->event_lock){..-.}-{2:2}, at: input_event drivers/input/input.c:397 [inline] &dev->event_lock){..-.}-{2:2}, at: input_event+0x70/0xa0 drivers/input/input.c:390 #1: ffffffff88ebb140 (rcu_read_lock ){....}-{1:2} , at: rcu_lock_acquire include/linux/rcupdate.h:337 [inline] , at: rcu_read_lock include/linux/rcupdate.h:849 [inline] , at: input_pass_values+0x8b/0x8e0 drivers/input/input.c:118 #2: ffffffff89387a58 (kbd_event_lock ){..-.}-{2:2} , at: spin_lock include/linux/spinlock.h:351 [inline] , at: kbd_event+0x8a/0x17a0 drivers/tty/vt/keyboard.c:1535 #3: ffffffff88ebb140 ( rcu_read_lock ){....}-{1:2}, at: rcu_lock_acquire include/linux/rcupdate.h:337 [inline] ){....}-{1:2}, at: rcu_read_lock include/linux/rcupdate.h:849 [inline] ){....}-{1:2}, at: debug_show_all_locks+0x7f/0x390 kernel/locking/lockdep.c:6720 2 locks held by getty/2611: #0: ffff88810f3ca0a0 (&tty->ldisc_sem){++++}-{0:0}, at: tty_ldisc_ref_wait+0x24/0x80 drivers/tty/tty_ldisc.c:243 #1: ffffc900000432f0 (&ldata->atomic_read_lock){+.+.}-{3:3}, at: n_tty_read+0xfba/0x1480 drivers/tty/n_tty.c:2211 3 locks held by syz-executor/2645: #0: ffff8881119de070 (&vma->vm_lock->lock){++++}-{3:3}, at: vma_start_read include/linux/mm.h:704 [inline] #0: ffff8881119de070 (&vma->vm_lock->lock){++++}-{3:3}, at: lock_vma_under_rcu+0x13e/0x980 mm/memory.c:6232 #1: ffff888113f044f0 (sb_pagefaults){.+.+}-{0:0}, at: do_page_mkwrite+0x177/0x380 mm/memory.c:3162 #2: ffff888113f90958 (jbd2_handle ){++++}-{0:0}, at: start_this_handle+0xf6c/0x1430 fs/jbd2/transaction.c:448 2 locks held by kworker/u8:0/7397: #0: ffff888100089148 ((wq_completion)events_unbound ){+.+.}-{0:0} , at: process_one_work+0x129b/0x1ba0 kernel/workqueue.c:3204 #1: ffffc9000fbefd80 ((work_completion)(&sub_info->work)){+.+.}-{0:0} , at: process_one_work+0x921/0x1ba0 kernel/workqueue.c:3205 3 locks held by kworker/0:9/21307: 2 locks held by kworker/u8:2/24280: #0: ffff888100089148 ((wq_completion)events_unbound){+.+.}-{0:0} , at: process_one_work+0x129b/0x1ba0 kernel/workqueue.c:3204 #1: ffffc90008fffd80 ((work_completion)(&sub_info->work)){+.+.}-{0:0}, at: process_one_work+0x921/0x1ba0 kernel/workqueue.c:3205 1 lock held by syz.4.6217/30958: #0: ffffffff88ec6a38 (rcu_state.exp_mutex){+.+.}-{3:3}, at: exp_funnel_lock+0x282/0x3b0 kernel/rcu/tree_exp.h:297 1 lock held by syz.1.6218/30968: #0: ffffffff88ec6a38 (rcu_state.exp_mutex){+.+.}-{3:3}, at: exp_funnel_lock+0x1a4/0x3b0 kernel/rcu/tree_exp.h:329 3 locks held by syz-executor/31076: #0: ffff888113f043f8 (sb_writers#5){.+.+}-{0:0}, at: filename_create+0x10d/0x530 fs/namei.c:4019 #1: ffff88811d27e618 (&type->i_mutex_dir_key#3/1){+.+.}-{3:3}, at: inode_lock_nested include/linux/fs.h:850 [inline] (&type->i_mutex_dir_key#3/1){+.+.}-{3:3}, at: filename_create+0x1c2/0x530 fs/namei.c:4026 #2: ffff888113f90958 (jbd2_handle){++++}-{0:0}, at: start_this_handle+0xf6c/0x1430 fs/jbd2/transaction.c:448 =============================================