[ 13.872947][ C0] [ 13.873144][ C0] ================================ [ 13.873362][ C0] WARNING: inconsistent lock state [ 13.873573][ C0] 6.15.0-virtme #1 Not tainted [ 13.873787][ C0] -------------------------------- [ 13.874000][ C0] inconsistent {SOFTIRQ-ON-W} -> {IN-SOFTIRQ-W} usage. [ 13.874272][ C0] swapper/0/0 [HC0[0]:SC1[1]:HE1:SE0] takes: [ 13.874533][ C0] ffffffff997c5af8 (pin_fs_lock){+.?.}-{3:3}, at: simple_pin_fs+0x24/0x150 [ 13.874919][ C0] {SOFTIRQ-ON-W} state was registered at: [ 13.875132][ C0] __lock_acquire+0x20b/0x7e0 [ 13.875353][ C0] lock_acquire.part.0+0xb6/0x240 [ 13.875562][ C0] _raw_spin_lock+0x33/0x40 [ 13.875793][ C0] simple_pin_fs+0x24/0x150 [ 13.876015][ C0] start_creating.part.0+0x52/0x310 [ 13.876235][ C0] debugfs_create_dir+0x6a/0x540 [ 13.876446][ C0] component_debug_init+0x17/0x30 [ 13.876660][ C0] do_one_initcall+0x8f/0x1e0 [ 13.876871][ C0] do_initcalls+0x176/0x280 [ 13.877081][ C0] kernel_init_freeable+0x22d/0x300 [ 13.877298][ C0] kernel_init+0x20/0x200 [ 13.877510][ C0] ret_from_fork+0x240/0x320 [ 13.877732][ C0] ret_from_fork_asm+0x1a/0x30 [ 13.877944][ C0] irq event stamp: 413312 [ 13.878127][ C0] hardirqs last enabled at (413312): [] _raw_spin_unlock_irqrestore+0x5d/0x80 [ 13.878568][ C0] hardirqs last disabled at (413311): [] _raw_spin_lock_irqsave+0x5b/0x60 [ 13.879000][ C0] softirqs last enabled at (412900): [] handle_softirqs+0x358/0x620 [ 13.879567][ C0] softirqs last disabled at (412981): [] __irq_exit_rcu+0xfa/0x160 [ 13.879955][ C0] [ 13.879955][ C0] other info that might help us debug this: [ 13.880287][ C0] Possible unsafe locking scenario: [ 13.880287][ C0] [ 13.880609][ C0] CPU0 [ 13.880776][ C0] ---- [ 13.880940][ C0] lock(pin_fs_lock); [ 13.881123][ C0] [ 13.881298][ C0] lock(pin_fs_lock); [ 13.881469][ C0] [ 13.881469][ C0] *** DEADLOCK *** [ 13.881469][ C0] [ 13.881800][ C0] 1 lock held by swapper/0/0: [ 13.882020][ C0] #0: ffffffff995774c0 (rcu_callback){....}-{0:0}, at: rcu_do_batch+0x2e4/0xf20 [ 13.882427][ C0] [ 13.882427][ C0] stack backtrace: [ 13.882701][ C0] CPU: 0 UID: 0 PID: 0 Comm: swapper/0 Not tainted 6.15.0-virtme #1 PREEMPT(full) [ 13.882710][ C0] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 13.882711][ C0] Call Trace: [ 13.882720][ C0] [ 13.882721][ C0] dump_stack_lvl+0x82/0xd0 [ 13.882729][ C0] print_usage_bug.part.0+0x25f/0x360 [ 13.882735][ C0] mark_lock_irq+0x343/0x400 [ 13.882739][ C0] ? is_bpf_text_address+0x67/0x120 [ 13.882747][ C0] ? __lock_release+0x5d/0x170 [ 13.882751][ C0] ? save_trace+0x52/0x170 [ 13.882755][ C0] mark_lock+0x174/0x2f0 [ 13.882759][ C0] mark_usage+0x46/0x150 [ 13.882762][ C0] __lock_acquire+0x20b/0x7e0 [ 13.882766][ C0] ? __lock_acquire+0x44d/0x7e0 [ 13.882772][ C0] lock_acquire.part.0+0xb6/0x240 [ 13.882775][ C0] ? simple_pin_fs+0x24/0x150 [ 13.882779][ C0] ? rcu_is_watching+0x12/0xc0 [ 13.882785][ C0] ? lock_acquire+0x10c/0x170 [ 13.882788][ C0] ? simple_pin_fs+0x24/0x150 [ 13.882792][ C0] _raw_spin_lock+0x33/0x40 [ 13.882796][ C0] ? simple_pin_fs+0x24/0x150 [ 13.882799][ C0] simple_pin_fs+0x24/0x150 [ 13.882802][ C0] debugfs_remove+0x35/0x70 [ 13.882806][ C0] ref_tracker_dir_exit+0xcf/0x740 [ 13.882813][ C0] ? __pfx_ref_tracker_free+0x10/0x10 [ 13.882815][ C0] ? __sk_destruct+0x383/0x780 [ 13.882825][ C0] ? rcu_do_batch+0x34c/0xf20 [ 13.882828][ C0] ? __pfx_ref_tracker_dir_exit+0x10/0x10 [ 13.882831][ C0] ? irq_exit_rcu+0xe/0x30 [ 13.882834][ C0] ? sysvec_apic_timer_interrupt+0xa8/0xc0 [ 13.882840][ C0] ? asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 13.882844][ C0] ? finish_task_switch.isra.0+0x251/0x970 [ 13.882850][ C0] ? __schedule+0x86a/0x1b00 [ 13.882854][ C0] ? schedule_idle+0x61/0x90 [ 13.882857][ C0] ? do_idle+0x11f/0x160 [ 13.882864][ C0] ? cpu_startup_entry+0x54/0x60 [ 13.882867][ C0] ? rest_init+0x14b/0x260 [ 13.882870][ C0] ? start_kernel+0x350/0x410 [ 13.882875][ C0] ? x86_64_start_reservations+0x18/0x30 [ 13.882881][ C0] __put_net+0x19/0x60 [ 13.882887][ C0] __sk_destruct+0x58a/0x780 [ 13.882891][ C0] ? rcu_do_batch+0x34a/0xf20 [ 13.882894][ C0] rcu_do_batch+0x34c/0xf20 [ 13.882899][ C0] ? __pfx_rcu_do_batch+0x10/0x10 [ 13.882902][ C0] ? __lock_release+0x5d/0x170 [ 13.882906][ C0] ? rcu_is_watching+0x12/0xc0 [ 13.882909][ C0] ? _raw_spin_unlock_irqrestore+0x5d/0x80 [ 13.882914][ C0] rcu_core+0x2bb/0x500 [ 13.882920][ C0] handle_softirqs+0x218/0x620 [ 13.882926][ C0] __irq_exit_rcu+0xfa/0x160 [ 13.882929][ C0] irq_exit_rcu+0xe/0x30 [ 13.882932][ C0] sysvec_apic_timer_interrupt+0xa8/0xc0 [ 13.882936][ C0] [ 13.882937][ C0] [ 13.882938][ C0] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 13.882941][ C0] RIP: 0010:finish_task_switch.isra.0+0x251/0x970 [ 13.882945][ C0] Code: 4c 89 ff 48 c7 03 00 00 00 00 e8 f2 ed 4c 2a 4d 85 e4 75 ba 4c 89 ff e8 ad 14 89 02 e8 98 1f 31 00 fb 65 48 8b 1d f7 d2 1f 05 <66> 90 48 83 7d d0 00 74 55 65 48 8b 1d e6 d2 1f 05 48 8d bb 18 05 [ 13.882948][ C0] RSP: 0018:ffffffff99207ce8 EFLAGS: 00000206 [ 13.882953][ C0] RAX: 0000000000064d33 RBX: ffffffff9921f240 RCX: ffffffff96044b9f [ 13.882955][ C0] RDX: 0000000000000000 RSI: ffffffff9909175c RDI: ffffffff98853ca0 [ 13.882956][ C0] RBP: ffffffff99207d28 R08: 0000000000000001 R09: 0000000000000001 [ 13.882958][ C0] R10: ffffffff99fe7cd7 R11: ffff88802f438dd8 R12: ffff88802f438dd8 [ 13.882960][ C0] R13: ffff888008e08040 R14: ffff88802f439968 R15: ffff88802f438dc0 [ 13.882964][ C0] ? trace_irq_enable.constprop.0+0x2f/0x130 [ 13.882971][ C0] ? finish_task_switch.isra.0+0x248/0x970 [ 13.882974][ C0] ? __switch_to+0x503/0xd60 [ 13.882980][ C0] __schedule+0x86a/0x1b00 [ 13.882985][ C0] ? __pfx___schedule+0x10/0x10 [ 13.882989][ C0] ? trace_rcu_watching+0x121/0x1b0 [ 13.882996][ C0] ? rcu_is_watching+0x12/0xc0 [ 13.882999][ C0] ? default_idle_call+0x97/0xb0 [ 13.883002][ C0] ? lockdep_hardirqs_on+0x7c/0x110 [ 13.883007][ C0] ? rcu_is_watching+0x12/0xc0 [ 13.883010][ C0] ? tick_nohz_idle_exit+0x149/0x2c0 [ 13.883018][ C0] schedule_idle+0x61/0x90 [ 13.883021][ C0] do_idle+0x11f/0x160 [ 13.883025][ C0] cpu_startup_entry+0x54/0x60 [ 13.883028][ C0] rest_init+0x14b/0x260 [ 13.883032][ C0] start_kernel+0x350/0x410 [ 13.883036][ C0] x86_64_start_reservations+0x18/0x30 [ 13.883039][ C0] x86_64_start_kernel+0xf8/0x150 [ 13.883044][ C0] common_startup_64+0x13e/0x148 [ 13.883052][ C0] [ 13.905205][ C0] BUG: sleeping function called from invalid context at kernel/locking/rwsem.c:1576 [ 13.905650][ C0] in_atomic(): 1, irqs_disabled(): 0, non_block: 0, pid: 0, name: swapper/0 [ 13.906191][ C0] preempt_count: 101, expected: 0 [ 13.906474][ C0] RCU nest depth: 0, expected: 0 [ 13.906719][ C0] INFO: lockdep is turned off. [ 13.906951][ C0] Preemption disabled at: [ 13.906953][ C0] [] schedule_preempt_disabled+0x22/0x30 [ 13.907477][ C0] CPU: 0 UID: 0 PID: 0 Comm: swapper/0 Not tainted 6.15.0-virtme #1 PREEMPT(full) [ 13.907483][ C0] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 13.907486][ C0] Call Trace: [ 13.907489][ C0] [ 13.907491][ C0] dump_stack_lvl+0xb0/0xd0 [ 13.907498][ C0] __might_resched+0x360/0x5a0 [ 13.907513][ C0] down_write+0x72/0x210 [ 13.907517][ C0] ? __pfx_down_write+0x10/0x10 [ 13.907520][ C0] ? simple_recursive_removal+0x33/0x610 [ 13.907529][ C0] ? rcu_is_watching+0x12/0xc0 [ 13.907537][ C0] ? do_raw_spin_unlock+0x58/0x220 [ 13.907542][ C0] simple_recursive_removal+0x6a/0x610 [ 13.907545][ C0] ? do_raw_spin_unlock+0x58/0x220 [ 13.907547][ C0] ? __pfx_remove_one+0x10/0x10 [ 13.907554][ C0] debugfs_remove+0x44/0x70 [ 13.907558][ C0] ref_tracker_dir_exit+0xcf/0x740 [ 13.907564][ C0] ? __pfx_ref_tracker_free+0x10/0x10 [ 13.907566][ C0] ? __sk_destruct+0x383/0x780 [ 13.907573][ C0] ? rcu_do_batch+0x34c/0xf20 [ 13.907578][ C0] ? __pfx_ref_tracker_dir_exit+0x10/0x10 [ 13.907580][ C0] ? irq_exit_rcu+0xe/0x30 [ 13.907588][ C0] ? sysvec_apic_timer_interrupt+0xa8/0xc0 [ 13.907593][ C0] ? asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 13.907598][ C0] ? finish_task_switch.isra.0+0x251/0x970 [ 13.907603][ C0] ? __schedule+0x86a/0x1b00 [ 13.907608][ C0] ? schedule_idle+0x61/0x90 [ 13.907611][ C0] ? do_idle+0x11f/0x160 [ 13.907616][ C0] ? cpu_startup_entry+0x54/0x60 [ 13.907619][ C0] ? rest_init+0x14b/0x260 [ 13.907622][ C0] ? start_kernel+0x350/0x410 [ 13.907629][ C0] ? x86_64_start_reservations+0x18/0x30 [ 13.907636][ C0] __put_net+0x19/0x60 [ 13.907641][ C0] __sk_destruct+0x58a/0x780 [ 13.907645][ C0] ? rcu_do_batch+0x34a/0xf20 [ 13.907648][ C0] rcu_do_batch+0x34c/0xf20 [ 13.907653][ C0] ? __pfx_rcu_do_batch+0x10/0x10 [ 13.907657][ C0] ? __lock_release+0x5d/0x170 [ 13.907663][ C0] ? rcu_is_watching+0x12/0xc0 [ 13.907666][ C0] ? _raw_spin_unlock_irqrestore+0x5d/0x80 [ 13.907673][ C0] rcu_core+0x2bb/0x500 [ 13.907679][ C0] handle_softirqs+0x218/0x620 [ 13.907685][ C0] __irq_exit_rcu+0xfa/0x160 [ 13.907688][ C0] irq_exit_rcu+0xe/0x30 [ 13.907692][ C0] sysvec_apic_timer_interrupt+0xa8/0xc0 [ 13.907695][ C0] [ 13.907697][ C0] [ 13.907699][ C0] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 13.907701][ C0] RIP: 0010:finish_task_switch.isra.0+0x251/0x970 [ 13.907706][ C0] Code: 4c 89 ff 48 c7 03 00 00 00 00 e8 f2 ed 4c 2a 4d 85 e4 75 ba 4c 89 ff e8 ad 14 89 02 e8 98 1f 31 00 fb 65 48 8b 1d f7 d2 1f 05 <66> 90 48 83 7d d0 00 74 55 65 48 8b 1d e6 d2 1f 05 48 8d bb 18 05 [ 13.907709][ C0] RSP: 0018:ffffffff99207ce8 EFLAGS: 00000206 [ 13.907713][ C0] RAX: 0000000000064d33 RBX: ffffffff9921f240 RCX: ffffffff96044b9f [ 13.907715][ C0] RDX: 0000000000000000 RSI: ffffffff9909175c RDI: ffffffff98853ca0 [ 13.907717][ C0] RBP: ffffffff99207d28 R08: 0000000000000001 R09: 0000000000000001 [ 13.907719][ C0] R10: ffffffff99fe7cd7 R11: ffff88802f438dd8 R12: ffff88802f438dd8 [ 13.907721][ C0] R13: ffff888008e08040 R14: ffff88802f439968 R15: ffff88802f438dc0 [ 13.907725][ C0] ? trace_irq_enable.constprop.0+0x2f/0x130 [ 13.907732][ C0] ? finish_task_switch.isra.0+0x248/0x970 [ 13.907735][ C0] ? __switch_to+0x503/0xd60 [ 13.907740][ C0] __schedule+0x86a/0x1b00 [ 13.907746][ C0] ? __pfx___schedule+0x10/0x10 [ 13.907749][ C0] ? trace_rcu_watching+0x121/0x1b0 [ 13.907756][ C0] ? rcu_is_watching+0x12/0xc0 [ 13.907759][ C0] ? default_idle_call+0x97/0xb0 [ 13.907762][ C0] ? lockdep_hardirqs_on+0x7c/0x110 [ 13.907767][ C0] ? rcu_is_watching+0x12/0xc0 [ 13.907770][ C0] ? tick_nohz_idle_exit+0x149/0x2c0 [ 13.907777][ C0] schedule_idle+0x61/0x90 [ 13.907780][ C0] do_idle+0x11f/0x160 [ 13.907784][ C0] cpu_startup_entry+0x54/0x60 [ 13.907787][ C0] rest_init+0x14b/0x260 [ 13.907791][ C0] start_kernel+0x350/0x410 [ 13.907795][ C0] x86_64_start_reservations+0x18/0x30 [ 13.907799][ C0] x86_64_start_kernel+0xf8/0x150 [ 13.907804][ C0] common_startup_64+0x13e/0x148 [ 13.907813][ C0] [ 14.938447][ T230] icmps-discard_i (230) used greatest stack depth: 24736 bytes left [ 14.961346][ C3] BUG: sleeping function called from invalid context at kernel/locking/rwsem.c:1576 [ 14.961731][ C3] in_atomic(): 1, irqs_disabled(): 0, non_block: 0, pid: 32, name: ksoftirqd/3 [ 14.962055][ C3] preempt_count: 100, expected: 0 [ 14.962236][ C3] RCU nest depth: 0, expected: 0 [ 14.962421][ C3] INFO: lockdep is turned off. [ 14.962605][ C3] Preemption disabled at: [ 14.962607][ C3] [] handle_softirqs+0xe5/0x620 [ 14.962995][ C3] CPU: 3 UID: 0 PID: 32 Comm: ksoftirqd/3 Tainted: G W 6.15.0-virtme #1 PREEMPT(full) [ 14.963000][ C3] Tainted: [W]=WARN [ 14.963002][ C3] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 14.963004][ C3] Call Trace: [ 14.963006][ C3] [ 14.963008][ C3] dump_stack_lvl+0xb0/0xd0 [ 14.963018][ C3] __might_resched+0x360/0x5a0 [ 14.963028][ C3] down_write+0x72/0x210 [ 14.963036][ C3] ? __pfx_down_write+0x10/0x10 [ 14.963039][ C3] ? simple_recursive_removal+0x33/0x610 [ 14.963046][ C3] ? rcu_is_watching+0x12/0xc0 [ 14.963054][ C3] ? do_raw_spin_unlock+0x58/0x220 [ 14.963059][ C3] simple_recursive_removal+0x6a/0x610 [ 14.963062][ C3] ? do_raw_spin_unlock+0x58/0x220 [ 14.963065][ C3] ? __pfx_remove_one+0x10/0x10 [ 14.963072][ C3] debugfs_remove+0x44/0x70 [ 14.963076][ C3] ref_tracker_dir_exit+0xcf/0x740 [ 14.963082][ C3] ? __pfx_ref_tracker_free+0x10/0x10 [ 14.963085][ C3] ? __sk_destruct+0x383/0x780 [ 14.963092][ C3] ? rcu_do_batch+0x34c/0xf20 [ 14.963097][ C3] ? __pfx_ref_tracker_dir_exit+0x10/0x10 [ 14.963100][ C3] ? smpboot_thread_fn+0x30a/0x960 [ 14.963103][ C3] ? kthread+0x37e/0x600 [ 14.963106][ C3] ? ret_from_fork+0x240/0x320 [ 14.963111][ C3] ? ret_from_fork_asm+0x1a/0x30 [ 14.963115][ C3] ? migrate_enable+0x1f2/0x270 [ 14.963121][ C3] ? __pfx_migrate_enable+0x10/0x10 [ 14.963125][ C3] ? bpf_sk_storage_free+0x9f/0x1c0 [ 14.963130][ C3] ? rcu_is_watching+0x12/0xc0 [ 14.963134][ C3] __put_net+0x19/0x60 [ 14.963140][ C3] __sk_destruct+0x58a/0x780 [ 14.963144][ C3] ? rcu_do_batch+0x34a/0xf20 [ 14.963147][ C3] rcu_do_batch+0x34c/0xf20 [ 14.963151][ C3] ? __pfx_rcu_do_batch+0x10/0x10 [ 14.963156][ C3] ? rcu_is_watching+0x12/0xc0 [ 14.963161][ C3] rcu_core+0x2bb/0x500 [ 14.963166][ C3] handle_softirqs+0x218/0x620 [ 14.963171][ C3] ? __pfx_run_ksoftirqd+0x10/0x10 [ 14.963175][ C3] run_ksoftirqd+0x3f/0x70 [ 14.963178][ C3] smpboot_thread_fn+0x30a/0x960 [ 14.963181][ C3] ? __pfx_smpboot_thread_fn+0x10/0x10 [ 14.963184][ C3] kthread+0x37e/0x600 [ 14.963187][ C3] ? __pfx_kthread+0x10/0x10 [ 14.963190][ C3] ? ret_from_fork+0x1b/0x320 [ 14.963192][ C3] ? __lock_release+0x5d/0x170 [ 14.963200][ C3] ? rcu_is_watching+0x12/0xc0 [ 14.963203][ C3] ? __pfx_kthread+0x10/0x10 [ 14.963206][ C3] ret_from_fork+0x240/0x320 [ 14.963209][ C3] ? __pfx_kthread+0x10/0x10 [ 14.963212][ C3] ret_from_fork_asm+0x1a/0x30 [ 14.963218][ C3]