[ 119.804482][ T870] gre: GRE over IPv4 demultiplexer driver [ 119.811945][ T870] ip_gre: GRE over IPv4 tunneling driver [ 120.120724][ T886] ip6_gre: GRE over IPv6 tunneling driver [ 120.185572][ T345] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 120.214214][ T345] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 120.409535][ T899] br1: port 1(veth1) entered blocking state [ 120.409787][ T899] br1: port 1(veth1) entered disabled state [ 120.410020][ T899] veth1: entered allmulticast mode [ 120.411912][ T899] veth1: entered promiscuous mode [ 120.440784][ T46] br1: port 1(veth1) entered blocking state [ 120.441024][ T46] br1: port 1(veth1) entered forwarding state [ 120.466882][ T901] br1: port 2(veth2) entered blocking state [ 120.467085][ T901] br1: port 2(veth2) entered disabled state [ 120.467267][ T901] veth2: entered allmulticast mode [ 120.468932][ T901] veth2: entered promiscuous mode [ 120.494133][ T39] br1: port 2(veth2) entered blocking state [ 120.494326][ T39] br1: port 2(veth2) entered forwarding state [ 120.496505][ T71] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 120.652543][ T345] ip6_tunnel: gt6 xmit: Local address not yet configured! [ 120.670616][ T345] ip6_tunnel: gt6 xmit: Local address not yet configured! [ 120.736537][ T71] ip6_tunnel: gt6 xmit: Local address not yet configured! [ 120.872219][ T920] br2: port 1(veth4.555) entered blocking state [ 120.872439][ T920] br2: port 1(veth4.555) entered disabled state [ 120.872633][ T920] veth4.555: entered allmulticast mode [ 120.872763][ T920] veth4: entered allmulticast mode [ 120.874297][ T920] veth4.555: entered promiscuous mode [ 120.874448][ T920] veth4: entered promiscuous mode [ 120.875008][ T920] br2: port 1(veth4.555) entered blocking state [ 120.875183][ T920] br2: port 1(veth4.555) entered forwarding state [ 121.136530][ T345] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 121.520643][ T71] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 121.521210][ T71] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 121.689518][ T24] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 125.297497][ C1] ip6_tnl_xmit_ctl: 2 callbacks suppressed [ 125.297507][ C1] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 126.537402][ T959] Mirror/redirect action on [ 133.488970][ C1] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 135.048415][ C2] [ 135.048505][ C2] ================================ [ 135.048607][ C2] WARNING: inconsistent lock state [ 135.048708][ C2] 7.1.0-rc5-virtme #1 Not tainted [ 135.048811][ C2] -------------------------------- [ 135.048910][ C2] inconsistent {SOFTIRQ-ON-W} -> {IN-SOFTIRQ-W} usage. [ 135.049038][ C2] tc/1013 [HC0[0]:SC1[1]:HE1:SE0] takes: [ 135.049150][ C2] ffffffffc03ae7b8 (mirred_list_lock){+.?.}-{3:3}, at: tcf_mirred_release+0x1d/0x2e0 [act_mirred] [ 135.049359][ C2] {SOFTIRQ-ON-W} state was registered at: [ 135.049464][ C2] __lock_acquire+0x378/0xc10 [ 135.049569][ C2] lock_acquire.part.0+0xbc/0x260 [ 135.049669][ C2] _raw_spin_lock+0x33/0x40 [ 135.049772][ C2] tcf_mirred_init+0x844/0xd70 [act_mirred] [ 135.049897][ C2] tcf_action_init_1+0x428/0x6b0 [ 135.049998][ C2] tcf_action_init+0x3cf/0x890 [ 135.050096][ C2] tcf_exts_validate_ex+0x411/0x670 [ 135.050195][ C2] mall_change+0x3cd/0xe9b [cls_matchall] [ 135.050317][ C2] tc_new_tfilter+0x875/0x21e0 [ 135.050422][ C2] rtnetlink_rcv_msg+0x6fd/0xbd0 [ 135.050522][ C2] netlink_rcv_skb+0x14e/0x3a0 [ 135.050620][ C2] netlink_unicast+0x486/0x750 [ 135.050719][ C2] netlink_sendmsg+0x735/0xc60 [ 135.050818][ C2] ____sys_sendmsg+0x419/0x850 [ 135.050918][ C2] ___sys_sendmsg+0x14e/0x1d0 [ 135.051018][ C2] __sys_sendmsg+0x145/0x1f0 [ 135.051116][ C2] do_syscall_64+0x117/0x590 [ 135.051214][ C2] entry_SYSCALL_64_after_hwframe+0x4b/0x53 [ 135.051338][ C2] irq event stamp: 9458 [ 135.051417][ C2] hardirqs last enabled at (9458): [] _raw_spin_unlock_irqrestore+0x53/0x80 [ 135.051614][ C2] hardirqs last disabled at (9457): [] _raw_spin_lock_irqsave+0x50/0x60 [ 135.051787][ C2] softirqs last enabled at (8486): [] handle_softirqs+0x611/0x940 [ 135.051961][ C2] softirqs last disabled at (9431): [] __irq_exit_rcu+0x103/0x1c0 [ 135.052132][ C2] [ 135.052132][ C2] other info that might help us debug this: [ 135.052279][ C2] Possible unsafe locking scenario: [ 135.052279][ C2] [ 135.052426][ C2] CPU0 [ 135.052501][ C2] ---- [ 135.052575][ C2] lock(mirred_list_lock); [ 135.052675][ C2] [ 135.052750][ C2] lock(mirred_list_lock); [ 135.052849][ C2] [ 135.052849][ C2] *** DEADLOCK *** [ 135.052849][ C2] [ 135.052997][ C2] 3 locks held by tc/1013: [ 135.053097][ C2] #0: ff1100000b7fe378 (&mm->mmap_lock){++++}-{4:4}, at: setup_arg_pages+0x2e3/0xbd0 [ 135.053274][ C2] #1: ffffffffb5d905f8 (remove_cache_srcu){.+.+}-{0:0}, at: kasan_quarantine_reduce+0x84/0x240 [ 135.053476][ C2] #2: ffffffffb5b77c00 (rcu_callback){....}-{0:0}, at: rcu_do_batch+0x389/0x1020 [ 135.053653][ C2] [ 135.053653][ C2] stack backtrace: [ 135.053778][ C2] CPU: 2 UID: 0 PID: 1013 Comm: tc Not tainted 7.1.0-rc5-virtme #1 PREEMPT(full) [ 135.053781][ C2] Hardware name: Bochs Bochs, BIOS Bochs 01/01/2011 [ 135.053783][ C2] Call Trace: [ 135.053784][ C2] [ 135.053785][ C2] dump_stack_lvl+0x6f/0xa0 [ 135.053791][ C2] print_usage_bug.part.0.cold+0xa9/0xb7 [ 135.053793][ C2] ? filter_irq_stacks+0xd0/0xd0 [ 135.053797][ C2] mark_lock_irq+0x4e3/0x9c0 [ 135.053798][ C2] ? sysvec_apic_timer_interrupt+0x9d/0xe0 [ 135.053800][ C2] ? asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 135.053802][ C2] ? save_trace+0x68/0x280 [ 135.053804][ C2] ? mmu_notifier_unregister+0x330/0x3a0 [ 135.053808][ C2] mark_lock+0x1d7/0xa00 [ 135.053809][ C2] mark_usage+0x42/0x170 [ 135.053811][ C2] __lock_acquire+0x378/0xc10 [ 135.053812][ C2] ? mark_held_locks+0x40/0x70 [ 135.053813][ C2] ? rcu_do_batch+0x2b4/0x1020 [ 135.053816][ C2] lock_acquire.part.0+0xbc/0x260 [ 135.053818][ C2] ? tcf_mirred_release+0x1d/0x2e0 [act_mirred] [ 135.053820][ C2] ? rcu_is_watching+0x15/0xd0 [ 135.053822][ C2] ? lock_acquire+0x134/0x160 [ 135.053823][ C2] _raw_spin_lock+0x33/0x40 [ 135.053825][ C2] ? tcf_mirred_release+0x1d/0x2e0 [act_mirred] [ 135.053827][ C2] tcf_mirred_release+0x1d/0x2e0 [act_mirred] [ 135.053828][ C2] tcf_action_rcu_free+0x74/0x1a0 [ 135.053830][ C2] ? rcu_do_batch+0x2b4/0x1020 [ 135.053832][ C2] rcu_do_batch+0x2b6/0x1020 [ 135.053834][ C2] ? trace_rcu_batch_end+0x330/0x330 [ 135.053837][ C2] ? lockdep_hardirqs_on_prepare.part.0+0x9a/0x160 [ 135.053838][ C2] ? lockdep_hardirqs_on+0x8c/0x130 [ 135.053840][ C2] ? _raw_spin_unlock_irqrestore+0x53/0x80 [ 135.053841][ C2] ? _raw_spin_unlock_irqrestore+0x40/0x80 [ 135.053843][ C2] rcu_core+0x2bf/0x640 [ 135.053845][ C2] handle_softirqs+0x1d8/0x940 [ 135.053847][ C2] ? find_held_lock+0x2b/0x80 [ 135.053850][ C2] ? __lock_release.isra.0+0x6b/0x1a0 [ 135.053851][ C2] ? _local_bh_enable+0xd0/0xd0 [ 135.053853][ C2] __irq_exit_rcu+0x103/0x1c0 [ 135.053855][ C2] irq_exit_rcu+0xe/0x30 [ 135.053857][ C2] sysvec_apic_timer_interrupt+0x9d/0xe0 [ 135.053858][ C2] [ 135.053859][ C2] [ 135.053860][ C2] asm_sysvec_apic_timer_interrupt+0x1a/0x20 [ 135.053861][ C2] RIP: 0010:lock_acquire.part.0+0x6d/0x260 [ 135.053864][ C2] Code: 00 65 8b 0d c5 d9 33 04 85 c9 0f 85 c9 00 00 00 65 48 8b 05 65 93 33 04 8b 90 ec 0a 00 00 85 d2 0f 85 b3 00 00 00 9c 8f 04 24 48 c7 c7 cd 44 63 b5 e8 f6 1d 33 02 45 89 f0 44 89 f9 89 ea 65 [ 135.053866][ C2] RSP: 0018:ffa0000000826e60 EFLAGS: 00000246 [ 135.053868][ C2] RAX: ff110000196b4640 RBX: 0000000000000000 RCX: 0000000000000000 [ 135.053869][ C2] RDX: 0000000000000000 RSI: 0000000000000001 RDI: 1ffffffff6b6efa4 [ 135.053870][ C2] RBP: 0000000000000000 R08: 0000000000000001 R09: 0000000000000000 [ 135.053871][ C2] R10: 0000000000000002 R11: 0000000000000000 R12: ffffffffb5b77d20 [ 135.053872][ C2] R13: 0000000000000000 R14: 0000000000000000 R15: 0000000000000002 [ 135.053874][ C2] ? rcu_is_watching+0x15/0xd0 [ 135.053876][ C2] ? lock_acquire+0x134/0x160 [ 135.053878][ C2] unwind_next_frame+0x192/0x1ea0 [ 135.053880][ C2] ? unwind_next_frame+0x17e/0x1ea0 [ 135.053881][ C2] ? set_track_prepare+0x62/0x90 [ 135.053884][ C2] ? is_bpf_text_address+0x68/0x110 [ 135.053887][ C2] ? stack_access_ok+0x1e0/0x1e0 [ 135.053889][ C2] ? __unwind_start+0x432/0x910 [ 135.053891][ C2] ? write_profile+0xf0/0xf0 [ 135.053893][ C2] arch_stack_walk+0xd7/0x130 [ 135.053897][ C2] ? set_track_prepare+0x62/0x90 [ 135.053899][ C2] stack_trace_save+0x93/0xc0 [ 135.053901][ C2] ? filter_irq_stacks+0xd0/0xd0 [ 135.053904][ C2] set_track_prepare+0x62/0x90 [ 135.053906][ C2] free_to_partial_list+0x1c1/0x300 [ 135.053908][ C2] ? qlist_free_all+0x57/0x110 [ 135.053910][ C2] qlist_free_all+0x5c/0x110 [ 135.053912][ C2] kasan_quarantine_reduce+0x196/0x240 [ 135.053914][ C2] __kasan_slab_alloc+0x4b/0x70 [ 135.053916][ C2] kmem_cache_alloc_noprof+0x221/0x5f0 [ 135.053919][ C2] __alloc_object+0x30/0x250 [ 135.053921][ C2] __create_object+0x30/0x110 [ 135.053922][ C2] ? kasan_save_track+0x14/0x30 [ 135.053924][ C2] kmem_cache_alloc_noprof+0x445/0x5f0 [ 135.053926][ C2] ? static_obj+0x90/0x90 [ 135.053929][ C2] mas_preallocate+0x9d6/0x10f0 [ 135.053932][ C2] ? mas_wr_slot_store+0xc20/0xc20 [ 135.053934][ C2] ? lock_acquire.part.0+0xbc/0x260 [ 135.053936][ C2] ? __asan_memset+0x27/0x50 [ 135.053938][ C2] ? init_multi_vma_prep+0x2b/0x780 [ 135.053940][ C2] commit_merge+0x27b/0xeb0 [ 135.053942][ C2] ? vma_complete+0x1260/0x1260 [ 135.053944][ C2] ? __vma_start_exclude_readers+0x6f0/0x6f0 [ 135.053948][ C2] vma_expand+0x344/0x9c0 [ 135.053950][ C2] ? vms_complete_munmap_vmas+0xe60/0xe60 [ 135.053952][ C2] ? mas_prev_setup.constprop.0+0xb80/0xb80 [ 135.053953][ C2] ? __lock_acquire+0x508/0xc10 [ 135.053955][ C2] relocate_vma_down+0x326/0x550 [ 135.053957][ C2] ? vma_mmu_pagesize+0xa0/0xa0 [ 135.053958][ C2] ? __lock_release.isra.0+0x6b/0x1a0 [ 135.053960][ C2] ? exec_mmap+0x2ab/0x3f0 [ 135.053961][ C2] ? is_bpf_text_address+0x72/0x110 [ 135.053963][ C2] ? rcu_lockdep_current_cpu_online+0x39/0x1b0 [ 135.053965][ C2] ? validate_chain+0x38b/0xc20 [ 135.053968][ C2] ? lock_acquire.part.0+0xbc/0x260 [ 135.053970][ C2] ? down_write_killable+0xcd/0x260 [ 135.053972][ C2] ? down_write_killable+0x15b/0x260 [ 135.053973][ C2] ? down_write+0x1f0/0x1f0 [ 135.053975][ C2] ? do_execveat_common.isra.0+0x3e4/0x4f0 [ 135.053977][ C2] setup_arg_pages+0x65e/0xbd0 [ 135.053979][ C2] ? open_exec+0x40/0x40 [ 135.053982][ C2] ? find_held_lock+0x2b/0x80 [ 135.053984][ C2] ? __lock_release.isra.0+0x6b/0x1a0 [ 135.053985][ C2] ? rcu_is_watching+0x15/0xd0 [ 135.053987][ C2] ? trace_irq_enable.constprop.0+0x9b/0x180 [ 135.053992][ C2] load_elf_binary+0x9cf/0x2cb0 [ 135.053995][ C2] ? __lock_acquire+0x508/0xc10 [ 135.053997][ C2] ? lock_acquire.part.0+0xbc/0x260 [ 135.053999][ C2] ? find_held_lock+0x2b/0x80 [ 135.054001][ C2] ? load_elf_interp.isra.0+0xaa0/0xaa0 [ 135.054002][ C2] ? __lock_release.isra.0+0x6b/0x1a0 [ 135.054003][ C2] ? exec_binprm+0x249/0x630 [ 135.054005][ C2] exec_binprm+0x265/0x630 [ 135.054007][ C2] ? check_unsafe_exec+0x540/0x540 [ 135.054009][ C2] bprm_execve+0x190/0x4d0 [ 135.054011][ C2] do_execveat_common.isra.0+0x3e4/0x4f0 [ 135.054013][ C2] __x64_sys_execve+0x91/0xc0 [ 135.054014][ C2] do_syscall_64+0x117/0x590 [ 135.054016][ C2] ? trace_hardirqs_off+0xd/0x30 [ 135.054017][ C2] ? exc_page_fault+0xee/0x100 [ 135.054019][ C2] entry_SYSCALL_64_after_hwframe+0x4b/0x53 [ 135.054020][ C2] RIP: 0033:0x7f18637dc15b [ 135.054026][ C2] Code: Unable to access opcode bytes at 0x7f18637dc131. [ 135.054027][ C2] RSP: 002b:00007ffe02d9e1d8 EFLAGS: 00000202 ORIG_RAX: 000000000000003b [ 135.054028][ C2] RAX: ffffffffffffffda RBX: 00005602dfb78e60 RCX: 00007f18637dc15b [ 135.054029][ C2] RDX: 00005602dfad6700 RSI: 00005602dfb37bc0 RDI: 00005602dfb78e60 [ 135.054030][ C2] RBP: 00007ffe02d9e2c0 R08: 00005602dfa62850 R09: 0000000000000070 [ 135.054031][ C2] R10: 0000000000000070 R11: 0000000000000202 R12: 00005602dfb78e60 [ 135.054032][ C2] R13: 0000000000000000 R14: 00005602dfb37bc0 R15: 00005602dfad6700 [ 135.054034][ C2] [ 148.848473][ C1] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 162.812874][ T1218] br2: port 1(veth4.555) entered disabled state [ 167.071656][ T1240] br2: port 1(veth4.555) entered forwarding state [ 174.652494][ T1302] br2: port 1(veth4.555) entered disabled state [ 178.033459][ C1] ip6_tunnel: h3-gt6 xmit: Local address not yet configured! [ 178.901256][ T1324] br2: port 1(veth4.555) entered forwarding state [ 183.229989][ T1355] veth4.555: left allmulticast mode [ 183.230116][ T1355] veth4: left allmulticast mode [ 183.230235][ T1355] veth4.555: left promiscuous mode [ 183.230320][ T1355] veth4: left promiscuous mode [ 183.230579][ T1355] br2: port 1(veth4.555) entered disabled state [ 183.380269][ T1363] br1: port 1(veth1) entered disabled state [ 183.394240][ T1364] br1: port 2(veth2) entered disabled state [ 183.413820][ T1365] veth2: left allmulticast mode [ 183.413935][ T1365] veth2: left promiscuous mode [ 183.414077][ T1365] br1: port 2(veth2) entered disabled state [ 183.419204][ T1365] veth1: left allmulticast mode [ 183.419302][ T1365] veth1: left promiscuous mode [ 183.419449][ T1365] br1: port 1(veth1) entered disabled state