[ 28.584741][ T299] nstat (299) used greatest stack depth: 23712 bytes left [ 28.584757][ T299] BUG: sleeping function called from invalid context at ./include/linux/sched/mm.h:322 [ 28.584759][ T299] in_atomic(): 1, irqs_disabled(): 1, non_block: 0, pid: 299, name: nstat [ 28.584761][ T299] preempt_count: 2, expected: 0 [ 28.584761][ T299] RCU nest depth: 0, expected: 0 [ 28.584763][ T299] locks held by nstat/299: 5, last CPU#0: [ 28.584765][ T299] #0: ffffffffbce267b8 (low_water_lock){+.+.}-{3:3}, at: do_exit+0x887/0xdc0 [ 28.584777][ T299] #1: ffffffffbcf8dcc0 (console_lock){+.+.}-{0:0}, at: vprintk_emit+0x320/0x3e0 [ 28.584782][ T299] #2: ffffffffbcf8dd38 (console_srcu){....}-{0:0}, at: console_flush_one_record+0x106/0x710 [ 28.584786][ T299] #3: ffffffffbcead660 (console_owner){....}-{0:0}, at: console_lock_spinning_enable+0x40/0x60 [ 28.584789][ T299] #4: ffffffffbcead560 (printk_legacy_map-wait-type-override){....}-{3:3}, at: console_emit_next_record+0x1df/0x4c0 [ 28.584793][ T299] irq event stamp: 51760 [ 28.584793][ T299] hardirqs last enabled at (51759): [] __down_trylock_console_sem+0x86/0xa0 [ 28.584795][ T299] hardirqs last disabled at (51760): [] console_emit_next_record+0x3d4/0x4c0 [ 28.584797][ T299] softirqs last enabled at (50774): [] handle_softirqs+0x67c/0x900 [ 28.584799][ T299] softirqs last disabled at (50769): [] __irq_exit_rcu+0x145/0x1c0 [ 28.584801][ T299] Preemption disabled at: [ 28.584802][ T299] [<0000000000000000>] 0x0 [ 28.584808][ T299] CPU: 0 UID: 0 PID: 299 Comm: nstat Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 28.584812][ T299] Tainted: [W]=WARN [ 28.584813][ T299] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 28.584814][ T299] Call Trace: [ 28.584816][ T299] [ 28.584818][ T299] dump_stack_lvl+0x6f/0xa0 [ 28.584824][ T299] __might_resched.cold+0x1fe/0x2c1 [ 28.584828][ T299] ? perf_trace_sched_switch+0x7c0/0x7c0 [ 28.584832][ T299] ? __kmalloc_noprof+0xdb/0x760 [ 28.584837][ T299] __kmalloc_noprof+0x443/0x760 [ 28.584839][ T299] ? alloc_buf.isra.0+0x4b/0x260 [ 28.584845][ T299] ? do_raw_spin_unlock+0x59/0x250 [ 28.584848][ T299] alloc_buf.isra.0+0x4b/0x260 [ 28.584857][ T299] put_chars+0x1e1/0x2f0 [ 28.584860][ T299] ? __send_to_port+0x420/0x420 [ 28.584862][ T299] ? rcu_lockdep_current_cpu_online+0x3f/0x1b0 [ 28.584867][ T299] ? validate_chain+0x38b/0xc20 [ 28.584872][ T299] hvc_console_print+0x292/0x780 [ 28.584879][ T299] ? hvc_write+0x3a0/0x3a0 [ 28.584881][ T299] ? rcu_is_watching+0x16/0xd0 [ 28.584883][ T299] ? lock_acquire+0x13c/0x160 [ 28.584887][ T299] console_emit_next_record+0x22f/0x4c0 [ 28.584890][ T299] ? devkmsg_read+0x4b0/0x4b0 [ 28.584892][ T299] ? console_flush_one_record+0x106/0x710 [ 28.584895][ T299] ? rcu_is_watching+0x16/0xd0 [ 28.584897][ T299] ? lock_acquire+0x13c/0x160 [ 28.584901][ T299] console_flush_one_record+0x46f/0x710 [ 28.584904][ T299] ? console_emit_next_record+0x4c0/0x4c0 [ 28.584906][ T299] ? __lock_acquire+0x518/0xc20 [ 28.584911][ T299] console_unlock+0xee/0x1f0 [ 28.584913][ T299] ? console_flush_one_record+0x710/0x710 [ 28.584915][ T299] ? rcu_is_watching+0x16/0xd0 [ 28.584917][ T299] ? lock_acquire+0x60/0x160 [ 28.584920][ T299] ? __down_trylock_console_sem+0x5e/0xa0 [ 28.584922][ T299] ? vprintk_emit+0x320/0x3e0 [ 28.584925][ T299] vprintk_emit+0x37c/0x3e0 [ 28.584928][ T299] ? wake_up_klogd_work_func+0x90/0x90 [ 28.584931][ T299] ? __lock_acquire+0x518/0xc20 [ 28.584935][ T299] _printk+0xc7/0x100 [ 28.584938][ T299] ? snapshot_read.cold+0x21/0x21 [ 28.584941][ T299] ? do_raw_spin_lock+0x131/0x280 [ 28.584943][ T299] ? __rwlock_init+0x150/0x150 [ 28.584947][ T299] ? do_raw_spin_lock+0x131/0x280 [ 28.584949][ T299] do_exit.cold+0x82/0x9c [ 28.584953][ T299] ? exit_notify+0x890/0x890 [ 28.584955][ T299] ? __lock_release.isra.0+0x69/0x1a0 [ 28.584957][ T299] ? rcu_is_watching+0x16/0xd0 [ 28.584961][ T299] do_group_exit+0xb8/0x370 [ 28.584964][ T299] __x64_sys_exit_group+0x3c/0x50 [ 28.584966][ T299] x64_sys_call+0x1567/0x1570 [ 28.584968][ T299] do_syscall_64+0xff/0x530 [ 28.584971][ T299] ? exc_page_fault+0xee/0x100 [ 28.584975][ T299] entry_SYSCALL_64_after_hwframe+0x4b/0x53 [ 28.584977][ T299] RIP: 0033:0x7f77f11b71b8 [ 28.584979][ T299] Code: Unable to access opcode bytes at 0x7f77f11b718e. [ 28.584980][ T299] RSP: 002b:00007ffc229df908 EFLAGS: 00000246 ORIG_RAX: 00000000000000e7 [ 28.584983][ T299] RAX: ffffffffffffffda RBX: 00007f77f12e7f88 RCX: 00007f77f11b71b8 [ 28.584984][ T299] RDX: 00007f77f0fdea88 RSI: ffffffffffffffa0 RDI: 0000000000000000 [ 28.584985][ T299] RBP: 00007ffc229df960 R08: 0000000000000000 R09: 0000000000000000 [ 28.584986][ T299] R10: 00007ffc229df740 R11: 0000000000000246 R12: 0000000000000001 [ 28.584986][ T299] R13: 0000000000000000 R14: 00007f77f12e6680 R15: 00007f77f12e7fa0 [ 28.584993][ T299] [ 70.410459][ C0] clocksource: Watchdog remote CPU 3 read timed out [ 70.410882][ C0] [ 70.410885][ C0] ======================================================== [ 70.410886][ C0] WARNING: possible irq lock inversion dependency detected [ 70.410888][ C0] 7.2.0-virtme #1 Tainted: G W [ 70.410890][ C0] -------------------------------------------------------- [ 70.410890][ C0] swapper/0/0 just changed the state of lock: [ 70.410892][ C0] ffffffffbcead660 (console_owner){..-.}-{0:0}, at: console_lock_spinning_enable+0x40/0x60 [ 70.410904][ C0] but this lock took another, SOFTIRQ-unsafe lock in the past: [ 70.410905][ C0] (fs_reclaim){+.+.}-{0:0} [ 70.410906][ C0] [ 70.410906][ C0] [ 70.410906][ C0] and interrupts could create inverse lock ordering between them. [ 70.410906][ C0] [ 70.410907][ C0] [ 70.410907][ C0] other info that might help us debug this: [ 70.410908][ C0] Possible interrupt unsafe locking scenario: [ 70.410908][ C0] [ 70.410909][ C0] CPU0 CPU1 [ 70.410909][ C0] ---- ---- [ 70.410909][ C0] lock(fs_reclaim); [ 70.410910][ C0] local_irq_disable(); [ 70.410911][ C0] lock(console_owner); [ 70.410912][ C0] lock(fs_reclaim); [ 70.410913][ C0] [ 70.410913][ C0] lock(console_owner); [ 70.410914][ C0] [ 70.410914][ C0] *** DEADLOCK *** [ 70.410914][ C0] [ 70.410914][ C0] locks held by swapper/0/0: 4, last CPU#0: [ 70.410916][ C0] #0: ffa0000000007c90 ((&watchdog_timer)){+.-.}-{0:0}, at: call_timer_fn+0x110/0x4d0 [ 70.410921][ C0] #1: ffffffffbcff28b8 (watchdog_lock){+.-.}-{3:3}, at: clocksource_watchdog+0x15/0x30 [ 70.410925][ C0] #2: ffffffffbcf8dcc0 (console_lock){+.+.}-{0:0}, at: vprintk_emit+0x320/0x3e0 [ 70.410929][ C0] #3: ffffffffbcf8dd38 (console_srcu){....}-{0:0}, at: console_flush_one_record+0x106/0x710 [ 70.410932][ C0] [ 70.410932][ C0] the shortest dependencies between 2nd lock and 1st lock: [ 70.410936][ C0] -> (fs_reclaim){+.+.}-{0:0} { [ 70.410939][ C0] HARDIRQ-ON-W at: [ 70.410940][ C0] __lock_acquire+0x388/0xc20 [ 70.410943][ C0] lock_acquire.part.0+0xd4/0x280 [ 70.410944][ C0] fs_reclaim_acquire+0xd5/0x120 [ 70.410948][ C0] __kmalloc_cache_noprof+0x6e/0x620 [ 70.410950][ C0] kthread_create_worker_on_node+0xea/0x210 [ 70.410953][ C0] workqueue_init+0x2a/0x680 [ 70.410956][ C0] kernel_init_freeable+0x2fe/0x630 [ 70.410959][ C0] kernel_init+0x21/0x150 [ 70.410962][ C0] ret_from_fork+0x474/0x6b0 [ 70.410966][ C0] ret_from_fork_asm+0x11/0x20 [ 70.410975][ C0] SOFTIRQ-ON-W at: [ 70.410976][ C0] __lock_acquire+0x388/0xc20 [ 70.410978][ C0] lock_acquire.part.0+0xd4/0x280 [ 70.410979][ C0] fs_reclaim_acquire+0xd5/0x120 [ 70.410980][ C0] __kmalloc_cache_noprof+0x6e/0x620 [ 70.410982][ C0] kthread_create_worker_on_node+0xea/0x210 [ 70.410983][ C0] workqueue_init+0x2a/0x680 [ 70.410984][ C0] kernel_init_freeable+0x2fe/0x630 [ 70.410985][ C0] kernel_init+0x21/0x150 [ 70.410987][ C0] ret_from_fork+0x474/0x6b0 [ 70.410988][ C0] ret_from_fork_asm+0x11/0x20 [ 70.410989][ C0] INITIAL USE at: [ 70.410990][ C0] __lock_acquire+0x388/0xc20 [ 70.410991][ C0] lock_acquire.part.0+0xd4/0x280 [ 70.410993][ C0] fs_reclaim_acquire+0xd5/0x120 [ 70.410994][ C0] __kmalloc_cache_noprof+0x6e/0x620 [ 70.410996][ C0] kthread_create_worker_on_node+0xea/0x210 [ 70.410997][ C0] workqueue_init+0x2a/0x680 [ 70.410998][ C0] kernel_init_freeable+0x2fe/0x630 [ 70.410999][ C0] kernel_init+0x21/0x150 [ 70.411001][ C0] ret_from_fork+0x474/0x6b0 [ 70.411003][ C0] ret_from_fork_asm+0x11/0x20 [ 70.411004][ C0] } [ 70.411004][ C0] ... key at: [] __fs_reclaim_map+0x0/0xbe0 [ 70.411008][ C0] ... acquired at: [ 70.411009][ C0] __lock_acquire+0x518/0xc20 [ 70.411010][ C0] lock_acquire.part.0+0xd4/0x280 [ 70.411011][ C0] fs_reclaim_acquire+0xd5/0x120 [ 70.411013][ C0] __kmalloc_noprof+0xd3/0x760 [ 70.411014][ C0] alloc_buf.isra.0+0x4b/0x260 [ 70.411018][ C0] put_chars+0x1e1/0x2f0 [ 70.411020][ C0] hvc_console_print+0x292/0x780 [ 70.411023][ C0] console_emit_next_record+0x22f/0x4c0 [ 70.411024][ C0] console_flush_one_record+0x46f/0x710 [ 70.411026][ C0] console_unlock+0xee/0x1f0 [ 70.411027][ C0] vprintk_emit+0x37c/0x3e0 [ 70.411029][ C0] dev_vprintk_emit+0x27f/0x2c0 [ 70.411032][ C0] dev_printk_emit+0xb9/0xee [ 70.411033][ C0] _dev_info+0xe2/0x116 [ 70.411035][ C0] __devm_rtc_register_device.cold+0xc3/0x3a8 [ 70.411037][ C0] cmos_do_probe+0x73b/0x98a [ 70.411038][ C0] platform_probe+0xfe/0x1f0 [ 70.411041][ C0] call_driver_probe+0x61/0x1c0 [ 70.411043][ C0] really_probe+0x199/0x760 [ 70.411044][ C0] __driver_probe_device+0x24f/0x440 [ 70.411045][ C0] driver_probe_device+0x4a/0xf0 [ 70.411047][ C0] __driver_attach+0x1b8/0x540 [ 70.411048][ C0] bus_for_each_dev+0x130/0x1e0 [ 70.411049][ C0] bus_add_driver+0x2c8/0x530 [ 70.411050][ C0] driver_register+0x1a3/0x390 [ 70.411052][ C0] __platform_driver_probe+0x13f/0x270 [ 70.411053][ C0] cmos_init+0x31/0x40 [ 70.411056][ C0] do_one_initcall+0x124/0x4f0 [ 70.411057][ C0] kernel_init_freeable+0x596/0x630 [ 70.411058][ C0] kernel_init+0x21/0x150 [ 70.411060][ C0] ret_from_fork+0x474/0x6b0 [ 70.411062][ C0] ret_from_fork_asm+0x11/0x20 [ 70.411063][ C0] [ 70.411063][ C0] -> (console_owner){..-.}-{0:0} { [ 70.411065][ C0] IN-SOFTIRQ-W at: [ 70.411066][ C0] __lock_acquire+0x388/0xc20 [ 70.411068][ C0] lock_acquire.part.0+0xd4/0x280 [ 70.411069][ C0] console_lock_spinning_enable+0x5c/0x60 [ 70.411070][ C0] console_emit_next_record+0x1d1/0x4c0 [ 70.411072][ C0] console_flush_one_record+0x46f/0x710 [ 70.411073][ C0] console_unlock+0xee/0x1f0 [ 70.411075][ C0] vprintk_emit+0x37c/0x3e0 [ 70.411076][ C0] _printk+0xc7/0x100 [ 70.411080][ C0] clocksource_watchdog.part.0.cold+0x105/0x1dd [ 70.411082][ C0] call_timer_fn+0x160/0x4d0 [ 70.411084][ C0] __run_timers+0x68f/0xaa0 [ 70.411085][ C0] run_timer_softirq+0xf0/0x160 [ 70.411086][ C0] handle_softirqs+0x1d3/0x900 [ 70.411089][ C0] __irq_exit_rcu+0x145/0x1c0 [ 70.411090][ C0] irq_exit_rcu+0xe/0x30 [ 70.411091][ C0] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 70.411093][ C0] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 70.411095][ C0] pv_native_safe_halt+0xf/0x10 [ 70.411097][ C0] default_idle+0x9/0x10 [ 70.411099][ C0] default_idle_call+0x6e/0xb0 [ 70.411100][ C0] cpuidle_idle_call.constprop.0+0x237/0x410 [ 70.411102][ C0] do_idle+0xd8/0x190 [ 70.411103][ C0] cpu_startup_entry+0x53/0x70 [ 70.411104][ C0] rest_init+0x279/0x280 [ 70.411106][ C0] start_kernel+0x3af/0x3b0 [ 70.411107][ C0] x86_64_start_reservations+0x24/0x30 [ 70.411109][ C0] x86_64_start_kernel+0x12b/0x130 [ 70.411111][ C0] common_startup_64+0x13e/0x148 [ 70.411113][ C0] INITIAL USE at: [ 70.411114][ C0] } [ 70.411114][ C0] ... key at: [] console_owner_dep_map+0x0/0x60 [ 70.411117][ C0] ... acquired at: [ 70.411117][ C0] mark_lock+0x1d7/0xa00 [ 70.411119][ C0] mark_usage+0x42/0x170 [ 70.411120][ C0] __lock_acquire+0x388/0xc20 [ 70.411121][ C0] lock_acquire.part.0+0xd4/0x280 [ 70.411122][ C0] console_lock_spinning_enable+0x5c/0x60 [ 70.411124][ C0] console_emit_next_record+0x1d1/0x4c0 [ 70.411125][ C0] console_flush_one_record+0x46f/0x710 [ 70.411127][ C0] console_unlock+0xee/0x1f0 [ 70.411128][ C0] vprintk_emit+0x37c/0x3e0 [ 70.411129][ C0] _printk+0xc7/0x100 [ 70.411131][ C0] clocksource_watchdog.part.0.cold+0x105/0x1dd [ 70.411132][ C0] call_timer_fn+0x160/0x4d0 [ 70.411133][ C0] __run_timers+0x68f/0xaa0 [ 70.411135][ C0] run_timer_softirq+0xf0/0x160 [ 70.411136][ C0] handle_softirqs+0x1d3/0x900 [ 70.411137][ C0] __irq_exit_rcu+0x145/0x1c0 [ 70.411138][ C0] irq_exit_rcu+0xe/0x30 [ 70.411139][ C0] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 70.411141][ C0] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 70.411142][ C0] pv_native_safe_halt+0xf/0x10 [ 70.411143][ C0] default_idle+0x9/0x10 [ 70.411145][ C0] default_idle_call+0x6e/0xb0 [ 70.411147][ C0] cpuidle_idle_call.constprop.0+0x237/0x410 [ 70.411148][ C0] do_idle+0xd8/0x190 [ 70.411149][ C0] cpu_startup_entry+0x53/0x70 [ 70.411150][ C0] rest_init+0x279/0x280 [ 70.411151][ C0] start_kernel+0x3af/0x3b0 [ 70.411152][ C0] x86_64_start_reservations+0x24/0x30 [ 70.411154][ C0] x86_64_start_kernel+0x12b/0x130 [ 70.411155][ C0] common_startup_64+0x13e/0x148 [ 70.411156][ C0] [ 70.411157][ C0] [ 70.411157][ C0] stack backtrace: [ 70.411159][ C0] CPU: 0 UID: 0 PID: 0 Comm: swapper/0 Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 70.411163][ C0] Tainted: [W]=WARN [ 70.411164][ C0] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 70.411165][ C0] Call Trace: [ 70.411167][ C0] [ 70.411168][ C0] dump_stack_lvl+0x6f/0xa0 [ 70.411171][ C0] print_irq_inversion_bug.part.0.cold+0xe6/0x143 [ 70.411174][ C0] mark_lock_irq+0x989/0x9c0 [ 70.411175][ C0] ? add_lock_to_list+0x2c/0x1a0 [ 70.411178][ C0] mark_lock+0x1d7/0xa00 [ 70.411179][ C0] mark_usage+0x42/0x170 [ 70.411181][ C0] __lock_acquire+0x388/0xc20 [ 70.411183][ C0] lock_acquire.part.0+0xd4/0x280 [ 70.411184][ C0] ? console_lock_spinning_enable+0x40/0x60 [ 70.411186][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411189][ C0] ? lock_acquire+0x13c/0x160 [ 70.411191][ C0] console_lock_spinning_enable+0x5c/0x60 [ 70.411192][ C0] ? console_lock_spinning_enable+0x40/0x60 [ 70.411194][ C0] console_emit_next_record+0x1d1/0x4c0 [ 70.411196][ C0] ? devkmsg_read+0x4b0/0x4b0 [ 70.411197][ C0] ? console_flush_one_record+0x106/0x710 [ 70.411199][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411201][ C0] ? lock_acquire+0x13c/0x160 [ 70.411202][ C0] console_flush_one_record+0x46f/0x710 [ 70.411204][ C0] ? console_emit_next_record+0x4c0/0x4c0 [ 70.411206][ C0] ? __lock_acquire+0x518/0xc20 [ 70.411208][ C0] console_unlock+0xee/0x1f0 [ 70.411210][ C0] ? console_flush_one_record+0x710/0x710 [ 70.411211][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411213][ C0] ? lock_acquire+0x60/0x160 [ 70.411214][ C0] ? __down_trylock_console_sem+0x5e/0xa0 [ 70.411216][ C0] ? vprintk_emit+0x320/0x3e0 [ 70.411218][ C0] vprintk_emit+0x37c/0x3e0 [ 70.411220][ C0] ? wake_up_klogd_work_func+0x90/0x90 [ 70.411222][ C0] ? clocksource_watchdog.part.0+0x450/0x540 [ 70.411224][ C0] _printk+0xc7/0x100 [ 70.411225][ C0] ? snapshot_read.cold+0x21/0x21 [ 70.411227][ C0] ? clocksource_watchdog.part.0+0x450/0x540 [ 70.411228][ C0] ? __lock_release.isra.0+0x69/0x1a0 [ 70.411231][ C0] clocksource_watchdog.part.0.cold+0x105/0x1dd [ 70.411232][ C0] ? clocksource_watchdog.part.0+0x540/0x540 [ 70.411234][ C0] ? clocksource_watchdog.part.0+0x540/0x540 [ 70.411235][ C0] call_timer_fn+0x160/0x4d0 [ 70.411237][ C0] ? detach_if_pending+0x1d0/0x1d0 [ 70.411238][ C0] ? debug_object_active_state+0x430/0x430 [ 70.411241][ C0] ? find_held_lock+0x2b/0x80 [ 70.411244][ C0] ? __lock_release.isra.0+0x69/0x1a0 [ 70.411245][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411247][ C0] __run_timers+0x68f/0xaa0 [ 70.411249][ C0] ? clocksource_watchdog.part.0+0x540/0x540 [ 70.411251][ C0] ? __bpf_trace_itimer_expire+0x10/0x10 [ 70.411252][ C0] ? __lock_acquire+0x518/0xc20 [ 70.411255][ C0] ? __rwlock_init+0x150/0x150 [ 70.411257][ C0] run_timer_softirq+0xf0/0x160 [ 70.411259][ C0] ? __run_timers+0xaa0/0xaa0 [ 70.411260][ C0] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 70.411263][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411265][ C0] handle_softirqs+0x1d3/0x900 [ 70.411266][ C0] ? __lock_release.isra.0+0x69/0x1a0 [ 70.411268][ C0] ? _local_bh_enable+0xc0/0xc0 [ 70.411270][ C0] __irq_exit_rcu+0x145/0x1c0 [ 70.411271][ C0] irq_exit_rcu+0xe/0x30 [ 70.411272][ C0] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 70.411274][ C0] [ 70.411274][ C0] [ 70.411275][ C0] ? lockdep_hardirqs_on_prepare.part.0+0x9a/0x160 [ 70.411277][ C0] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 70.411278][ C0] RIP: 0010:pv_native_safe_halt+0xf/0x10 [ 70.411281][ C0] Code: 48 8b 3d 94 a2 10 02 e8 1f 00 00 00 48 2b 05 58 f3 ab 00 c3 0f 1f 80 00 00 00 00 f3 0f 1e fa eb 07 0f 00 2d 13 d6 25 00 fb f4 0f 1f 40 d6 48 83 ec 20 8b 17 49 89 f8 83 e2 fe 41 89 d2 0f 01 [ 70.411283][ C0] RSP: 0018:ffffffffbcc07cf8 EFLAGS: 00000296 [ 70.411285][ C0] RAX: 000000000042e345 RBX: ffffffffbcc40600 RCX: ffffffffb9af3307 [ 70.411286][ C0] RDX: ffffffffbcc40600 RSI: ffffffffbca57571 RDI: ffffffffbc48d8e0 [ 70.411287][ C0] RBP: 0000000000000000 R08: 0000000000000000 R09: 0000000000000000 [ 70.411288][ C0] R10: 0000000000000000 R11: 0000000000000001 R12: 1ffffffff7980fa2 [ 70.411289][ C0] R13: 0000000000000000 R14: dffffc0000000000 R15: 0000000000014770 [ 70.411291][ C0] ? cpuidle_idle_call.constprop.0+0x237/0x410 [ 70.411293][ C0] ? lockdep_hardirqs_on+0x91/0x130 [ 70.411294][ C0] default_idle+0x9/0x10 [ 70.411296][ C0] default_idle_call+0x6e/0xb0 [ 70.411298][ C0] cpuidle_idle_call.constprop.0+0x237/0x410 [ 70.411299][ C0] ? arch_cpu_idle_exit+0x40/0x40 [ 70.411301][ C0] ? mark_tsc_async_resets+0x30/0x30 [ 70.411303][ C0] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 70.411305][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411307][ C0] do_idle+0xd8/0x190 [ 70.411308][ C0] cpu_startup_entry+0x53/0x70 [ 70.411310][ C0] rest_init+0x279/0x280 [ 70.411311][ C0] ? __cpuidle_text_end+0x3b/0x3b [ 70.411314][ C0] ? rest_init+0x280/0x280 [ 70.411316][ C0] ? acpi_hw_set_mode+0x4a0/0x4a0 [ 70.411323][ C0] ? cpus_read_unlock+0x4f/0xc0 [ 70.411326][ C0] ? acpi_enable+0x1e4/0x330 [ 70.411328][ C0] start_kernel+0x3af/0x3b0 [ 70.411329][ C0] x86_64_start_reservations+0x24/0x30 [ 70.411331][ C0] x86_64_start_kernel+0x12b/0x130 [ 70.411333][ C0] common_startup_64+0x13e/0x148 [ 70.411336][ C0] [ 70.411340][ C0] BUG: sleeping function called from invalid context at ./include/linux/sched/mm.h:322 [ 70.411342][ C0] in_atomic(): 1, irqs_disabled(): 1, non_block: 0, pid: 0, name: swapper/0 [ 70.411343][ C0] preempt_count: 103, expected: 0 [ 70.411344][ C0] RCU nest depth: 0, expected: 0 [ 70.411344][ C0] INFO: lockdep is turned off. [ 70.411345][ C0] irq event stamp: 4383573 [ 70.411346][ C0] hardirqs last enabled at (4383572): [] __down_trylock_console_sem+0x86/0xa0 [ 70.411348][ C0] hardirqs last disabled at (4383573): [] console_emit_next_record+0x3d4/0x4c0 [ 70.411349][ C0] softirqs last enabled at (4383540): [] handle_softirqs+0x67c/0x900 [ 70.411351][ C0] softirqs last disabled at (4383559): [] __irq_exit_rcu+0x145/0x1c0 [ 70.411352][ C0] Preemption disabled at: [ 70.411353][ C0] [] schedule_preempt_disabled+0x22/0x30 [ 70.411356][ C0] CPU: 0 UID: 0 PID: 0 Comm: swapper/0 Tainted: G W 7.2.0-virtme #1 PREEMPT(full) [ 70.411358][ C0] Tainted: [W]=WARN [ 70.411358][ C0] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 70.411359][ C0] Call Trace: [ 70.411359][ C0] [ 70.411360][ C0] dump_stack_lvl+0x6f/0xa0 [ 70.411362][ C0] ? schedule_preempt_disabled+0x22/0x30 [ 70.411363][ C0] __might_resched.cold+0x1fe/0x2c1 [ 70.411366][ C0] ? perf_trace_sched_switch+0x7c0/0x7c0 [ 70.411369][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411371][ C0] __kmalloc_noprof+0x443/0x760 [ 70.411372][ C0] ? __rwlock_init+0x150/0x150 [ 70.411374][ C0] ? alloc_buf.isra.0+0x4b/0x260 [ 70.411376][ C0] ? do_raw_spin_unlock+0x59/0x250 [ 70.411377][ C0] alloc_buf.isra.0+0x4b/0x260 [ 70.411380][ C0] put_chars+0x1e1/0x2f0 [ 70.411382][ C0] ? __send_to_port+0x420/0x420 [ 70.411384][ C0] ? mark_lock+0x1d7/0xa00 [ 70.411386][ C0] hvc_console_print+0x292/0x780 [ 70.411389][ C0] ? hvc_write+0x3a0/0x3a0 [ 70.411391][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411393][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411395][ C0] console_emit_next_record+0x22f/0x4c0 [ 70.411397][ C0] ? devkmsg_read+0x4b0/0x4b0 [ 70.411398][ C0] ? console_flush_one_record+0x106/0x710 [ 70.411400][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411402][ C0] ? lock_acquire+0x13c/0x160 [ 70.411404][ C0] console_flush_one_record+0x46f/0x710 [ 70.411406][ C0] ? console_emit_next_record+0x4c0/0x4c0 [ 70.411407][ C0] ? __lock_acquire+0x518/0xc20 [ 70.411409][ C0] console_unlock+0xee/0x1f0 [ 70.411411][ C0] ? console_flush_one_record+0x710/0x710 [ 70.411412][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411414][ C0] ? lock_acquire+0x60/0x160 [ 70.411415][ C0] ? __down_trylock_console_sem+0x5e/0xa0 [ 70.411417][ C0] ? vprintk_emit+0x320/0x3e0 [ 70.411419][ C0] vprintk_emit+0x37c/0x3e0 [ 70.411420][ C0] ? wake_up_klogd_work_func+0x90/0x90 [ 70.411423][ C0] ? clocksource_watchdog.part.0+0x450/0x540 [ 70.411424][ C0] _printk+0xc7/0x100 [ 70.411426][ C0] ? snapshot_read.cold+0x21/0x21 [ 70.411428][ C0] ? clocksource_watchdog.part.0+0x450/0x540 [ 70.411429][ C0] ? __lock_release.isra.0+0x69/0x1a0 [ 70.411431][ C0] clocksource_watchdog.part.0.cold+0x105/0x1dd [ 70.411433][ C0] ? clocksource_watchdog.part.0+0x540/0x540 [ 70.411434][ C0] ? clocksource_watchdog.part.0+0x540/0x540 [ 70.411436][ C0] call_timer_fn+0x160/0x4d0 [ 70.411437][ C0] ? detach_if_pending+0x1d0/0x1d0 [ 70.411439][ C0] ? debug_object_active_state+0x430/0x430 [ 70.411440][ C0] ? find_held_lock+0x2b/0x80 [ 70.411442][ C0] ? __lock_release.isra.0+0x69/0x1a0 [ 70.411444][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411446][ C0] __run_timers+0x68f/0xaa0 [ 70.411447][ C0] ? clocksource_watchdog.part.0+0x540/0x540 [ 70.411449][ C0] ? __bpf_trace_itimer_expire+0x10/0x10 [ 70.411451][ C0] ? __lock_acquire+0x518/0xc20 [ 70.411453][ C0] ? __rwlock_init+0x150/0x150 [ 70.411455][ C0] run_timer_softirq+0xf0/0x160 [ 70.411457][ C0] ? __run_timers+0xaa0/0xaa0 [ 70.411459][ C0] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 70.411462][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411464][ C0] handle_softirqs+0x1d3/0x900 [ 70.411467][ C0] ? __lock_release.isra.0+0x69/0x1a0 [ 70.411469][ C0] ? _local_bh_enable+0xc0/0xc0 [ 70.411472][ C0] __irq_exit_rcu+0x145/0x1c0 [ 70.411473][ C0] irq_exit_rcu+0xe/0x30 [ 70.411475][ C0] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 70.411478][ C0] [ 70.411479][ C0] [ 70.411479][ C0] ? lockdep_hardirqs_on_prepare.part.0+0x9a/0x160 [ 70.411482][ C0] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 70.411484][ C0] RIP: 0010:pv_native_safe_halt+0xf/0x10 [ 70.411486][ C0] Code: 48 8b 3d 94 a2 10 02 e8 1f 00 00 00 48 2b 05 58 f3 ab 00 c3 0f 1f 80 00 00 00 00 f3 0f 1e fa eb 07 0f 00 2d 13 d6 25 00 fb f4 0f 1f 40 d6 48 83 ec 20 8b 17 49 89 f8 83 e2 fe 41 89 d2 0f 01 [ 70.411488][ C0] RSP: 0018:ffffffffbcc07cf8 EFLAGS: 00000296 [ 70.411490][ C0] RAX: 000000000042e345 RBX: ffffffffbcc40600 RCX: ffffffffb9af3307 [ 70.411491][ C0] RDX: ffffffffbcc40600 RSI: ffffffffbca57571 RDI: ffffffffbc48d8e0 [ 70.411493][ C0] RBP: 0000000000000000 R08: 0000000000000000 R09: 0000000000000000 [ 70.411494][ C0] R10: 0000000000000000 R11: 0000000000000001 R12: 1ffffffff7980fa2 [ 70.411495][ C0] R13: 0000000000000000 R14: dffffc0000000000 R15: 0000000000014770 [ 70.411497][ C0] ? cpuidle_idle_call.constprop.0+0x237/0x410 [ 70.411500][ C0] ? lockdep_hardirqs_on+0x91/0x130 [ 70.411503][ C0] default_idle+0x9/0x10 [ 70.411505][ C0] default_idle_call+0x6e/0xb0 [ 70.411507][ C0] cpuidle_idle_call.constprop.0+0x237/0x410 [ 70.411510][ C0] ? arch_cpu_idle_exit+0x40/0x40 [ 70.411512][ C0] ? mark_tsc_async_resets+0x30/0x30 [ 70.411515][ C0] ? trace_irq_enable.constprop.0+0x9b/0x160 [ 70.411517][ C0] ? rcu_is_watching+0x16/0xd0 [ 70.411520][ C0] do_idle+0xd8/0x190 [ 70.411522][ C0] cpu_startup_entry+0x53/0x70 [ 70.411525][ C0] rest_init+0x279/0x280 [ 70.411527][ C0] ? __cpuidle_text_end+0x3b/0x3b [ 70.411532][ C0] ? rest_init+0x280/0x280 [ 70.411534][ C0] ? acpi_hw_set_mode+0x4a0/0x4a0 [ 70.411537][ C0] ? cpus_read_unlock+0x4f/0xc0 [ 70.411540][ C0] ? acpi_enable+0x1e4/0x330 [ 70.411543][ C0] start_kernel+0x3af/0x3b0 [ 70.411545][ C0] x86_64_start_reservations+0x24/0x30 [ 70.411547][ C0] x86_64_start_kernel+0x12b/0x130 [ 70.411550][ C0] common_startup_64+0x13e/0x148 [ 70.411555][ C0]