====================================== | [ 44.367512][ C0] common_startup_64 (arch/x86/kernel/head_64.S:421) | [ 44.367667][ C0] | [ 44.367743][ C0] | [ 44.367743][ C0] stack backtrace: [ 44.368252][ C0] Hardware name: QEMU Standard PC (i440FX + PIIX, 1996), BIOS rel-1.16.3-0-ga6ed6b701f0a-prebuilt.qemu.org 04/01/2014 [ 44.368590][ C0] Call Trace: [ 44.368798][ C0] [ 44.368878][ C0] dump_stack_lvl (lib/dump_stack.c:117) [ 44.369041][ C0] print_irq_inversion_bug.part.0 (kernel/locking/lockdep.c:4024) [ 44.369230][ C0] ? common_startup_64 (arch/x86/kernel/head_64.S:421) [ 44.369383][ C0] ? __pfx_print_irq_inversion_bug.part.0 (kernel/locking/lockdep.c:4024) [ 44.369668][ C0] ? __pfx_usage_skip (kernel/locking/lockdep.c:2264) [ 44.369820][ C0] ? __pfx_usage_match (kernel/locking/lockdep.c:2256) [ 44.369972][ C0] ? arch_stack_walk (arch/x86/kernel/stacktrace.c:24) [ 44.370124][ C0] mark_lock_irq (kernel/locking/lockdep.c:4244) [ 44.370371][ C0] ? __pfx_mark_lock_irq (kernel/locking/lockdep.c:4207) [ 44.370528][ C0] ? stack_trace_save (kernel/stacktrace.c:123) [ 44.370681][ C0] ? add_chain_cache (kernel/locking/lockdep.c:3730) [ 44.370839][ C0] ? save_trace (kernel/locking/lockdep.c:586) [ 44.371098][ C0] mark_lock (kernel/locking/lockdep.c:4678) [ 44.371215][ C0] mark_usage (kernel/locking/lockdep.c:4567) [ 44.371331][ C0] __lock_acquire (kernel/locking/lockdep.c:5091) [ 44.371496][ C0] ? __lock_acquire (kernel/locking/lockdep.c:5137) [ 44.371647][ C0] ? __pfx_br_forward_delay_timer_expired (net/bridge/br_stp_timer.c:80) bridge [ 44.372002][ C0] lock_acquire.part.0 (kernel/locking/lockdep.c:467 kernel/locking/lockdep.c:5756) [ 44.372160][ C0] ? br_forward_delay_timer_expired (net/bridge/br_stp_timer.c:87) bridge [ 44.372386][ C0] ? __pfx_lock_acquire.part.0 (kernel/locking/lockdep.c:5719) [ 44.372634][ C0] ? trace_lock_acquire (./include/trace/events/lock.h:24 (discriminator 52)) [ 44.372787][ C0] ? br_forward_delay_timer_expired (net/bridge/br_stp_timer.c:87) bridge [ 44.373010][ C0] ? lock_acquire (kernel/locking/lockdep.c:5727) [ 44.373160][ C0] ? br_forward_delay_timer_expired (net/bridge/br_stp_timer.c:87) bridge [ 44.373575][ C0] _raw_spin_lock (./include/linux/spinlock_api_smp.h:134 kernel/locking/spinlock.c:154) [ 44.373726][ C0] ? br_forward_delay_timer_expired (net/bridge/br_stp_timer.c:87) bridge [ 44.373951][ C0] br_forward_delay_timer_expired (net/bridge/br_stp_timer.c:87) bridge [ 44.374176][ C0] ? __pfx_br_forward_delay_timer_expired (net/bridge/br_stp_timer.c:80) bridge [ 44.374530][ C0] call_timer_fn (kernel/time/timer.c:1793) [ 44.374681][ C0] ? call_timer_fn (./include/linux/lockdep.h:31 kernel/time/timer.c:1783) [ 44.374847][ C0] ? call_timer_fn (./include/linux/lockdep.h:31 kernel/time/timer.c:1783) [ 44.375028][ C0] ? __pfx_call_timer_fn (kernel/time/timer.c:1770) [ 44.375300][ C0] ? mark_lock (kernel/locking/lockdep.c:4656 (discriminator 3)) [ 44.375429][ C0] __run_timers (kernel/time/timer.c:1845 kernel/time/timer.c:2418) [ 44.375592][ C0] ? __pfx_br_forward_delay_timer_expired (net/bridge/br_stp_timer.c:80) bridge [ 44.375879][ C0] ? __pfx___run_timers (kernel/time/timer.c:2389) [ 44.376135][ C0] ? __lock_release (kernel/locking/lockdep.c:5430) [ 44.376299][ C0] ? do_raw_spin_lock (./arch/x86/include/asm/atomic.h:115 ./include/linux/atomic/atomic-arch-fallback.h:2170 ./include/linux/atomic/atomic-instrumented.h:1302 ./include/asm-generic/qspinlock.h:111 kernel/locking/spinlock_debug.c:116) [ 44.376463][ C0] ? __pfx_do_raw_spin_lock (kernel/locking/spinlock_debug.c:114) [ 44.376625][ C0] ? lock_acquire (kernel/locking/lockdep.c:5727) [ 44.376888][ C0] ? timer_expire_remote (kernel/time/timer.c:2429 kernel/time/timer.c:2422 kernel/time/timer.c:2181) [ 44.377053][ C0] timer_expire_remote (kernel/time/timer.c:2430 kernel/time/timer.c:2422 kernel/time/timer.c:2181) [ 44.377216][ C0] tmigr_handle_remote_cpu (./arch/x86/include/asm/irqflags.h:26 ./arch/x86/include/asm/irqflags.h:67 ./arch/x86/include/asm/irqflags.h:127 kernel/time/timer_migration.c:925) [ 44.377382][ C0] ? __pfx_tmigr_handle_remote_cpu (kernel/time/timer_migration.c:869) [ 44.377675][ C0] tmigr_handle_remote_up (kernel/time/timer_migration.c:1003) [ 44.377826][ C0] tmigr_handle_remote (kernel/time/timer_migration.c:488 kernel/time/timer_migration.c:1061) [ 44.377976][ C0] ? do_raw_spin_lock (./arch/x86/include/asm/atomic.h:115 ./include/linux/atomic/atomic-arch-fallback.h:2170 ./include/linux/atomic/atomic-instrumented.h:1302 ./include/asm-generic/qspinlock.h:111 kernel/locking/spinlock_debug.c:116) [ 44.378133][ C0] ? __pfx_tmigr_handle_remote (kernel/time/timer_migration.c:1026) [ 44.378377][ C0] ? __pfx_do_raw_spin_lock (kernel/locking/spinlock_debug.c:114) [ 44.378529][ C0] ? lockdep_hardirqs_on_prepare.part.0 (kernel/locking/lockdep.c:4292 kernel/locking/lockdep.c:4359) [ 44.378716][ C0] __do_softirq (kernel/softirq.c:554) [ 44.378868][ C0] irq_exit_rcu (kernel/softirq.c:428 kernel/softirq.c:633 kernel/softirq.c:645) [ 44.379088][ C0] sysvec_apic_timer_interrupt (arch/x86/kernel/apic/apic.c:1043 arch/x86/kernel/apic/apic.c:1043) [ 44.379240][ C0] [ 44.379318][ C0] [ 44.379394][ C0] asm_sysvec_apic_timer_interrupt (./arch/x86/include/asm/idtentry.h:702) [ 44.379590][ C0] RIP: 0010:default_idle (./arch/x86/include/asm/irqflags.h:37 ./arch/x86/include/asm/irqflags.h:72 arch/x86/kernel/process.c:743) [ 44.379847][ C0] Code: 4c 01 c7 4c 29 c2 e9 72 ff ff ff 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 30 35 00 fb f4 c3 cc cc cc cc 66 66 2e 0f 1f 84 00 00 00 00 00 90 90 90 90 90 All code ======== 0: 4c 01 c7 add %r8,%rdi 3: 4c 29 c2 sub %r8,%rdx 6: e9 72 ff ff ff jmp 0xffffffffffffff7d b: 90 nop c: 90 nop d: 90 nop e: 90 nop f: 90 nop 10: 90 nop 11: 90 nop 12: 90 nop 13: 90 nop 14: 90 nop 15: 90 nop 16: 90 nop 17: 90 nop 18: 90 nop 19: 90 nop 1a: 90 nop 1b: f3 0f 1e fa endbr64 1f: 66 90 xchg %ax,%ax 21: 0f 00 2d a3 30 35 00 verw 0x3530a3(%rip) # 0x3530cb 28: fb sti 29: f4 hlt 2a:* fa cli <-- trapping instruction 2b: c3 ret 2c: cc int3 2d: cc int3 2e: cc int3 2f: cc int3 30: 66 66 2e 0f 1f 84 00 data16 cs nopw 0x0(%rax,%rax,1) 37: 00 00 00 00 3b: 90 nop 3c: 90 nop 3d: 90 nop 3e: 90 nop 3f: 90 nop Code starting with the faulting instruction =========================================== 0: fa cli 1: c3 ret 2: cc int3 3: cc int3 4: cc int3 5: cc int3 6: 66 66 2e 0f 1f 84 00 data16 cs nopw 0x0(%rax,%rax,1) d: 00 00 00 00 11: 90 nop 12: 90 nop 13: 90 nop 14: 90 nop 15: 90 nop [ 44.380380][ C0] RSP: 0018:ffffffff86a07e00 EFLAGS: 00000242 [ 44.380669][ C0] RAX: 00000000000a7ad5 RBX: 1ffffffff0d40fc2 RCX: ffffffff85b0e9d5 [ 44.380904][ C0] RDX: 0000000000000000 RSI: 0000000000000000 RDI: ffffffff834aa4a4 [ 44.381131][ C0] RBP: 0000000000000000 R08: 0000000000000001 R09: ffffed1006c0709c [ 44.381462][ C0] R10: ffff8880360384e3 R11: ffff88803602d9b0 R12: 0000000000000000 [ 44.381703][ C0] R13: ffffffff86a1d000 R14: dffffc0000000000 R15: 0000000000014770 [ 44.381931][ C0] ? ct_kernel_exit.constprop.0 (kernel/context_tracking.c:147) [ 44.382180][ C0] ? cpuidle_idle_call (kernel/sched/idle.c:192) [ 44.382333][ C0] default_idle_call (./include/linux/cpuidle.h:143 kernel/sched/idle.c:118) [ 44.382483][ C0] cpuidle_idle_call (kernel/sched/idle.c:192) [ 44.382634][ C0] ? __pfx_cpuidle_idle_call (kernel/sched/idle.c:168) [ 44.382893][ C0] ? tsc_verify_tsc_adjust (arch/x86/kernel/tsc_sync.c:59) [ 44.383059][ C0] do_idle (kernel/sched/idle.c:332) [ 44.383174][ C0] cpu_startup_entry (kernel/sched/idle.c:429 (discriminator 1)) [ 44.383324][ C0] rest_init (./include/linux/rcupdate.h:782 init/main.c:703) [ 44.383444][ C0] start_kernel (init/main.c:1024 (discriminator 1)) [ 44.383691][ C0] x86_64_start_reservations (arch/x86/kernel/head64.c:495) [ 44.383843][ C0] x86_64_start_kernel (arch/x86/kernel/head64.c:437 (discriminator 17)) Finger prints: common_startup_64:dump_stack_lvl:mark_lock_irq:mark_lock