====================================== | [ 40.430437][ C0] entry_SYSCALL_64_after_hwframe (arch/x86/entry/entry_64.S:129) | [ 40.430701][ C0] | [ 40.430786][ C0] | [ 40.430786][ C0] stack backtrace: [ 40.431456][ C0] Hardware name: QEMU Standard PC (i440FX + PIIX, 1996), BIOS rel-1.16.3-0-ga6ed6b701f0a-prebuilt.qemu.org 04/01/2014 [ 40.432168][ C0] Call Trace: [ 40.432357][ C0] [ 40.432490][ C0] dump_stack_lvl (lib/dump_stack.c:117) [ 40.432734][ C0] print_irq_inversion_bug.part.0 (kernel/locking/lockdep.c:4024) [ 40.433048][ C0] ? kernel_text_address (kernel/extable.c:97 kernel/extable.c:94) [ 40.433296][ C0] ? __pfx_print_irq_inversion_bug.part.0 (kernel/locking/lockdep.c:4024) [ 40.433589][ C0] ? __pfx_usage_skip (kernel/locking/lockdep.c:2264) [ 40.433885][ C0] ? __pfx_usage_match (kernel/locking/lockdep.c:2256) [ 40.434138][ C0] ? arch_stack_walk (arch/x86/kernel/stacktrace.c:26) [ 40.434574][ C0] mark_lock_irq (kernel/locking/lockdep.c:4244) [ 40.434829][ C0] ? __pfx_mark_lock_irq (kernel/locking/lockdep.c:4207) [ 40.435100][ C0] ? __pfx_stack_trace_save (kernel/stacktrace.c:114) [ 40.435358][ C0] ? save_trace (kernel/locking/lockdep.c:586) [ 40.435745][ C0] mark_lock (kernel/locking/lockdep.c:4678) [ 40.435909][ C0] ? __pfx_stack_trace_save (kernel/stacktrace.c:114) [ 40.436157][ C0] mark_usage (kernel/locking/lockdep.c:4567) [ 40.436374][ C0] __lock_acquire (kernel/locking/lockdep.c:5091) [ 40.436617][ C0] ? __pfx_validate_chain (kernel/locking/lockdep.c:3825) [ 40.437011][ C0] ? __pfx_addrconf_rs_timer (net/ipv6/addrconf.c:4016) [ 40.437251][ C0] lock_acquire.part.0 (kernel/locking/lockdep.c:467 kernel/locking/lockdep.c:5756) [ 40.437483][ C0] ? addrconf_rs_timer (net/ipv6/addrconf.c:4023) [ 40.437675][ C0] ? __pfx_lock_acquire.part.0 (kernel/locking/lockdep.c:5719) [ 40.437968][ C0] ? trace_lock_acquire (./include/trace/events/lock.h:24 (discriminator 52)) [ 40.438224][ C0] ? addrconf_rs_timer (net/ipv6/addrconf.c:4023) [ 40.438451][ C0] ? lock_acquire (kernel/locking/lockdep.c:5727) [ 40.438644][ C0] ? addrconf_rs_timer (net/ipv6/addrconf.c:4023) [ 40.438937][ C0] _raw_write_lock (./include/linux/rwlock_api_smp.h:210 kernel/locking/spinlock.c:300) [ 40.439120][ C0] ? addrconf_rs_timer (net/ipv6/addrconf.c:4023) [ 40.439346][ C0] addrconf_rs_timer (net/ipv6/addrconf.c:4023) [ 40.439541][ C0] ? __pfx_lock_acquire.part.0 (kernel/locking/lockdep.c:5719) [ 40.439776][ C0] ? __pfx_addrconf_rs_timer (net/ipv6/addrconf.c:4016) [ 40.439972][ C0] ? call_timer_fn (./include/linux/lockdep.h:31 kernel/time/timer.c:1783) [ 40.440149][ C0] ? lock_acquire (kernel/locking/lockdep.c:5727) [ 40.440344][ C0] ? call_timer_fn (./include/linux/lockdep.h:31 kernel/time/timer.c:1783) [ 40.440586][ C0] ? __pfx_addrconf_rs_timer (net/ipv6/addrconf.c:4016) [ 40.441012][ C0] call_timer_fn (kernel/time/timer.c:1793) [ 40.441259][ C0] ? call_timer_fn (./include/linux/lockdep.h:31 kernel/time/timer.c:1783) [ 40.441516][ C0] ? call_timer_fn (./include/linux/lockdep.h:31 kernel/time/timer.c:1783) [ 40.441770][ C0] ? __pfx_call_timer_fn (kernel/time/timer.c:1770) [ 40.442088][ C0] ? mark_lock (kernel/locking/lockdep.c:4656 (discriminator 3)) [ 40.442245][ C0] __run_timers (kernel/time/timer.c:1845 kernel/time/timer.c:2418) [ 40.442457][ C0] ? __pfx_addrconf_rs_timer (net/ipv6/addrconf.c:4016) [ 40.442625][ C0] ? __pfx___run_timers (kernel/time/timer.c:2389) [ 40.442876][ 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) [ 40.443113][ C0] ? __pfx_do_raw_spin_lock (kernel/locking/spinlock_debug.c:114) [ 40.443346][ C0] ? lock_acquire (kernel/locking/lockdep.c:5727) [ 40.443581][ C0] ? run_timer_softirq (kernel/time/timer.c:2429 kernel/time/timer.c:2422 kernel/time/timer.c:2438 kernel/time/timer.c:2448) [ 40.443818][ C0] run_timer_softirq (kernel/time/timer.c:2430 kernel/time/timer.c:2422 kernel/time/timer.c:2438 kernel/time/timer.c:2448) [ 40.444222][ C0] __do_softirq (kernel/softirq.c:554) [ 40.444471][ C0] irq_exit_rcu (kernel/softirq.c:428 kernel/softirq.c:633 kernel/softirq.c:645) [ 40.444650][ C0] sysvec_apic_timer_interrupt (arch/x86/kernel/apic/apic.c:1043 arch/x86/kernel/apic/apic.c:1043) [ 40.444885][ C0] [ 40.445004][ C0] [ 40.445127][ C0] asm_sysvec_apic_timer_interrupt (./arch/x86/include/asm/idtentry.h:702) [ 40.445415][ C0] RIP: 0010:_raw_spin_unlock_irqrestore (./include/linux/spinlock_api_smp.h:152 kernel/locking/spinlock.c:194) [ 40.445724][ C0] Code: 10 e8 21 49 9b fd 48 89 ef e8 59 b9 9b fd 81 e3 00 02 00 00 75 1d 9c 58 f6 c4 02 75 29 48 85 db 74 01 fb 65 ff 0d 05 bf af 49 <74> 0e 5b 5d c3 cc cc cc cc e8 4f b3 be fd eb dc 0f 1f 44 00 00 5b All code ======== 0: 10 e8 adc %ch,%al 2: 21 49 9b and %ecx,-0x65(%rcx) 5: fd std 6: 48 89 ef mov %rbp,%rdi 9: e8 59 b9 9b fd call 0xfffffffffd9bb967 e: 81 e3 00 02 00 00 and $0x200,%ebx 14: 75 1d jne 0x33 16: 9c pushf 17: 58 pop %rax 18: f6 c4 02 test $0x2,%ah 1b: 75 29 jne 0x46 1d: 48 85 db test %rbx,%rbx 20: 74 01 je 0x23 22: fb sti 23: 65 ff 0d 05 bf af 49 decl %gs:0x49afbf05(%rip) # 0x49afbf2f 2a:* 74 0e je 0x3a <-- trapping instruction 2c: 5b pop %rbx 2d: 5d pop %rbp 2e: c3 ret 2f: cc int3 30: cc int3 31: cc int3 32: cc int3 33: e8 4f b3 be fd call 0xfffffffffdbeb387 38: eb dc jmp 0x16 3a: 0f 1f 44 00 00 nopl 0x0(%rax,%rax,1) 3f: 5b pop %rbx Code starting with the faulting instruction =========================================== 0: 74 0e je 0x10 2: 5b pop %rbx 3: 5d pop %rbp 4: c3 ret 5: cc int3 6: cc int3 7: cc int3 8: cc int3 9: e8 4f b3 be fd call 0xfffffffffdbeb35d e: eb dc jmp 0xffffffffffffffec 10: 0f 1f 44 00 00 nopl 0x0(%rax,%rax,1) 15: 5b pop %rbx [ 40.446719][ C0] RSP: 0018:ffffc9000099f440 EFLAGS: 00000282 [ 40.447024][ C0] RAX: 0000000000000002 RBX: 0000000000000200 RCX: 1ffffffff7024179 [ 40.447529][ C0] RDX: 0000000000000000 RSI: 0000000000000000 RDI: ffffffffb6540911 [ 40.447879][ C0] RBP: ffff888001041080 R08: 0000000000000001 R09: fffffbfff70249fa [ 40.448249][ C0] R10: ffffffffb8124fd7 R11: 0000000000001000 R12: ffff888001041080 [ 40.448774][ C0] R13: ffffea00001de000 R14: ffff8880010433c0 R15: ffff888007784000 [ 40.449122][ C0] ? _raw_spin_unlock_irqrestore (./include/linux/spinlock_api_smp.h:151 kernel/locking/spinlock.c:194) [ 40.449385][ C0] get_partial_node.part.0 (mm/slub.c:2623) [ 40.449685][ C0] ___slab_alloc (mm/slub.c:2583 mm/slub.c:2701 mm/slub.c:3505) [ 40.449917][ C0] ? fs_reclaim_acquire (mm/page_alloc.c:3715 mm/page_alloc.c:3706) [ 40.450078][ C0] ? p9_fcall_init (net/9p/client.c:232) [ 40.450302][ C0] ? __pfx___lock_release (kernel/locking/lockdep.c:5406) [ 40.450564][ C0] ? p9_fcall_init (net/9p/client.c:232) [ 40.450774][ C0] ? __kmalloc (mm/slub.c:3610 mm/slub.c:3663 mm/slub.c:3835 mm/slub.c:3965 mm/slub.c:3979) [ 40.451011][ C0] __kmalloc (mm/slub.c:3610 mm/slub.c:3663 mm/slub.c:3835 mm/slub.c:3965 mm/slub.c:3979) [ 40.451194][ C0] p9_fcall_init (net/9p/client.c:232) [ 40.451428][ C0] p9_tag_alloc (net/9p/client.c:297) [ 40.451809][ C0] ? __pfx_p9_tag_alloc (net/9p/client.c:277) [ 40.452010][ C0] ? validate_chain (./include/linux/hash.h:78 kernel/locking/lockdep.c:3759 kernel/locking/lockdep.c:3782 kernel/locking/lockdep.c:3837) [ 40.452178][ C0] ? hlock_class (./arch/x86/include/asm/bitops.h:227 ./arch/x86/include/asm/bitops.h:239 ./include/asm-generic/bitops/instrumented-non-atomic.h:142 kernel/locking/lockdep.c:228) [ 40.452426][ C0] p9_client_prepare_req (net/9p/client.c:641) [ 40.452793][ C0] ? hlock_class (./arch/x86/include/asm/bitops.h:227 ./arch/x86/include/asm/bitops.h:239 ./include/asm-generic/bitops/instrumented-non-atomic.h:142 kernel/locking/lockdep.c:228) [ 40.452949][ C0] ? __pfx_p9_client_prepare_req (net/9p/client.c:625) [ 40.453211][ C0] ? __lock_acquire (kernel/locking/lockdep.c:5137) [ 40.453404][ C0] p9_client_rpc (net/9p/client.c:688 (discriminator 4)) [ 40.453708][ C0] ? __pfx_p9_client_rpc (net/9p/client.c:672) [ 40.453942][ C0] ? __lock_release (kernel/locking/lockdep.c:5430) [ 40.454163][ C0] ? list_lru_add (mm/list_lru.c:106) [ 40.454399][ C0] ? __pfx___lock_release (kernel/locking/lockdep.c:5406) [ 40.454815][ C0] ? __pfx_lock_acquire.part.0 (kernel/locking/lockdep.c:5719) [ 40.455096][ C0] ? find_held_lock (kernel/locking/lockdep.c:5244) [ 40.455328][ C0] ? __lock_release (kernel/locking/lockdep.c:5430) [ 40.455555][ C0] ? __pfx___lock_release (kernel/locking/lockdep.c:5406) [ 40.455759][ C0] p9_client_clunk (net/9p/client.c:1438 (discriminator 3)) [ 40.456170][ C0] v9fs_dentry_release (fs/9p/vfs_dentry.c:54) [ 40.456384][ C0] __dentry_kill (fs/dcache.c:608) [ 40.456631][ C0] ? __pfx_kfree_link (fs/libfs.c:1573) [ 40.456905][ C0] dput.part.0 (fs/dcache.c:845) [ 40.457145][ C0] walk_component (fs/namei.c:562 fs/namei.c:1027 fs/namei.c:2009) [ 40.457396][ C0] link_path_walk.part.0.constprop.0 (fs/namei.c:2328) [ 40.457688][ C0] ? __pfx_link_path_walk.part.0.constprop.0 (fs/namei.c:2249) [ 40.457992][ C0] path_openat (fs/namei.c:3795) [ 40.458560][ C0] ? __pfx_path_openat (fs/namei.c:3781) [ 40.458808][ C0] ? __lock_acquire (kernel/locking/lockdep.c:5137) [ 40.459042][ C0] do_filp_open (fs/namei.c:3826) [ 40.459284][ C0] ? __pfx_do_filp_open (fs/namei.c:3820) [ 40.459707][ C0] ? find_held_lock (kernel/locking/lockdep.c:5244) [ 40.459945][ C0] ? __pfx_kfree_link (fs/libfs.c:1573) [ 40.460197][ C0] ? __pfx_do_raw_spin_lock (kernel/locking/spinlock_debug.c:114) [ 40.460405][ C0] ? alloc_fd (fs/file.c:555 (discriminator 10)) [ 40.460646][ C0] ? do_raw_spin_unlock (./arch/x86/include/asm/atomic.h:23 ./include/linux/atomic/atomic-arch-fallback.h:457 ./include/linux/atomic/atomic-instrumented.h:33 ./include/asm-generic/qspinlock.h:57 kernel/locking/spinlock_debug.c:101 kernel/locking/spinlock_debug.c:141) [ 40.460851][ C0] ? _raw_spin_unlock (./arch/x86/include/asm/preempt.h:94 ./include/linux/spinlock_api_smp.h:143 kernel/locking/spinlock.c:186) [ 40.461055][ C0] ? alloc_fd (fs/file.c:555 (discriminator 10)) [ 40.461188][ C0] do_sys_openat2 (fs/open.c:1406) [ 40.461381][ C0] ? vfs_fstatat (fs/stat.c:308) [ 40.461690][ C0] ? __pfx_do_sys_openat2 (fs/open.c:1392) [ 40.461937][ C0] ? __pfx___do_sys_newfstatat (fs/stat.c:464) [ 40.462145][ C0] __x64_sys_openat (fs/open.c:1432) [ 40.462340][ C0] ? __pfx___x64_sys_openat (fs/open.c:1432) [ 40.462633][ C0] ? __pfx_do_faccessat (fs/open.c:465) [ 40.462884][ C0] do_syscall_64 (arch/x86/entry/common.c:52 arch/x86/entry/common.c:83) [ 40.463076][ C0] entry_SYSCALL_64_after_hwframe (arch/x86/entry/entry_64.S:129) [ 40.463307][ C0] RIP: 0033:0x7f22c3ab60e8 [ 40.463730][ C0] Code: f9 41 89 f0 41 83 e2 40 75 30 89 f0 25 00 00 41 00 3d 00 00 41 00 74 22 44 89 c2 4c 89 ce bf 9c ff ff ff b8 01 01 00 00 0f 05 <48> 3d 00 f0 ff ff 77 30 c3 0f 1f 80 00 00 00 00 48 8d 44 24 08 c7 All code ======== 0: f9 stc 1: 41 89 f0 mov %esi,%r8d 4: 41 83 e2 40 and $0x40,%r10d 8: 75 30 jne 0x3a a: 89 f0 mov %esi,%eax c: 25 00 00 41 00 and $0x410000,%eax 11: 3d 00 00 41 00 cmp $0x410000,%eax 16: 74 22 je 0x3a 18: 44 89 c2 mov %r8d,%edx 1b: 4c 89 ce mov %r9,%rsi 1e: bf 9c ff ff ff mov $0xffffff9c,%edi 23: b8 01 01 00 00 mov $0x101,%eax 28: 0f 05 syscall 2a:* 48 3d 00 f0 ff ff cmp $0xfffffffffffff000,%rax <-- trapping instruction 30: 77 30 ja 0x62 32: c3 ret 33: 0f 1f 80 00 00 00 00 nopl 0x0(%rax) 3a: 48 8d 44 24 08 lea 0x8(%rsp),%rax 3f: c7 .byte 0xc7 Code starting with the faulting instruction =========================================== 0: 48 3d 00 f0 ff ff cmp $0xfffffffffffff000,%rax 6: 77 30 ja 0x38 8: c3 ret 9: 0f 1f 80 00 00 00 00 nopl 0x0(%rax) 10: 48 8d 44 24 08 lea 0x8(%rsp),%rax 15: c7 .byte 0xc7 [ 40.464459][ C0] RSP: 002b:00007ffca58ea988 EFLAGS: 00000287 ORIG_RAX: 0000000000000101 [ 40.464863][ C0] RAX: ffffffffffffffda RBX: 00007ffca58eac0f RCX: 00007f22c3ab60e8 [ 40.465234][ C0] RDX: 0000000000080000 RSI: 00007ffca58eaa00 RDI: 00000000ffffff9c [ 40.465597][ C0] RBP: 00007ffca58ea9f0 R08: 0000000000080000 R09: 00007ffca58eaa00 [ 40.466142][ C0] R10: 0000000000000000 R11: 0000000000000287 R12: 00007ffca58eaa07 Finger prints: dump_stack_lvl:mark_lock_irq:mark_lock:mark_usage