[ 615.777278][ T44] INFO: task ip:4864 blocked for more than 122 seconds. [ 615.777793][ T44] Not tainted 6.18.0-rc6-virtme #1 [ 615.778006][ T44] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 615.778383][ T44] task:ip state:D stack:24984 pid:4864 tgid:4864 ppid:1 task_flags:0x400100 flags:0x00080003 [ 615.778802][ T44] Call Trace: [ 615.778947][ T44] [ 615.779050][ T44] __schedule+0x88d/0x1b90 [ 615.779263][ T44] ? io_schedule_timeout+0x130/0x130 [ 615.779448][ T44] ? lock_acquire.part.0+0xbc/0x260 [ 615.779636][ T44] ? __lock_release.isra.0+0x59/0x170 [ 615.779821][ T44] ? __lock_release.isra.0+0x59/0x170 [ 615.780013][ T44] schedule+0xd4/0x260 [ 615.780143][ T44] schedule_preempt_disabled+0x18/0x30 [ 615.780400][ T44] __mutex_lock+0x9ae/0x1500 [ 615.780576][ T44] ? napi_enable+0x3b/0x80 [ 615.780767][ T44] ? virtqueue_add_inbuf_ctx+0x1850/0x1850 [ 615.780995][ T44] ? ww_mutex_lock+0x160/0x160 [ 615.781190][ T44] ? __asan_memset+0x27/0x50 [ 615.781379][ T44] ? sg_init_table+0x19/0x60 [ 615.781569][ T44] ? try_fill_recv+0x3ec/0x1750 [ 615.781762][ T44] ? napi_enable+0x3b/0x80 [ 615.781950][ T44] napi_enable+0x3b/0x80 [ 615.782088][ T44] __virtnet_rx_resume+0x156/0x290 [ 615.782271][ T44] ? queue_delayed_work_on+0x91/0x100 [ 615.782457][ T44] virtnet_rx_resume_all+0xe7/0x1a0 [ 615.782634][ T44] virtnet_xdp_set+0xef7/0x1aa0 [ 615.782825][ T44] ? virtnet_xdp_set+0x1aa0/0x1aa0 [ 615.783010][ T44] dev_xdp_install+0x3e4/0x8e0 [ 615.783201][ T44] ? netif_skb_check_for_xdp+0x600/0x600 [ 615.783389][ T44] dev_xdp_attach+0x50d/0x1320 [ 615.783949][ T44] ? bpf_xdp_link_update+0x6e0/0x6e0 [ 615.784146][ T44] ? __bpf_prog_get+0x320/0x320 [ 615.784336][ T44] dev_change_xdp_fd+0x182/0x240 [ 615.784519][ T44] do_setlink.isra.0+0x1c2d/0x2880 [ 615.784701][ T44] ? rtnl_newlink_create+0x900/0x900 [ 615.784888][ T44] ? rcu_lockdep_current_cpu_online+0x3e/0x1b0 [ 615.785114][ T44] ? rcu_read_lock_any_held+0x41/0xa0 [ 615.785303][ T44] ? validate_chain+0x287/0x5f0 [ 615.785489][ T44] ? rcu_read_lock_any_held+0x6b/0xa0 [ 615.785700][ T44] ? stack_depot_save_flags+0x3e1/0x6e0 [ 615.785884][ T44] ? __lock_acquire+0x34c/0x740 [ 615.786094][ T44] ? trace_lock_acquire+0x88/0xd0 [ 615.786280][ T44] ? perf_trace_sched_switch+0x6d0/0x6d0 [ 615.786465][ T44] ? lock_acquire+0x31/0x80 [ 615.786649][ T44] ? rtnl_newlink+0x5df/0xb20 [ 615.786829][ T44] ? rcu_is_watching+0x15/0xd0 [ 615.787019][ T44] ? rcu_is_watching+0x15/0xd0 [ 615.787205][ T44] ? trace_contention_end+0xd6/0x140 [ 615.787381][ T44] ? rtnl_newlink+0x5df/0xb20 [ 615.787560][ T44] ? __mutex_lock+0x32e/0x1500 [ 615.787749][ T44] ? ww_mutex_lock+0x160/0x160 [ 615.787933][ T44] ? nla_validate_int_range+0x5b0/0x5b0 [ 615.788110][ T44] ? __rtnl_newlink+0x3fa/0xa40 [ 615.788307][ T44] rtnl_newlink+0x637/0xb20 [ 615.788496][ T44] ? __rtnl_newlink+0xa40/0xa40 [ 615.788676][ T44] ? lock_acquire.part.0+0xbc/0x260 [ 615.788848][ T44] ? find_held_lock+0x2b/0x80 [ 615.789032][ T44] ? __rtnl_newlink+0xa40/0xa40 [ 615.789226][ T44] ? __lock_release.isra.0+0x59/0x170 [ 615.789418][ T44] ? __rtnl_newlink+0xa40/0xa40 [ 615.789606][ T44] rtnetlink_rcv_msg+0x6fe/0xb90 [ 615.789783][ T44] ? rtnl_port_fill+0x940/0x940 [ 615.789971][ T44] ? __lock_acquire+0x34c/0x740 [ 615.790154][ T44] ? lock_acquire.part.0+0xbc/0x260 [ 615.790338][ T44] ? find_held_lock+0x2b/0x80 [ 615.790522][ T44] netlink_rcv_skb+0x123/0x380 [ 615.790698][ T44] ? rtnl_port_fill+0x940/0x940 [ 615.790877][ T44] ? netlink_ack+0xcc0/0xcc0 [ 615.791071][ T44] ? netlink_deliver_tap+0x13f/0x330 [ 615.791274][ T44] netlink_unicast+0x4a3/0x770 [ 615.791463][ T44] ? netlink_attachskb+0x810/0x810 [ 615.791646][ T44] ? __lock_acquire+0x34c/0x740 [ 615.791831][ T44] netlink_sendmsg+0x735/0xc60 [ 615.792016][ T44] ? netlink_unicast+0x770/0x770 [ 615.792213][ T44] ? __might_fault+0x97/0x140 [ 615.792394][ T44] ____sys_sendmsg+0x419/0x850 [ 615.792566][ T44] ? copy_msghdr_from_user+0x270/0x430 [ 615.792747][ T44] ? get_timestamp.constprop.0+0x3a0/0x3a0 [ 615.792967][ T44] ? move_addr_to_kernel+0x40/0x40 [ 615.793151][ T44] ? stack_depot_save_flags+0x3e1/0x6e0 [ 615.793341][ T44] ? validate_chain+0x287/0x5f0 [ 615.793532][ T44] ___sys_sendmsg+0xfd/0x180 [ 615.793719][ T44] ? __call_rcu_common.constprop.0+0xa5/0x680 [ 615.793958][ T44] ? copy_msghdr_from_user+0x430/0x430 [ 615.794187][ T44] __sys_sendmsg+0x124/0x1c0 [ 615.794379][ T44] ? __sys_sendmsg_sock+0x20/0x20 [ 615.794571][ T44] ? lockdep_hardirqs_on+0x84/0x130 [ 615.794760][ T44] ? __call_rcu_common.constprop.0+0x2fa/0x680 [ 615.795002][ T44] ? do_raw_spin_unlock+0x59/0x250 [ 615.795205][ T44] ? rcu_is_watching+0x15/0xd0 [ 615.795396][ T44] do_syscall_64+0xbb/0xfd0 [ 615.795592][ T44] entry_SYSCALL_64_after_hwframe+0x4b/0x53 [ 615.795830][ T44] RIP: 0033:0x7fad7ae37c5e [ 615.796037][ T44] RSP: 002b:00007fff9df66b90 EFLAGS: 00000202 ORIG_RAX: 000000000000002e [ 615.796323][ T44] RAX: ffffffffffffffda RBX: 0000000000000007 RCX: 00007fad7ae37c5e [ 615.796599][ T44] RDX: 0000000000000000 RSI: 00007fff9df66c50 RDI: 0000000000000003 [ 615.796893][ T44] RBP: 00007fff9df66ba0 R08: 0000000000000000 R09: 0000000000000000 [ 615.797185][ T44] R10: 0000000000000000 R11: 0000000000000202 R12: 00007fff9df67310 [ 615.797468][ T44] R13: 000000006923a3c3 R14: 0000000000000000 R15: 0000000000499600 [ 615.797760][ T44] [ 615.797912][ T44] INFO: task ip:4864 is blocked on a mutex likely owned by task kworker/2:0:28. [ 615.798245][ T44] task:kworker/2:0 state:D stack:27512 pid:28 tgid:28 ppid:2 task_flags:0x4208060 flags:0x00080000 [ 615.798662][ T44] Workqueue: events refill_work [ 615.798851][ T44] Call Trace: [ 615.798998][ T44] [ 615.799097][ T44] __schedule+0x88d/0x1b90 [ 615.799302][ T44] ? io_schedule_timeout+0x130/0x130 [ 615.799483][ T44] ? trace_irq_disable.constprop.0+0xce/0x130 [ 615.799723][ T44] ? lock_acquire.part.0+0xbc/0x260 [ 615.799910][ T44] ? __lock_release.isra.0+0x59/0x170 [ 615.800107][ T44] ? usleep_range_state+0xba/0x1b0 [ 615.800304][ T44] schedule+0xd4/0x260 [ 615.800445][ T44] schedule_hrtimeout_range_clock+0x1da/0x2f0 [ 615.800678][ T44] ? schedule_timeout_idle+0xe0/0xe0 [ 615.800870][ T44] ? hrtimer_cb_get_time+0x90/0x90 [ 615.801062][ T44] ? lockdep_hardirqs_on+0x84/0x130 [ 615.801254][ T44] ? ktime_get+0x15e/0x220 [ 615.801434][ T44] ? kvm_clock_get_cycles+0x18/0x30 [ 615.801592][ T44] ? ktime_get+0xa9/0x220 [ 615.801682][ T44] usleep_range_state+0x133/0x1b0 [ 615.801804][ T44] ? schedule_hrtimeout+0x20/0x20 [ 615.801922][ T44] ? perf_trace_sched_switch+0x6d0/0x6d0 [ 615.802058][ T44] napi_disable_locked+0x379/0x5f0 [ 615.802202][ T44] ? _mutex_trylock_nest_lock+0x150/0x150 [ 615.802335][ T44] ? netdev_bind_sb_channel_queue+0x470/0x470 [ 615.802485][ T44] napi_disable+0x43/0x80 [ 615.802574][ T44] refill_work+0x116/0x210 [ 615.802695][ T44] process_one_work+0xd57/0x1390 [ 615.802821][ T44] ? pwq_dec_nr_in_flight+0x700/0x700 [ 615.802953][ T44] ? lock_acquire.part.0+0xbc/0x260 [ 615.803078][ T44] ? assign_work+0x152/0x380 [ 615.803222][ T44] worker_thread+0x4d6/0xd40 [ 615.803348][ T44] ? process_one_work+0x1390/0x1390 [ 615.803471][ T44] kthread+0x355/0x5b0 [ 615.803562][ T44] ? kthread_is_per_cpu+0xe0/0xe0 [ 615.803682][ T44] ? __lock_release.isra.0+0x59/0x170 [ 615.803808][ T44] ? rcu_is_watching+0x15/0xd0 [ 615.803932][ T44] ? kthread_is_per_cpu+0xe0/0xe0 [ 615.804053][ T44] ret_from_fork+0x1d4/0x270 [ 615.804189][ T44] ? kthread_is_per_cpu+0xe0/0xe0 [ 615.804309][ T44] ret_from_fork_asm+0x11/0x20 [ 615.804435][ T44] [ 615.804538][ T44] [ 615.804538][ T44] Showing all locks held in the system: [ 615.804733][ T44] 3 locks held by kworker/0:0/9: [ 615.804859][ T44] #0: ff11000001139b48 ((wq_completion)events){+.+.}-{0:0}, at: process_one_work+0xcb4/0x1390 [ 615.805105][ T44] #1: ffa0000000097d30 ((work_completion)(&pool->work)){+.+.}-{0:0}, at: process_one_work+0xd16/0x1390 [ 615.805575][ T44] #2: ffffffff87292a28 (rtnl_mutex){+.+.}-{4:4}, at: xp_release_deferred+0x1b/0x1e0 [ 615.805896][ T44] 3 locks held by kworker/u16:0/12: [ 615.806077][ T44] #0: ff1100000917cd48 ((wq_completion)ipv6_addrconf){+.+.}-{0:0}, at: process_one_work+0xcb4/0x1390 [ 615.806445][ T44] #1: ffa00000000c7d30 ((work_completion)(&(&net->ipv6.addr_chk_work)->work)){+.+.}-{0:0}, at: process_one_work+0xd16/0x1390 [ 615.806891][ T44] #2: ffffffff87292a28 (rtnl_mutex){+.+.}-{4:4}, at: addrconf_verify_work+0x12/0x30 [ 615.807234][ T44] 4 locks held by kworker/2:0/28: [ 615.807414][ T44] #0: ff11000001139b48 ((wq_completion)events){+.+.}-{0:0}, at: process_one_work+0xcb4/0x1390 [ 615.807678][ T44] #1: ffa00000001ffd30 ((work_completion)(&(&vi->refill)->work)){+.+.}-{0:0}, at: process_one_work+0xd16/0x1390 [ 615.807948][ T44] #2: ff11000008c32c98 (&dev->lock){+.+.}-{4:4}, at: napi_disable+0x3b/0x80 [ 615.808159][ T44] #3: ff11000035336b58 (&rq->__lock){-.-.}-{2:2}, at: __schedule+0x174/0x1b90 [ 615.808385][ T44] 1 lock held by khungtaskd/44: [ 615.808501][ T44] #0: ffffffff86b78fc0 (rcu_read_lock){....}-{1:3}, at: debug_show_all_locks+0x2b/0x1db [ 615.808723][ T44] 2 locks held by ip/4864: [ 615.808839][ T44] #0: ffffffff87292a28 (rtnl_mutex){+.+.}-{4:4}, at: rtnl_newlink+0x5df/0xb20 [ 615.809056][ T44] #1: ff11000008c32c98 (&dev->lock){+.+.}-{4:4}, at: napi_enable+0x3b/0x80 [ 615.809337][ T44] [ 615.809438][ T44] ============================================= [ 615.809438][ T44]