[ 17.574474][ C3] [ 17.574618][ C3] ================================ [ 17.574821][ C3] WARNING: inconsistent lock state [ 17.575018][ C3] 6.15.0-rc5-virtme #1 Not tainted [ 17.575210][ C3] -------------------------------- [ 17.575398][ C3] inconsistent {SOFTIRQ-ON-W} -> {IN-SOFTIRQ-W} usage. [ 17.575631][ C3] swapper/3/0 [HC0[0]:SC1[1]:HE1:SE0] takes: [ 17.575881][ C3] ffffffff929bf978 (pin_fs_lock){+.?.}-{3:3}, at: simple_pin_fs+0x24/0x150 [ 17.576229][ C3] {SOFTIRQ-ON-W} state was registered at: [ 17.576423][ C3] __lock_acquire+0x3eb/0x9d0 [ 17.576613][ C3] lock_acquire.part.0+0xb6/0x240 [ 17.576812][ C3] _raw_spin_lock+0x33/0x40 [ 17.577004][ C3] simple_pin_fs+0x24/0x150 [ 17.577190][ C3] start_creating.part.0+0x3f/0x2f0 [ 17.577376][ C3] debugfs_create_dir+0x6a/0x540 [ 17.577561][ C3] component_debug_init+0x17/0x30 [ 17.577779][ C3] do_one_initcall+0x8c/0x1e0 [ 17.577985][ C3] do_initcalls+0x176/0x280 [ 17.578161][ C3] kernel_init_freeable+0x22d/0x300 [ 17.578335][ C3] kernel_init+0x20/0x200 [ 17.578515][ C3] ret_from_fork+0x31/0x70 [ 17.578699][ C3] ret_from_fork_asm+0x1a/0x30 [ 17.578884][ C3] irq event stamp: 280472 [ 17.579021][ C3] hardirqs last enabled at (280472): [] _raw_spin_unlock_irqrestore+0x5d/0x80 [ 17.579383][ C3] hardirqs last disabled at (280471): [] _raw_spin_lock_irqsave+0x5b/0x60 [ 17.579749][ C3] softirqs last enabled at (278536): [] handle_softirqs+0x358/0x620 [ 17.580063][ C3] softirqs last disabled at (278569): [] __irq_exit_rcu+0xfa/0x160 [ 17.580385][ C3] [ 17.580385][ C3] other info that might help us debug this: [ 17.580659][ C3] Possible unsafe locking scenario: [ 17.580659][ C3] [ 17.580937][ C3] CPU0 [ 17.581071][ C3] ---- [ 17.581209][ C3] lock(pin_fs_lock); [ 17.581351][ C3] [ 17.581489][ C3] lock(pin_fs_lock); [ 17.581626][ C3] [ 17.581626][ C3] *** DEADLOCK *** [ 17.581626][ C3] [ 17.581905][ C3] 1 lock held by swapper/3/0: [ 17.582085][ C3] #0: ffffffff92774480 (rcu_callback){....}-{0:0}, at: rcu_do_batch+0x2e4/0xf20 [ 17.582412][ C3] [ 17.582412][ C3] stack backtrace: [ 17.582635][ C3] CPU: 3 UID: 0 PID: 0 Comm: swapper/3 Not tainted 6.15.0-rc5-virtme #1 PREEMPT(full) [ 17.582640][ C3] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 17.582642][ C3] Call Trace: [ 17.582644][ C3] [ 17.582646][ C3] dump_stack_lvl+0x82/0xd0 [ 17.582653][ C3] print_usage_bug.part.0+0x25f/0x360 [ 17.582659][ C3] mark_lock_irq+0x343/0x400 [ 17.582664][ C3] ? __pfx_unwind_next_frame+0x10/0x10 [ 17.582669][ C3] ? save_trace+0x52/0x170 [ 17.582673][ C3] mark_lock+0x174/0x2f0 [ 17.582677][ C3] mark_usage+0x46/0x150 [ 17.582681][ C3] __lock_acquire+0x3eb/0x9d0 [ 17.582686][ C3] lock_acquire.part.0+0xb6/0x240 [ 17.582689][ C3] ? simple_pin_fs+0x24/0x150 [ 17.582696][ C3] ? rcu_is_watching+0x12/0xc0 [ 17.582703][ C3] ? lock_acquire+0x10c/0x170 [ 17.582707][ C3] ? simple_pin_fs+0x24/0x150 [ 17.582714][ C3] _raw_spin_lock+0x33/0x40 [ 17.582717][ C3] ? simple_pin_fs+0x24/0x150 [ 17.582720][ C3] simple_pin_fs+0x24/0x150 [ 17.582724][ C3] debugfs_remove+0x35/0x70 [ 17.582728][ C3] ref_tracker_dir_exit+0xcf/0x740 [ 17.582733][ C3] ? __pfx_ref_tracker_free+0x10/0x10 [ 17.582736][ C3] ? __sk_destruct+0x383/0x780 [ 17.582742][ C3] ? rcu_do_batch+0x34c/0xf20 [ 17.582745][ C3] ? __pfx_ref_tracker_dir_exit+0x10/0x10 [ 17.582748][ C3] ? irq_exit_rcu+0xe/0x30 [ 17.582750][ C3] ? sysvec_apic_timer_interrupt+0xa8/0xc0 [ 17.582755][ C3] ? asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 17.582758][ C3] ? pv_native_safe_halt+0xf/0x20 [ 17.582761][ C3] ? default_idle+0x9/0x10 [ 17.582764][ C3] ? default_idle_call+0x6d/0xb0 [ 17.582766][ C3] ? cpuidle_idle_call+0x26f/0x3a0 [ 17.582771][ C3] ? do_idle+0xf6/0x160 [ 17.582773][ C3] ? cpu_startup_entry+0x54/0x60 [ 17.582777][ C3] ? start_secondary+0x213/0x2a0 [ 17.582781][ C3] ? common_startup_64+0x13e/0x148 [ 17.582787][ C3] __put_net+0x19/0x60 [ 17.582790][ C3] __sk_destruct+0x58a/0x780 [ 17.582794][ C3] ? rcu_do_batch+0x34a/0xf20 [ 17.582797][ C3] rcu_do_batch+0x34c/0xf20 [ 17.582800][ C3] ? find_held_lock+0x2b/0x80 [ 17.582804][ C3] ? __pfx_rcu_do_batch+0x10/0x10 [ 17.582808][ C3] ? _raw_spin_unlock_irqrestore+0x5d/0x80 [ 17.582811][ C3] ? lockdep_hardirqs_on+0x7c/0x110 [ 17.582815][ C3] ? _raw_spin_unlock_irqrestore+0x46/0x80 [ 17.582819][ C3] rcu_core+0x2bb/0x500 [ 17.582822][ C3] handle_softirqs+0x218/0x620 [ 17.582827][ C3] __irq_exit_rcu+0xfa/0x160 [ 17.582829][ C3] irq_exit_rcu+0xe/0x30 [ 17.582832][ C3] sysvec_apic_timer_interrupt+0xa8/0xc0 [ 17.582835][ C3] [ 17.582836][ C3] [ 17.582837][ C3] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 17.582840][ C3] RIP: 0010:pv_native_safe_halt+0xf/0x20 [ 17.582844][ C3] Code: b0 b8 00 c3 cc cc cc cc 0f 1f 00 90 90 90 90 90 90 90 90 90 90 90 90 90 90 90 90 f3 0f 1e fa 66 90 0f 00 2d a3 d0 13 00 fb f4 cc cc cc cc 66 2e 0f 1f 84 00 00 00 00 00 66 90 90 90 90 90 90 [ 17.582847][ C3] RSP: 0018:ffffc90000157de8 EFLAGS: 00000246 [ 17.582851][ C3] RAX: 0000000000044027 RBX: 1ffff9200002afc1 RCX: ffffffff91755a19 [ 17.582853][ C3] RDX: 0000000000000000 RSI: ffffffff92285f31 RDI: ffffffff91a50ce0 [ 17.582855][ C3] RBP: 0000000000000000 R08: 0000000000000001 R09: ffffed1006c3667a [ 17.582857][ C3] R10: ffff8880361b33d3 R11: 0000000000000000 R12: 0000000000000000 [ 17.582859][ C3] R13: ffff888001bb4640 R14: dffffc0000000000 R15: 0000000000000000 [ 17.582862][ C3] ? ct_kernel_exit.constprop.0+0x109/0x160 [ 17.582868][ C3] default_idle+0x9/0x10 [ 17.582870][ C3] default_idle_call+0x6d/0xb0 [ 17.582872][ C3] cpuidle_idle_call+0x26f/0x3a0 [ 17.582876][ C3] ? __pfx_cpuidle_idle_call+0x10/0x10 [ 17.582880][ C3] ? tsc_verify_tsc_adjust+0x98/0x300 [ 17.582885][ C3] do_idle+0xf6/0x160 [ 17.582889][ C3] cpu_startup_entry+0x54/0x60 [ 17.582892][ C3] start_secondary+0x213/0x2a0 [ 17.582895][ C3] ? __pfx_start_secondary+0x10/0x10 [ 17.582900][ C3] common_startup_64+0x13e/0x148 [ 17.582906][ C3] [ 17.597408][ C3] BUG: sleeping function called from invalid context at kernel/locking/rwsem.c:1576 [ 17.597716][ C3] in_atomic(): 1, irqs_disabled(): 0, non_block: 0, pid: 0, name: swapper/3 [ 17.598115][ C3] preempt_count: 101, expected: 0 [ 17.598282][ C3] RCU nest depth: 0, expected: 0 [ 17.598451][ C3] INFO: lockdep is turned off. [ 17.598617][ C3] Preemption disabled at: [ 17.598619][ C3] [<0000000000000000>] 0x0 [ 17.599036][ C3] CPU: 3 UID: 0 PID: 0 Comm: swapper/3 Not tainted 6.15.0-rc5-virtme #1 PREEMPT(full) [ 17.599041][ C3] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 17.599044][ C3] Call Trace: [ 17.599045][ C3] [ 17.599047][ C3] dump_stack_lvl+0xb0/0xd0 [ 17.599055][ C3] __might_resched+0x360/0x5a0 [ 17.599061][ C3] down_write+0x72/0x210 [ 17.599065][ C3] ? __pfx_down_write+0x10/0x10 [ 17.599067][ C3] ? simple_recursive_removal+0x3a/0x860 [ 17.599071][ C3] ? rcu_is_watching+0x12/0xc0 [ 17.599077][ C3] ? do_raw_spin_unlock+0x58/0x220 [ 17.599082][ C3] simple_recursive_removal+0x166/0x860 [ 17.599084][ C3] ? __pfx_remove_one+0x10/0x10 [ 17.599088][ C3] ? do_raw_spin_unlock+0x58/0x220 [ 17.599092][ C3] debugfs_remove+0x44/0x70 [ 17.599095][ C3] ref_tracker_dir_exit+0xcf/0x740 [ 17.599100][ C3] ? __pfx_ref_tracker_free+0x10/0x10 [ 17.599103][ C3] ? __sk_destruct+0x383/0x780 [ 17.599108][ C3] ? rcu_do_batch+0x34c/0xf20 [ 17.599112][ C3] ? __pfx_ref_tracker_dir_exit+0x10/0x10 [ 17.599115][ C3] ? irq_exit_rcu+0xe/0x30 [ 17.599118][ C3] ? sysvec_apic_timer_interrupt+0xa8/0xc0 [ 17.599123][ C3] ? asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 17.599126][ C3] ? pv_native_safe_halt+0xf/0x20 [ 17.599129][ C3] ? default_idle+0x9/0x10 [ 17.599131][ C3] ? default_idle_call+0x6d/0xb0 [ 17.599134][ C3] ? cpuidle_idle_call+0x26f/0x3a0 [ 17.599138][ C3] ? do_idle+0xf6/0x160 [ 17.599141][ C3] ? cpu_startup_entry+0x54/0x60 [ 17.599144][ C3] ? start_secondary+0x213/0x2a0 [ 17.599149][ C3] ? common_startup_64+0x13e/0x148 [ 17.599155][ C3] __put_net+0x19/0x60 [ 17.599158][ C3] __sk_destruct+0x58a/0x780 [ 17.599162][ C3] ? rcu_do_batch+0x34a/0xf20 [ 17.599165][ C3] rcu_do_batch+0x34c/0xf20 [ 17.599169][ C3] ? find_held_lock+0x2b/0x80 [ 17.599173][ C3] ? __pfx_rcu_do_batch+0x10/0x10 [ 17.599177][ C3] ? _raw_spin_unlock_irqrestore+0x5d/0x80 [ 17.599181][ C3] ? lockdep_hardirqs_on+0x7c/0x110 [ 17.599184][ C3] ? _raw_spin_unlock_irqrestore+0x46/0x80 [ 17.599189][ C3] rcu_core+0x2bb/0x500 [ 17.599192][ C3] handle_softirqs+0x218/0x620 [ 17.599197][ C3] __irq_exit_rcu+0xfa/0x160 [ 17.599200][ C3] irq_exit_rcu+0xe/0x30 [ 17.599202][ C3] sysvec_apic_timer_interrupt+0xa8/0xc0 [ 17.599205][ C3] [ 17.599206][ C3] [ 17.599207][ C3] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 17.599210][ C3] RIP: 0010:pv_native_safe_halt+0xf/0x20 [ 17.599214][ C3] Code: b0 b8 00 c3 cc cc cc cc 0f 1f 00 90 90 90 90 90 90 90 90 90 90 90 90 90 90 90 90 f3 0f 1e fa 66 90 0f 00 2d a3 d0 13 00 fb f4 cc cc cc cc 66 2e 0f 1f 84 00 00 00 00 00 66 90 90 90 90 90 90 [ 17.599217][ C3] RSP: 0018:ffffc90000157de8 EFLAGS: 00000246 [ 17.599220][ C3] RAX: 0000000000044027 RBX: 1ffff9200002afc1 RCX: ffffffff91755a19 [ 17.599222][ C3] RDX: 0000000000000000 RSI: ffffffff92285f31 RDI: ffffffff91a50ce0 [ 17.599224][ C3] RBP: 0000000000000000 R08: 0000000000000001 R09: ffffed1006c3667a [ 17.599225][ C3] R10: ffff8880361b33d3 R11: 0000000000000000 R12: 0000000000000000 [ 17.599227][ C3] R13: ffff888001bb4640 R14: dffffc0000000000 R15: 0000000000000000 [ 17.599231][ C3] ? ct_kernel_exit.constprop.0+0x109/0x160 [ 17.599236][ C3] default_idle+0x9/0x10 [ 17.599238][ C3] default_idle_call+0x6d/0xb0 [ 17.599240][ C3] cpuidle_idle_call+0x26f/0x3a0 [ 17.599244][ C3] ? __pfx_cpuidle_idle_call+0x10/0x10 [ 17.599248][ C3] ? tsc_verify_tsc_adjust+0x98/0x300 [ 17.599253][ C3] do_idle+0xf6/0x160 [ 17.599257][ C3] cpu_startup_entry+0x54/0x60 [ 17.599260][ C3] start_secondary+0x213/0x2a0 [ 17.599263][ C3] ? __pfx_start_secondary+0x10/0x10 [ 17.599268][ C3] common_startup_64+0x13e/0x148 [ 17.599275][ C3] [ 20.584328][ C1] BUG: sleeping function called from invalid context at kernel/locking/rwsem.c:1576 [ 20.584651][ C1] in_atomic(): 1, irqs_disabled(): 0, non_block: 0, pid: 22, name: ksoftirqd/1 [ 20.584933][ C1] preempt_count: 100, expected: 0 [ 20.585086][ C1] RCU nest depth: 0, expected: 0 [ 20.585240][ C1] INFO: lockdep is turned off. [ 20.585400][ C1] Preemption disabled at: [ 20.585402][ C1] [] handle_softirqs+0xe5/0x620 [ 20.585713][ C1] CPU: 1 UID: 0 PID: 22 Comm: ksoftirqd/1 Tainted: G W 6.15.0-rc5-virtme #1 PREEMPT(full) [ 20.585723][ C1] Tainted: [W]=WARN [ 20.585724][ C1] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 20.585727][ C1] Call Trace: [ 20.585729][ C1] [ 20.585731][ C1] dump_stack_lvl+0xb0/0xd0 [ 20.585738][ C1] __might_resched+0x360/0x5a0 [ 20.585744][ C1] down_write+0x72/0x210 [ 20.585748][ C1] ? __pfx_down_write+0x10/0x10 [ 20.585750][ C1] ? simple_recursive_removal+0x3a/0x860 [ 20.585754][ C1] ? rcu_is_watching+0x12/0xc0 [ 20.585761][ C1] ? do_raw_spin_unlock+0x58/0x220 [ 20.585766][ C1] simple_recursive_removal+0x166/0x860 [ 20.585768][ C1] ? __pfx_remove_one+0x10/0x10 [ 20.585772][ C1] ? do_raw_spin_unlock+0x58/0x220 [ 20.585777][ C1] debugfs_remove+0x44/0x70 [ 20.585780][ C1] ref_tracker_dir_exit+0xcf/0x740 [ 20.585786][ C1] ? __pfx_ref_tracker_free+0x10/0x10 [ 20.585789][ C1] ? __sk_destruct+0x383/0x780 [ 20.585794][ C1] ? rcu_do_batch+0x34c/0xf20 [ 20.585798][ C1] ? __pfx_ref_tracker_dir_exit+0x10/0x10 [ 20.585800][ C1] ? smpboot_thread_fn+0x307/0x960 [ 20.585804][ C1] ? kthread+0x37b/0x600 [ 20.585808][ C1] ? ret_from_fork+0x31/0x70 [ 20.585813][ C1] ? ret_from_fork_asm+0x1a/0x30 [ 20.585818][ C1] ? migrate_enable+0x1f2/0x270 [ 20.585822][ C1] ? __pfx_migrate_enable+0x10/0x10 [ 20.585826][ C1] ? bpf_sk_storage_free+0x9f/0x1c0 [ 20.585831][ C1] ? rcu_is_watching+0x12/0xc0 [ 20.585835][ C1] __put_net+0x19/0x60 [ 20.585839][ C1] __sk_destruct+0x58a/0x780 [ 20.585843][ C1] ? rcu_do_batch+0x34a/0xf20 [ 20.585845][ C1] rcu_do_batch+0x34c/0xf20 [ 20.585850][ C1] ? __pfx_rcu_do_batch+0x10/0x10 [ 20.585855][ C1] ? rcu_is_watching+0x12/0xc0 [ 20.585858][ C1] ? trace_irq_enable.constprop.0+0xd4/0x130 [ 20.585864][ C1] rcu_core+0x2bb/0x500 [ 20.585867][ C1] handle_softirqs+0x218/0x620 [ 20.585871][ C1] ? __pfx_run_ksoftirqd+0x10/0x10 [ 20.585874][ C1] run_ksoftirqd+0x3f/0x70 [ 20.585876][ C1] smpboot_thread_fn+0x307/0x960 [ 20.585879][ C1] ? __pfx_smpboot_thread_fn+0x10/0x10 [ 20.585883][ C1] kthread+0x37b/0x600 [ 20.585886][ C1] ? __pfx_kthread+0x10/0x10 [ 20.585889][ C1] ? ret_from_fork+0x1b/0x70 [ 20.585892][ C1] ? __lock_release+0x5d/0x170 [ 20.585897][ C1] ? rcu_is_watching+0x12/0xc0 [ 20.585900][ C1] ? __pfx_kthread+0x10/0x10 [ 20.585904][ C1] ret_from_fork+0x31/0x70 [ 20.585907][ C1] ? __pfx_kthread+0x10/0x10 [ 20.585910][ C1] ret_from_fork_asm+0x1a/0x30 [ 20.585916][ C1]