[ 13.375871][ C0] [ 13.376020][ C0] ================================ [ 13.376243][ C0] WARNING: inconsistent lock state [ 13.376454][ C0] 6.15.0-virtme #1 Not tainted [ 13.376669][ C0] -------------------------------- [ 13.376875][ C0] inconsistent {SOFTIRQ-ON-W} -> {IN-SOFTIRQ-W} usage. [ 13.377139][ C0] swapper/0/0 [HC0[0]:SC1[1]:HE1:SE0] takes: [ 13.377407][ C0] ffffffffb87c5af8 (pin_fs_lock){+.?.}-{3:3}, at: simple_pin_fs+0x24/0x150 [ 13.377797][ C0] {SOFTIRQ-ON-W} state was registered at: [ 13.378011][ C0] __lock_acquire+0x20b/0x7e0 [ 13.378234][ C0] lock_acquire.part.0+0xb6/0x240 [ 13.378448][ C0] _raw_spin_lock+0x33/0x40 [ 13.378668][ C0] simple_pin_fs+0x24/0x150 [ 13.378880][ C0] start_creating.part.0+0x52/0x310 [ 13.379094][ C0] debugfs_create_dir+0x6a/0x540 [ 13.379307][ C0] component_debug_init+0x17/0x30 [ 13.379520][ C0] do_one_initcall+0x8f/0x1e0 [ 13.379730][ C0] do_initcalls+0x176/0x280 [ 13.379948][ C0] kernel_init_freeable+0x22d/0x300 [ 13.380165][ C0] kernel_init+0x20/0x200 [ 13.380380][ C0] ret_from_fork+0x240/0x320 [ 13.380596][ C0] ret_from_fork_asm+0x1a/0x30 [ 13.380808][ C0] irq event stamp: 416024 [ 13.380977][ C0] hardirqs last enabled at (416024): [] _raw_spin_unlock_irqrestore+0x5d/0x80 [ 13.381422][ C0] hardirqs last disabled at (416023): [] _raw_spin_lock_irqsave+0x5b/0x60 [ 13.381853][ C0] softirqs last enabled at (415820): [] handle_softirqs+0x358/0x620 [ 13.382231][ C0] softirqs last disabled at (415851): [] __irq_exit_rcu+0xfa/0x160 [ 13.382614][ C0] [ 13.382614][ C0] other info that might help us debug this: [ 13.382933][ C0] Possible unsafe locking scenario: [ 13.382933][ C0] [ 13.383256][ C0] CPU0 [ 13.383421][ C0] ---- [ 13.383583][ C0] lock(pin_fs_lock); [ 13.383748][ C0] [ 13.383915][ C0] lock(pin_fs_lock); [ 13.384083][ C0] [ 13.384083][ C0] *** DEADLOCK *** [ 13.384083][ C0] [ 13.384402][ C0] 1 lock held by swapper/0/0: [ 13.384619][ C0] #0: ffffffffb85774c0 (rcu_callback){....}-{0:0}, at: rcu_do_batch+0x2e4/0xf20 [ 13.385011][ C0] [ 13.385011][ C0] stack backtrace: [ 13.385283][ C0] CPU: 0 UID: 0 PID: 0 Comm: swapper/0 Not tainted 6.15.0-virtme #1 PREEMPT(full) [ 13.385288][ C0] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 13.385290][ C0] Call Trace: [ 13.385292][ C0] [ 13.385294][ C0] dump_stack_lvl+0x82/0xd0 [ 13.385300][ C0] print_usage_bug.part.0+0x25f/0x360 [ 13.385304][ C0] mark_lock_irq+0x343/0x400 [ 13.385308][ C0] ? is_bpf_text_address+0x67/0x120 [ 13.385313][ C0] ? __lock_release+0x5d/0x170 [ 13.385317][ C0] ? save_trace+0x52/0x170 [ 13.385321][ C0] mark_lock+0x174/0x2f0 [ 13.385325][ C0] mark_usage+0x46/0x150 [ 13.385329][ C0] __lock_acquire+0x20b/0x7e0 [ 13.385332][ C0] ? __lock_acquire+0x44d/0x7e0 [ 13.385336][ C0] lock_acquire.part.0+0xb6/0x240 [ 13.385340][ C0] ? simple_pin_fs+0x24/0x150 [ 13.385343][ C0] ? rcu_is_watching+0x12/0xc0 [ 13.385348][ C0] ? lock_acquire+0x10c/0x170 [ 13.385350][ C0] ? simple_pin_fs+0x24/0x150 [ 13.385354][ C0] _raw_spin_lock+0x33/0x40 [ 13.385357][ C0] ? simple_pin_fs+0x24/0x150 [ 13.385360][ C0] simple_pin_fs+0x24/0x150 [ 13.385363][ C0] debugfs_remove+0x35/0x70 [ 13.385366][ C0] ref_tracker_dir_exit+0xcf/0x740 [ 13.385371][ C0] ? __pfx_ref_tracker_free+0x10/0x10 [ 13.385373][ C0] ? __sk_destruct+0x383/0x780 [ 13.385378][ C0] ? rcu_do_batch+0x34c/0xf20 [ 13.385381][ C0] ? __pfx_ref_tracker_dir_exit+0x10/0x10 [ 13.385384][ C0] ? irq_exit_rcu+0xe/0x30 [ 13.385387][ C0] ? sysvec_apic_timer_interrupt+0xa8/0xc0 [ 13.385391][ C0] ? asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 13.385395][ C0] ? pv_native_safe_halt+0xf/0x20 [ 13.385398][ C0] ? default_idle+0x9/0x10 [ 13.385400][ C0] ? default_idle_call+0x6d/0xb0 [ 13.385403][ C0] ? cpuidle_idle_call+0x26f/0x3a0 [ 13.385407][ C0] ? do_idle+0xf6/0x160 [ 13.385410][ C0] ? cpu_startup_entry+0x54/0x60 [ 13.385413][ C0] ? rest_init+0x14b/0x260 [ 13.385415][ C0] ? start_kernel+0x350/0x410 [ 13.385421][ C0] __put_net+0x19/0x60 [ 13.385425][ C0] __sk_destruct+0x58a/0x780 [ 13.385429][ C0] ? rcu_do_batch+0x34a/0xf20 [ 13.385432][ C0] rcu_do_batch+0x34c/0xf20 [ 13.385435][ C0] ? find_held_lock+0x2b/0x80 [ 13.385439][ C0] ? __pfx_rcu_do_batch+0x10/0x10 [ 13.385442][ C0] ? _raw_spin_unlock_irqrestore+0x5d/0x80 [ 13.385446][ C0] ? lockdep_hardirqs_on+0x7c/0x110 [ 13.385450][ C0] ? _raw_spin_unlock_irqrestore+0x46/0x80 [ 13.385454][ C0] rcu_core+0x2bb/0x500 [ 13.385459][ C0] handle_softirqs+0x218/0x620 [ 13.385464][ C0] __irq_exit_rcu+0xfa/0x160 [ 13.385468][ C0] irq_exit_rcu+0xe/0x30 [ 13.385471][ C0] sysvec_apic_timer_interrupt+0xa8/0xc0 [ 13.385474][ C0] [ 13.385475][ C0] [ 13.385477][ C0] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 13.385480][ C0] RIP: 0010:pv_native_safe_halt+0xf/0x20 [ 13.385484][ C0] Code: a2 b4 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 83 17 0f 00 fb f4 fc 54 02 00 66 2e 0f 1f 84 00 00 00 00 00 66 90 90 90 90 90 90 [ 13.385487][ C0] RSP: 0018:ffffffffb8207df8 EFLAGS: 00000246 [ 13.385490][ C0] RAX: 0000000000065869 RBX: 1ffffffff7040fc3 RCX: ffffffffb75a25d9 [ 13.385492][ C0] RDX: 0000000000000000 RSI: ffffffffb809175c RDI: ffffffffb7853ca0 [ 13.385494][ C0] RBP: 0000000000000000 R08: 0000000000000001 R09: ffffed1006c066fa [ 13.385495][ C0] R10: ffff8880360337d3 R11: ffffffffb8211288 R12: 0000000000000000 [ 13.385497][ C0] R13: ffffffffb821f240 R14: dffffc0000000000 R15: 0000000000014770 [ 13.385501][ C0] ? ct_kernel_exit.constprop.0+0x109/0x160 [ 13.385505][ C0] default_idle+0x9/0x10 [ 13.385508][ C0] default_idle_call+0x6d/0xb0 [ 13.385510][ C0] cpuidle_idle_call+0x26f/0x3a0 [ 13.385514][ C0] ? __pfx_cpuidle_idle_call+0x10/0x10 [ 13.385518][ C0] ? tsc_verify_tsc_adjust+0x98/0x310 [ 13.385523][ C0] do_idle+0xf6/0x160 [ 13.385527][ C0] cpu_startup_entry+0x54/0x60 [ 13.385530][ C0] rest_init+0x14b/0x260 [ 13.385533][ C0] start_kernel+0x350/0x410 [ 13.385537][ C0] x86_64_start_reservations+0x18/0x30 [ 13.385542][ C0] x86_64_start_kernel+0xf8/0x150 [ 13.385546][ C0] common_startup_64+0x13e/0x148 [ 13.385555][ C0] [ 13.404060][ C0] BUG: sleeping function called from invalid context at kernel/locking/rwsem.c:1576 [ 13.404403][ C0] in_atomic(): 1, irqs_disabled(): 0, non_block: 0, pid: 0, name: swapper/0 [ 13.404879][ C0] preempt_count: 101, expected: 0 [ 13.405078][ C0] RCU nest depth: 0, expected: 0 [ 13.405283][ C0] INFO: lockdep is turned off. [ 13.405480][ C0] Preemption disabled at: [ 13.405482][ C0] [] schedule_preempt_disabled+0x22/0x30 [ 13.405938][ C0] CPU: 0 UID: 0 PID: 0 Comm: swapper/0 Not tainted 6.15.0-virtme #1 PREEMPT(full) [ 13.405942][ C0] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 13.405944][ C0] Call Trace: [ 13.405946][ C0] [ 13.405947][ C0] dump_stack_lvl+0xb0/0xd0 [ 13.405953][ C0] __might_resched+0x360/0x5a0 [ 13.405961][ C0] down_write+0x72/0x210 [ 13.405964][ C0] ? __pfx_down_write+0x10/0x10 [ 13.405967][ C0] ? simple_recursive_removal+0x33/0x610 [ 13.405971][ C0] ? rcu_is_watching+0x12/0xc0 [ 13.405977][ C0] ? do_raw_spin_unlock+0x58/0x220 [ 13.405981][ C0] simple_recursive_removal+0x6a/0x610 [ 13.405984][ C0] ? do_raw_spin_unlock+0x58/0x220 [ 13.405986][ C0] ? __pfx_remove_one+0x10/0x10 [ 13.405992][ C0] debugfs_remove+0x44/0x70 [ 13.405995][ C0] ref_tracker_dir_exit+0xcf/0x740 [ 13.405999][ C0] ? __pfx_ref_tracker_free+0x10/0x10 [ 13.406002][ C0] ? __sk_destruct+0x383/0x780 [ 13.406006][ C0] ? rcu_do_batch+0x34c/0xf20 [ 13.406009][ C0] ? __pfx_ref_tracker_dir_exit+0x10/0x10 [ 13.406012][ C0] ? irq_exit_rcu+0xe/0x30 [ 13.406017][ C0] ? sysvec_apic_timer_interrupt+0xa8/0xc0 [ 13.406021][ C0] ? asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 13.406024][ C0] ? pv_native_safe_halt+0xf/0x20 [ 13.406028][ C0] ? default_idle+0x9/0x10 [ 13.406030][ C0] ? default_idle_call+0x6d/0xb0 [ 13.406033][ C0] ? cpuidle_idle_call+0x26f/0x3a0 [ 13.406036][ C0] ? do_idle+0xf6/0x160 [ 13.406039][ C0] ? cpu_startup_entry+0x54/0x60 [ 13.406041][ C0] ? rest_init+0x14b/0x260 [ 13.406044][ C0] ? start_kernel+0x350/0x410 [ 13.406051][ C0] __put_net+0x19/0x60 [ 13.406055][ C0] __sk_destruct+0x58a/0x780 [ 13.406059][ C0] ? rcu_do_batch+0x34a/0xf20 [ 13.406062][ C0] rcu_do_batch+0x34c/0xf20 [ 13.406065][ C0] ? find_held_lock+0x2b/0x80 [ 13.406069][ C0] ? __pfx_rcu_do_batch+0x10/0x10 [ 13.406073][ C0] ? _raw_spin_unlock_irqrestore+0x5d/0x80 [ 13.406077][ C0] ? lockdep_hardirqs_on+0x7c/0x110 [ 13.406080][ C0] ? _raw_spin_unlock_irqrestore+0x46/0x80 [ 13.406085][ C0] rcu_core+0x2bb/0x500 [ 13.406089][ C0] handle_softirqs+0x218/0x620 [ 13.406095][ C0] __irq_exit_rcu+0xfa/0x160 [ 13.406098][ C0] irq_exit_rcu+0xe/0x30 [ 13.406101][ C0] sysvec_apic_timer_interrupt+0xa8/0xc0 [ 13.406105][ C0] [ 13.406106][ C0] [ 13.406108][ C0] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 13.406111][ C0] RIP: 0010:pv_native_safe_halt+0xf/0x20 [ 13.406114][ C0] Code: a2 b4 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 83 17 0f 00 fb f4 fc 54 02 00 66 2e 0f 1f 84 00 00 00 00 00 66 90 90 90 90 90 90 [ 13.406117][ C0] RSP: 0018:ffffffffb8207df8 EFLAGS: 00000246 [ 13.406120][ C0] RAX: 0000000000065869 RBX: 1ffffffff7040fc3 RCX: ffffffffb75a25d9 [ 13.406122][ C0] RDX: 0000000000000000 RSI: ffffffffb809175c RDI: ffffffffb7853ca0 [ 13.406123][ C0] RBP: 0000000000000000 R08: 0000000000000001 R09: ffffed1006c066fa [ 13.406125][ C0] R10: ffff8880360337d3 R11: ffffffffb8211288 R12: 0000000000000000 [ 13.406127][ C0] R13: ffffffffb821f240 R14: dffffc0000000000 R15: 0000000000014770 [ 13.406131][ C0] ? ct_kernel_exit.constprop.0+0x109/0x160 [ 13.406136][ C0] default_idle+0x9/0x10 [ 13.406138][ C0] default_idle_call+0x6d/0xb0 [ 13.406140][ C0] cpuidle_idle_call+0x26f/0x3a0 [ 13.406144][ C0] ? __pfx_cpuidle_idle_call+0x10/0x10 [ 13.406148][ C0] ? tsc_verify_tsc_adjust+0x98/0x310 [ 13.406153][ C0] do_idle+0xf6/0x160 [ 13.406157][ C0] cpu_startup_entry+0x54/0x60 [ 13.406160][ C0] rest_init+0x14b/0x260 [ 13.406164][ C0] start_kernel+0x350/0x410 [ 13.406167][ C0] x86_64_start_reservations+0x18/0x30 [ 13.406172][ C0] x86_64_start_kernel+0xf8/0x150 [ 13.406176][ C0] common_startup_64+0x13e/0x148 [ 13.406185][ C0]