====================================== | not ok 1 selftests: drivers/net: xdp.py # TIMEOUT 360 seconds | /srv/vmksft/testing/wt-22/tools/testing/selftests/kselftest/runner.sh: line 50: : No such file or directory | make: Leaving directory '/srv/vmksft/testing/wt-22/tools/testing/selftests' | xx__-> echo $? | 0 xx__-> [ 247.104762][ T44] INFO: task ip:256 blocked for more than 122 seconds. [ 247.105115][ T44] Not tainted 6.19.0-rc1-virtme #1 [ 247.105258][ T44] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 247.105497][ T44] task:ip state:D stack:25520 pid:256 tgid:256 ppid:1 task_flags:0x400100 flags:0x00080002 [ 247.105828][ T44] Call Trace: [ 247.105939][ T44] [ 247.106018][ T44] __schedule (kernel/sched/core.c:5259 kernel/sched/core.c:6863) [ 247.106166][ T44] ? io_schedule_timeout (kernel/sched/core.c:6719) [ 247.106294][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 247.106417][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 247.106543][ T44] schedule (kernel/sched/core.c:6946 kernel/sched/core.c:6960) [ 247.106636][ T44] schedule_preempt_disabled (kernel/sched/core.c:7018) [ 247.106765][ T44] __mutex_lock (kernel/locking/mutex.c:199 kernel/locking/mutex.c:694 kernel/locking/mutex.c:776) [ 247.106888][ T44] ? __folio_put (mm/swap.c:98) [ 247.107015][ T44] ? napi_enable (net/core/dev.c:7618) [ 247.107142][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 247.107262][ T44] ? dma_map_phys (./include/trace/events/dma.h:75 (discriminator 33) kernel/dma/mapping.c:177 (discriminator 33)) [ 247.107381][ T44] ? __asan_memset (mm/kasan/shadow.c:84 (discriminator 2)) [ 247.107498][ T44] ? sg_init_table (lib/scatterlist.c:106) [ 247.107615][ T44] ? try_fill_recv (drivers/net/virtio_net.c:2865 (discriminator 1)) [ 247.107740][ T44] ? napi_enable (net/core/dev.c:7618) [ 247.107856][ T44] napi_enable (net/core/dev.c:7618) [ 247.107944][ T44] __virtnet_rx_resume (./include/linux/bottom_half.h:20 (discriminator 1) drivers/net/virtio_net.c:2894 (discriminator 1) drivers/net/virtio_net.c:2904 (discriminator 1) drivers/net/virtio_net.c:3481 (discriminator 1)) [ 247.108064][ T44] ? queue_delayed_work_on (./arch/x86/include/asm/irqflags.h:26 ./arch/x86/include/asm/irqflags.h:109 ./arch/x86/include/asm/irqflags.h:151 kernel/workqueue.c:2559) [ 247.108183][ T44] virtnet_rx_resume_all (drivers/net/virtio_net.c:3492 (discriminator 1)) [ 247.108302][ T44] virtnet_xdp_set (drivers/net/virtio_net.c:6140 (discriminator 1)) [ 247.108421][ T44] ? virtnet_xdp_set (drivers/net/virtio_net.c:6167) [ 247.108533][ T44] dev_xdp_install (net/core/dev.c:10314) [ 247.108648][ T44] ? netif_set_xps_queue (net/core/dev.c:10282) [ 247.108989][ T44] dev_xdp_attach (net/core/dev.c:10470) [ 247.109113][ T44] ? bpf_xdp_link_update (net/core/dev.c:10360) [ 247.109229][ T44] ? __bpf_prog_get (kernel/bpf/syscall.c:2622) [ 247.109345][ T44] dev_change_xdp_fd (net/core/dev.c:10724) [ 247.109461][ T44] do_setlink.isra.0 (net/core/rtnetlink.c:3392) [ 247.109577][ T44] ? rtnl_newlink_create (net/core/rtnetlink.c:3036) [ 247.109691][ T44] ? rcu_lockdep_current_cpu_online (kernel/rcu/tree.c:4028 (discriminator 2) kernel/rcu/tree.c:4020 (discriminator 2)) [ 247.109845][ T44] ? rcu_read_lock_any_held (kernel/rcu/update.c:386 (discriminator 1) kernel/rcu/update.c:380 (discriminator 1)) [ 247.109957][ T44] ? validate_chain (kernel/locking/lockdep.c:3801 (discriminator 4) kernel/locking/lockdep.c:3821 (discriminator 4) kernel/locking/lockdep.c:3876 (discriminator 4)) [ 247.110074][ T44] ? rcu_read_lock_any_held (./include/linux/lockdep.h:249 kernel/rcu/update.c:388 kernel/rcu/update.c:380) [ 247.110186][ T44] ? stack_depot_save_flags (lib/stackdepot.c:601 (discriminator 4) lib/stackdepot.c:668 (discriminator 4)) [ 247.110302][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 247.110418][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 247.110531][ T44] ? rtnl_newlink (net/core/rtnetlink.c:343 (discriminator 1) net/core/rtnetlink.c:4071 (discriminator 1)) [ 247.110646][ T44] ? lock_acquire (./include/trace/events/lock.h:24 (discriminator 33) kernel/locking/lockdep.c:5831 (discriminator 33)) [ 247.110762][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 247.110878][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 247.110994][ T44] ? trace_contention_end (./include/trace/events/lock.h:122 (discriminator 33)) [ 247.111112][ T44] ? __mutex_lock (kernel/locking/mutex.c:624 (discriminator 3) kernel/locking/mutex.c:776 (discriminator 3)) [ 247.111230][ T44] ? rtnl_newlink (net/core/rtnetlink.c:343 (discriminator 1) net/core/rtnetlink.c:4071 (discriminator 1)) [ 247.111345][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 247.111459][ T44] ? nla_get_range_signed (lib/nlattr.c:396) [ 247.111575][ T44] ? __rtnl_newlink (net/core/rtnetlink.c:3922) [ 247.111692][ T44] rtnl_newlink (net/core/rtnetlink.c:351 (discriminator 1) net/core/rtnetlink.c:4073 (discriminator 1)) [ 247.111814][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 247.111930][ T44] ? rtnl_setlink (net/core/rtnetlink.c:3963) [ 247.112046][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 247.112163][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 247.112275][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 247.112391][ T44] ? rtnl_setlink (net/core/rtnetlink.c:3963) [ 247.112505][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 247.112619][ T44] ? rtnl_setlink (net/core/rtnetlink.c:3963) [ 247.112740][ T44] rtnetlink_rcv_msg (net/core/rtnetlink.c:6958) [ 247.112854][ T44] ? rtnl_fdb_dump (net/core/rtnetlink.c:6861) [ 247.112972][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 247.113094][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 247.113207][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 247.113322][ T44] netlink_rcv_skb (net/netlink/af_netlink.c:2550) [ 247.113439][ T44] ? rtnl_fdb_dump (net/core/rtnetlink.c:6861) [ 247.113555][ T44] ? netlink_ack (net/netlink/af_netlink.c:2527) [ 247.113672][ T44] ? netlink_deliver_tap (./include/linux/rcupdate.h:341 (discriminator 1) ./include/linux/rcupdate.h:897 (discriminator 1) ./include/net/netns/generic.h:48 (discriminator 1) net/netlink/af_netlink.c:333 (discriminator 1)) [ 247.113793][ T44] ? netlink_deliver_tap (./include/linux/rcupdate.h:341 (discriminator 1) ./include/linux/rcupdate.h:897 (discriminator 1) net/netlink/af_netlink.c:340 (discriminator 1)) [ 247.113907][ T44] netlink_unicast (net/netlink/af_netlink.c:1319 net/netlink/af_netlink.c:1344) [ 247.114023][ T44] ? netlink_attachskb (net/netlink/af_netlink.c:1329) [ 247.114139][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 247.114252][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 247.114366][ T44] netlink_sendmsg (net/netlink/af_netlink.c:1894) [ 247.114481][ T44] ? netlink_unicast (net/netlink/af_netlink.c:1813) [ 247.114597][ T44] ____sys_sendmsg (net/socket.c:727 (discriminator 4) net/socket.c:742 (discriminator 4) net/socket.c:2592 (discriminator 4)) [ 247.114713][ T44] ? copy_msghdr_from_user (net/socket.c:2532) [ 247.114831][ T44] ? get_timestamp.constprop.0 (net/socket.c:2538) [ 247.114987][ T44] ? move_addr_to_kernel (net/socket.c:2518) [ 247.115102][ T44] ? stack_depot_save_flags (lib/stackdepot.c:601 (discriminator 4) lib/stackdepot.c:668 (discriminator 4)) [ 247.115213][ T44] ? rcu_read_lock_any_held (kernel/rcu/update.c:386 (discriminator 1) kernel/rcu/update.c:380 (discriminator 1)) [ 247.115326][ T44] ___sys_sendmsg (net/socket.c:2648) [ 247.115438][ T44] ? __call_rcu_common.constprop.0 (./arch/x86/include/asm/irqflags.h:26 ./arch/x86/include/asm/irqflags.h:109 ./arch/x86/include/asm/irqflags.h:127 kernel/rcu/tree.c:3121) [ 247.115579][ T44] ? copy_msghdr_from_user (net/socket.c:2635) [ 247.115705][ T44] __sys_sendmsg (net/socket.c:2678 (discriminator 1)) [ 247.115822][ T44] ? __sys_sendmsg_sock (net/socket.c:2663) [ 247.115936][ T44] ? lockdep_hardirqs_on (kernel/locking/lockdep.c:4473) [ 247.116050][ T44] ? __call_rcu_common.constprop.0 (./arch/x86/include/asm/irqflags.h:26 ./arch/x86/include/asm/irqflags.h:109 ./arch/x86/include/asm/irqflags.h:151 kernel/rcu/tree.c:3144) [ 247.116193][ T44] ? 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) [ 247.116305][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 247.116419][ T44] do_syscall_64 (arch/x86/entry/syscall_64.c:63 (discriminator 1) arch/x86/entry/syscall_64.c:94 (discriminator 1)) [ 247.116534][ T44] entry_SYSCALL_64_after_hwframe (arch/x86/entry/entry_64.S:131) [ 247.116676][ T44] RIP: 0033:0x7f73c7ff1c5e [ 247.116804][ T44] RSP: 002b:00007fff00886460 EFLAGS: 00000202 ORIG_RAX: 000000000000002e [ 247.116984][ T44] RAX: ffffffffffffffda RBX: 0000000000000007 RCX: 00007f73c7ff1c5e [ 247.117159][ T44] RDX: 0000000000000000 RSI: 00007fff00886520 RDI: 0000000000000003 [ 247.117329][ T44] RBP: 00007fff00886470 R08: 0000000000000000 R09: 0000000000000000 [ 247.117503][ T44] R10: 0000000000000000 R11: 0000000000000202 R12: 00007fff00886be0 [ 247.117673][ T44] R13: 000000006954d91d R14: 0000000000000000 R15: 0000000000499600 | [ 247.126691][ T44] 1 lock held by ip/322: | [ 247.126783][ T44] #0: ffffffff8ca85768 (rtnl_mutex){+.+.}-{4:4}, at: rtnetlink_rcv_msg (net/core/rtnetlink.c:6965) | [ 247.126973][ T44] | [ 247.127039][ T44] ============================================= | [ 247.127039][ T44] [ 369.984740][ T44] INFO: task kworker/u16:0:12 blocked for more than 122 seconds. [ 369.985007][ T44] Not tainted 6.19.0-rc1-virtme #1 [ 369.985143][ T44] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 369.985371][ T44] task:kworker/u16:0 state:D stack:27696 pid:12 tgid:12 ppid:2 task_flags:0x4208060 flags:0x00080000 [ 369.985661][ T44] Workqueue: ipv6_addrconf addrconf_verify_work [ 369.985839][ T44] Call Trace: [ 369.985937][ T44] [ 369.986005][ T44] __schedule (kernel/sched/core.c:5259 kernel/sched/core.c:6863) [ 369.986143][ T44] ? io_schedule_timeout (kernel/sched/core.c:6719) [ 369.986272][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 369.986399][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 369.986522][ T44] schedule (kernel/sched/core.c:6946 kernel/sched/core.c:6960) [ 369.986612][ T44] schedule_preempt_disabled (kernel/sched/core.c:7018) [ 369.986736][ T44] __mutex_lock (kernel/locking/mutex.c:199 kernel/locking/mutex.c:694 kernel/locking/mutex.c:776) [ 369.986865][ T44] ? addrconf_verify_work (net/ipv6/addrconf.c:4731 (discriminator 1)) [ 369.986983][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 369.987109][ T44] ? process_one_work (kernel/workqueue.c:3233 (discriminator 1)) [ 369.987228][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 369.987348][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 369.987466][ T44] ? addrconf_verify_work (net/ipv6/addrconf.c:4731 (discriminator 1)) [ 369.987576][ T44] addrconf_verify_work (net/ipv6/addrconf.c:4731 (discriminator 1)) [ 369.987690][ T44] process_one_work (kernel/workqueue.c:3262) [ 369.987813][ T44] ? pwq_dec_nr_in_flight (kernel/workqueue.c:3159) [ 369.987930][ T44] ? assign_work (kernel/workqueue.c:1200) [ 369.988044][ T44] worker_thread (kernel/workqueue.c:3334 (discriminator 2) kernel/workqueue.c:3421 (discriminator 2)) [ 369.988168][ T44] ? process_one_work (kernel/workqueue.c:3367) [ 369.988284][ T44] kthread (kernel/kthread.c:463) [ 369.988370][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 369.988484][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 369.988597][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 369.988711][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 369.988830][ T44] ret_from_fork (arch/x86/kernel/process.c:164) [ 369.988949][ T44] ? arch_exit_to_user_mode_prepare.isra.0 (arch/x86/entry/syscall_64.c:37) [ 369.989096][ T44] ? __switch_to (./arch/x86/include/asm/cpufeature.h:101 arch/x86/kernel/process_64.c:377 arch/x86/kernel/process_64.c:665) [ 369.989210][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 369.989324][ T44] ret_from_fork_asm (arch/x86/entry/entry_64.S:256) | [ 369.989444][ T44] | [ 369.989539][ T44] INFO: task kworker/u16:0:12 is blocked on a mutex likely owned by task ip:256. [ 369.989735][ T44] INFO: task kworker/2:1:51 blocked for more than 122 seconds. [ 369.989892][ T44] Not tainted 6.19.0-rc1-virtme #1 [ 369.989998][ T44] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 369.990182][ T44] task:kworker/2:1 state:D stack:27344 pid:51 tgid:51 ppid:2 task_flags:0x4208060 flags:0x00080000 [ 369.990426][ T44] Workqueue: events xp_release_deferred [ 369.990540][ T44] Call Trace: [ 369.990625][ T44] [ 369.990686][ T44] __schedule (kernel/sched/core.c:5259 kernel/sched/core.c:6863) [ 369.990814][ T44] ? io_schedule_timeout (kernel/sched/core.c:6719) [ 369.990928][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 369.991043][ T44] schedule (kernel/sched/core.c:6946 kernel/sched/core.c:6960) [ 369.991132][ T44] schedule_preempt_disabled (kernel/sched/core.c:7018) [ 369.991245][ T44] __mutex_lock (kernel/locking/mutex.c:199 kernel/locking/mutex.c:694 kernel/locking/mutex.c:776) [ 369.991359][ T44] ? xp_release_deferred (net/xdp/xsk_buff_pool.c:282) [ 369.991475][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 369.991590][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 369.991704][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 369.991819][ T44] ? process_one_work (kernel/workqueue.c:3233 (discriminator 1)) [ 369.991935][ T44] ? xp_release_deferred (net/xdp/xsk_buff_pool.c:282) [ 369.992048][ T44] xp_release_deferred (net/xdp/xsk_buff_pool.c:282) [ 369.992164][ T44] process_one_work (kernel/workqueue.c:3262) [ 369.992280][ T44] ? pwq_dec_nr_in_flight (kernel/workqueue.c:3159) [ 369.992396][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 369.992512][ T44] ? assign_work (kernel/workqueue.c:1200) [ 369.992627][ T44] worker_thread (kernel/workqueue.c:3334 (discriminator 2) kernel/workqueue.c:3421 (discriminator 2)) [ 369.992746][ T44] ? process_one_work (kernel/workqueue.c:3367) [ 369.992858][ T44] ? __kthread_parkme (./arch/x86/include/asm/bitops.h:202 (discriminator 1) ./arch/x86/include/asm/bitops.h:232 (discriminator 1) ./include/asm-generic/bitops/instrumented-non-atomic.h:142 (discriminator 1) kernel/kthread.c:290 (discriminator 1)) [ 369.992972][ T44] ? process_one_work (kernel/workqueue.c:3367) [ 369.993086][ T44] kthread (kernel/kthread.c:463) [ 369.993174][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 369.993286][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 369.993398][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 369.993511][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 369.993626][ T44] ret_from_fork (arch/x86/kernel/process.c:164) [ 369.993743][ T44] ? arch_exit_to_user_mode_prepare.isra.0 (arch/x86/entry/syscall_64.c:37) [ 369.993884][ T44] ? __switch_to (./arch/x86/include/asm/cpufeature.h:101 arch/x86/kernel/process_64.c:377 arch/x86/kernel/process_64.c:665) [ 369.994002][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 369.994121][ T44] ret_from_fork_asm (arch/x86/entry/entry_64.S:256) | [ 369.994238][ T44] | [ 369.994333][ T44] INFO: task kworker/2:1:51 is blocked on a mutex likely owned by task ip:256. [ 369.994523][ T44] INFO: task ip:256 blocked for more than 245 seconds. [ 369.994652][ T44] Not tainted 6.19.0-rc1-virtme #1 [ 369.994771][ T44] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 369.994960][ T44] task:ip state:D stack:25520 pid:256 tgid:256 ppid:1 task_flags:0x400100 flags:0x00080002 [ 369.995206][ T44] Call Trace: [ 369.995290][ T44] [ 369.995348][ T44] __schedule (kernel/sched/core.c:5259 kernel/sched/core.c:6863) [ 369.995463][ T44] ? io_schedule_timeout (kernel/sched/core.c:6719) [ 369.995577][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 369.995692][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 369.995816][ T44] schedule (kernel/sched/core.c:6946 kernel/sched/core.c:6960) [ 369.995901][ T44] schedule_preempt_disabled (kernel/sched/core.c:7018) [ 369.996014][ T44] __mutex_lock (kernel/locking/mutex.c:199 kernel/locking/mutex.c:694 kernel/locking/mutex.c:776) [ 369.996132][ T44] ? __folio_put (mm/swap.c:98) [ 369.996246][ T44] ? napi_enable (net/core/dev.c:7618) [ 369.996360][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 369.996474][ T44] ? dma_map_phys (./include/trace/events/dma.h:75 (discriminator 33) kernel/dma/mapping.c:177 (discriminator 33)) [ 369.996588][ T44] ? __asan_memset (mm/kasan/shadow.c:84 (discriminator 2)) [ 369.996703][ T44] ? sg_init_table (lib/scatterlist.c:106) [ 369.996823][ T44] ? try_fill_recv (drivers/net/virtio_net.c:2865 (discriminator 1)) [ 369.996938][ T44] ? napi_enable (net/core/dev.c:7618) [ 369.997052][ T44] napi_enable (net/core/dev.c:7618) [ 369.997139][ T44] __virtnet_rx_resume (./include/linux/bottom_half.h:20 (discriminator 1) drivers/net/virtio_net.c:2894 (discriminator 1) drivers/net/virtio_net.c:2904 (discriminator 1) drivers/net/virtio_net.c:3481 (discriminator 1)) [ 369.997252][ T44] ? queue_delayed_work_on (./arch/x86/include/asm/irqflags.h:26 ./arch/x86/include/asm/irqflags.h:109 ./arch/x86/include/asm/irqflags.h:151 kernel/workqueue.c:2559) [ 369.997368][ T44] virtnet_rx_resume_all (drivers/net/virtio_net.c:3492 (discriminator 1)) [ 369.997482][ T44] virtnet_xdp_set (drivers/net/virtio_net.c:6140 (discriminator 1)) [ 369.997599][ T44] ? virtnet_xdp_set (drivers/net/virtio_net.c:6167) [ 369.997712][ T44] dev_xdp_install (net/core/dev.c:10314) [ 369.997831][ T44] ? netif_set_xps_queue (net/core/dev.c:10282) [ 369.997953][ T44] dev_xdp_attach (net/core/dev.c:10470) [ 369.998069][ T44] ? bpf_xdp_link_update (net/core/dev.c:10360) [ 369.998187][ T44] ? __bpf_prog_get (kernel/bpf/syscall.c:2622) [ 369.998304][ T44] dev_change_xdp_fd (net/core/dev.c:10724) [ 369.998420][ T44] do_setlink.isra.0 (net/core/rtnetlink.c:3392) [ 369.998535][ T44] ? rtnl_newlink_create (net/core/rtnetlink.c:3036) [ 369.998648][ T44] ? rcu_lockdep_current_cpu_online (kernel/rcu/tree.c:4028 (discriminator 2) kernel/rcu/tree.c:4020 (discriminator 2)) [ 369.998796][ T44] ? rcu_read_lock_any_held (kernel/rcu/update.c:386 (discriminator 1) kernel/rcu/update.c:380 (discriminator 1)) [ 369.998909][ T44] ? validate_chain (kernel/locking/lockdep.c:3801 (discriminator 4) kernel/locking/lockdep.c:3821 (discriminator 4) kernel/locking/lockdep.c:3876 (discriminator 4)) [ 369.999028][ T44] ? rcu_read_lock_any_held (./include/linux/lockdep.h:249 kernel/rcu/update.c:388 kernel/rcu/update.c:380) [ 369.999143][ T44] ? stack_depot_save_flags (lib/stackdepot.c:601 (discriminator 4) lib/stackdepot.c:668 (discriminator 4)) [ 369.999259][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 369.999374][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 369.999488][ T44] ? rtnl_newlink (net/core/rtnetlink.c:343 (discriminator 1) net/core/rtnetlink.c:4071 (discriminator 1)) [ 369.999600][ T44] ? lock_acquire (./include/trace/events/lock.h:24 (discriminator 33) kernel/locking/lockdep.c:5831 (discriminator 33)) [ 369.999712][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 369.999835][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 369.999949][ T44] ? trace_contention_end (./include/trace/events/lock.h:122 (discriminator 33)) [ 370.000062][ T44] ? __mutex_lock (kernel/locking/mutex.c:624 (discriminator 3) kernel/locking/mutex.c:776 (discriminator 3)) [ 370.000180][ T44] ? rtnl_newlink (net/core/rtnetlink.c:343 (discriminator 1) net/core/rtnetlink.c:4071 (discriminator 1)) [ 370.000294][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 370.000407][ T44] ? nla_get_range_signed (lib/nlattr.c:396) [ 370.000523][ T44] ? __rtnl_newlink (net/core/rtnetlink.c:3922) [ 370.000638][ T44] rtnl_newlink (net/core/rtnetlink.c:351 (discriminator 1) net/core/rtnetlink.c:4073 (discriminator 1)) [ 370.000759][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 370.000872][ T44] ? rtnl_setlink (net/core/rtnetlink.c:3963) [ 370.000985][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 370.001103][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 370.001215][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 370.001327][ T44] ? rtnl_setlink (net/core/rtnetlink.c:3963) [ 370.001440][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 370.001555][ T44] ? rtnl_setlink (net/core/rtnetlink.c:3963) [ 370.001667][ T44] rtnetlink_rcv_msg (net/core/rtnetlink.c:6958) [ 370.001787][ T44] ? rtnl_fdb_dump (net/core/rtnetlink.c:6861) [ 370.001900][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 370.002012][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 370.002126][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 370.002239][ T44] netlink_rcv_skb (net/netlink/af_netlink.c:2550) [ 370.002353][ T44] ? rtnl_fdb_dump (net/core/rtnetlink.c:6861) [ 370.002469][ T44] ? netlink_ack (net/netlink/af_netlink.c:2527) [ 370.002584][ T44] ? netlink_deliver_tap (./include/linux/rcupdate.h:341 (discriminator 1) ./include/linux/rcupdate.h:897 (discriminator 1) ./include/net/netns/generic.h:48 (discriminator 1) net/netlink/af_netlink.c:333 (discriminator 1)) [ 370.002695][ T44] ? netlink_deliver_tap (./include/linux/rcupdate.h:341 (discriminator 1) ./include/linux/rcupdate.h:897 (discriminator 1) net/netlink/af_netlink.c:340 (discriminator 1)) [ 370.002819][ T44] netlink_unicast (net/netlink/af_netlink.c:1319 net/netlink/af_netlink.c:1344) [ 370.002937][ T44] ? netlink_attachskb (net/netlink/af_netlink.c:1329) [ 370.003049][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 370.003166][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 370.003282][ T44] netlink_sendmsg (net/netlink/af_netlink.c:1894) [ 370.003395][ T44] ? netlink_unicast (net/netlink/af_netlink.c:1813) [ 370.003511][ T44] ____sys_sendmsg (net/socket.c:727 (discriminator 4) net/socket.c:742 (discriminator 4) net/socket.c:2592 (discriminator 4)) [ 370.003624][ T44] ? copy_msghdr_from_user (net/socket.c:2532) [ 370.003740][ T44] ? get_timestamp.constprop.0 (net/socket.c:2538) [ 370.003880][ T44] ? move_addr_to_kernel (net/socket.c:2518) [ 370.003993][ T44] ? stack_depot_save_flags (lib/stackdepot.c:601 (discriminator 4) lib/stackdepot.c:668 (discriminator 4)) [ 370.004109][ T44] ? rcu_read_lock_any_held (kernel/rcu/update.c:386 (discriminator 1) kernel/rcu/update.c:380 (discriminator 1)) [ 370.004226][ T44] ___sys_sendmsg (net/socket.c:2648) [ 370.004339][ T44] ? __call_rcu_common.constprop.0 (./arch/x86/include/asm/irqflags.h:26 ./arch/x86/include/asm/irqflags.h:109 ./arch/x86/include/asm/irqflags.h:127 kernel/rcu/tree.c:3121) [ 370.004478][ T44] ? copy_msghdr_from_user (net/socket.c:2635) [ 370.004608][ T44] __sys_sendmsg (net/socket.c:2678 (discriminator 1)) [ 370.004722][ T44] ? __sys_sendmsg_sock (net/socket.c:2663) [ 370.004843][ T44] ? lockdep_hardirqs_on (kernel/locking/lockdep.c:4473) [ 370.004958][ T44] ? __call_rcu_common.constprop.0 (./arch/x86/include/asm/irqflags.h:26 ./arch/x86/include/asm/irqflags.h:109 ./arch/x86/include/asm/irqflags.h:151 kernel/rcu/tree.c:3144) [ 370.005105][ T44] ? 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) [ 370.005219][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 370.005333][ T44] do_syscall_64 (arch/x86/entry/syscall_64.c:63 (discriminator 1) arch/x86/entry/syscall_64.c:94 (discriminator 1)) [ 370.005448][ T44] entry_SYSCALL_64_after_hwframe (arch/x86/entry/entry_64.S:131) [ 370.005588][ T44] RIP: 0033:0x7f73c7ff1c5e [ 370.005710][ T44] RSP: 002b:00007fff00886460 EFLAGS: 00000202 ORIG_RAX: 000000000000002e [ 370.005890][ T44] RAX: ffffffffffffffda RBX: 0000000000000007 RCX: 00007f73c7ff1c5e [ 370.006059][ T44] RDX: 0000000000000000 RSI: 00007fff00886520 RDI: 0000000000000003 [ 370.006232][ T44] RBP: 00007fff00886470 R08: 0000000000000000 R09: 0000000000000000 [ 370.006401][ T44] R10: 0000000000000000 R11: 0000000000000202 R12: 00007fff00886be0 [ 370.006575][ T44] R13: 000000006954d91d R14: 0000000000000000 R15: 0000000000499600 | [ 370.011696][ T44] ? arch_exit_to_user_mode_prepare.isra.0 (arch/x86/entry/syscall_64.c:37) | [ 370.011896][ T44] ? __switch_to (./arch/x86/include/asm/cpufeature.h:101 arch/x86/kernel/process_64.c:377 arch/x86/kernel/process_64.c:665) | [ 370.012011][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) | [ 370.012128][ T44] ret_from_fork_asm (arch/x86/entry/entry_64.S:256) | [ 370.012302][ T44] [ 370.012391][ T44] INFO: task ip:322 blocked for more than 122 seconds. [ 370.012524][ T44] Not tainted 6.19.0-rc1-virtme #1 [ 370.012629][ T44] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 370.012862][ T44] task:ip state:D stack:25624 pid:322 tgid:322 ppid:321 task_flags:0x400100 flags:0x00080000 [ 370.013109][ T44] Call Trace: [ 370.013195][ T44] [ 370.013312][ T44] __schedule (kernel/sched/core.c:5259 kernel/sched/core.c:6863) [ 370.013428][ T44] ? io_schedule_timeout (kernel/sched/core.c:6719) [ 370.013543][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 370.013656][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 370.013777][ T44] schedule (kernel/sched/core.c:6946 kernel/sched/core.c:6960) [ 370.013863][ T44] schedule_preempt_disabled (kernel/sched/core.c:7018) [ 370.013977][ T44] __mutex_lock (kernel/locking/mutex.c:199 kernel/locking/mutex.c:694 kernel/locking/mutex.c:776) [ 370.014096][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 370.014210][ T44] ? rtnetlink_rcv_msg (net/core/rtnetlink.c:6965) [ 370.014322][ T44] ? write_profile (kernel/stacktrace.c:83) [ 370.014439][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 370.014556][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 370.014732][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 370.014847][ T44] ? rtnetlink_rcv_msg (net/core/rtnetlink.c:6965) [ 370.014961][ T44] rtnetlink_rcv_msg (net/core/rtnetlink.c:6965) [ 370.015078][ T44] ? rtnl_fdb_dump (net/core/rtnetlink.c:6861) [ 370.015245][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 370.015359][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 370.015472][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 370.015586][ T44] netlink_rcv_skb (net/netlink/af_netlink.c:2550) [ 370.015762][ T44] ? rtnl_fdb_dump (net/core/rtnetlink.c:6861) [ 370.015875][ T44] ? netlink_ack (net/netlink/af_netlink.c:2527) [ 370.015993][ T44] ? netlink_deliver_tap (./include/linux/rcupdate.h:341 (discriminator 1) ./include/linux/rcupdate.h:897 (discriminator 1) ./include/net/netns/generic.h:48 (discriminator 1) net/netlink/af_netlink.c:333 (discriminator 1)) [ 370.016108][ T44] ? netlink_deliver_tap (./include/linux/rcupdate.h:341 (discriminator 1) ./include/linux/rcupdate.h:897 (discriminator 1) net/netlink/af_netlink.c:340 (discriminator 1)) [ 370.016281][ T44] netlink_unicast (net/netlink/af_netlink.c:1319 net/netlink/af_netlink.c:1344) [ 370.016394][ T44] ? netlink_attachskb (net/netlink/af_netlink.c:1329) [ 370.016508][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 370.016622][ T44] netlink_sendmsg (net/netlink/af_netlink.c:1894) [ 370.016792][ T44] ? netlink_unicast (net/netlink/af_netlink.c:1813) [ 370.016908][ T44] ____sys_sendmsg (net/socket.c:727 (discriminator 4) net/socket.c:742 (discriminator 4) net/socket.c:2592 (discriminator 4)) [ 370.017024][ T44] ? copy_msghdr_from_user (net/socket.c:2532) [ 370.017139][ T44] ? get_timestamp.constprop.0 (net/socket.c:2538) [ 370.017333][ T44] ? move_addr_to_kernel (net/socket.c:2518) [ 370.017445][ T44] ? rcu_read_lock_any_held (kernel/rcu/update.c:386 (discriminator 1) kernel/rcu/update.c:380 (discriminator 1)) [ 370.017559][ T44] ? rcu_lockdep_current_cpu_online (kernel/rcu/tree.c:4028 (discriminator 2) kernel/rcu/tree.c:4020 (discriminator 2)) [ 370.017699][ T44] ? rcu_read_lock_any_held (kernel/rcu/update.c:386 (discriminator 1) kernel/rcu/update.c:380 (discriminator 1)) [ 370.017819][ T44] ___sys_sendmsg (net/socket.c:2648) [ 370.017932][ T44] ? copy_msghdr_from_user (net/socket.c:2635) [ 370.018045][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 370.018170][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 370.018287][ T44] ? move_addr_to_user (net/socket.c:306 (discriminator 1)) [ 370.018399][ T44] ? do_getsockname (net/socket.c:2119) [ 370.018513][ T44] __sys_sendmsg (net/socket.c:2678 (discriminator 1)) [ 370.018626][ T44] ? __sys_sendmsg_sock (net/socket.c:2663) [ 370.018806][ T44] ? __sys_getsockname (./include/linux/file.h:62 (discriminator 1) ./include/linux/file.h:83 (discriminator 1) net/socket.c:2144 (discriminator 1)) [ 370.018920][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 370.019033][ T44] do_syscall_64 (arch/x86/entry/syscall_64.c:63 (discriminator 1) arch/x86/entry/syscall_64.c:94 (discriminator 1)) [ 370.019150][ T44] entry_SYSCALL_64_after_hwframe (arch/x86/entry/entry_64.S:131) [ 370.019344][ T44] RIP: 0033:0x7f2470d1fc5e [ 370.019461][ T44] RSP: 002b:00007fff14c31cc0 EFLAGS: 00000202 ORIG_RAX: 000000000000002e [ 370.019631][ T44] RAX: ffffffffffffffda RBX: 0000000000000000 RCX: 00007f2470d1fc5e [ 370.019868][ T44] RDX: 0000000000000000 RSI: 00007fff14c31d80 RDI: 0000000000000004 [ 370.020037][ T44] RBP: 00007fff14c31cd0 R08: 0000000000000000 R09: 0000000000000000 [ 370.020210][ T44] R10: 0000000000000000 R11: 0000000000000202 R12: 00007fff14c3368d [ 370.020435][ T44] R13: 000000006954d9ed R14: 000000000000000d R15: 00007fff14c31e30 | [ 370.024469][ T44] 1 lock held by ip/322: | [ 370.024550][ T44] #0: ffffffff8ca85768 (rtnl_mutex){+.+.}-{4:4}, at: rtnetlink_rcv_msg (net/core/rtnetlink.c:6965) | [ 370.024773][ T44] | [ 370.024828][ T44] ============================================= | [ 370.024828][ T44] [ 492.864740][ T44] INFO: task kworker/u16:0:12 blocked for more than 245 seconds. [ 492.865014][ T44] Not tainted 6.19.0-rc1-virtme #1 [ 492.865154][ T44] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 492.865385][ T44] task:kworker/u16:0 state:D stack:27696 pid:12 tgid:12 ppid:2 task_flags:0x4208060 flags:0x00080000 [ 492.865687][ T44] Workqueue: ipv6_addrconf addrconf_verify_work [ 492.865863][ T44] Call Trace: [ 492.865957][ T44] [ 492.866021][ T44] __schedule (kernel/sched/core.c:5259 kernel/sched/core.c:6863) [ 492.866151][ T44] ? io_schedule_timeout (kernel/sched/core.c:6719) [ 492.866277][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.866403][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.866529][ T44] schedule (kernel/sched/core.c:6946 kernel/sched/core.c:6960) [ 492.866623][ T44] schedule_preempt_disabled (kernel/sched/core.c:7018) [ 492.866749][ T44] __mutex_lock (kernel/locking/mutex.c:199 kernel/locking/mutex.c:694 kernel/locking/mutex.c:776) [ 492.866867][ T44] ? addrconf_verify_work (net/ipv6/addrconf.c:4731 (discriminator 1)) [ 492.866985][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 492.867106][ T44] ? process_one_work (kernel/workqueue.c:3233 (discriminator 1)) [ 492.867230][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 492.867345][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 492.867463][ T44] ? addrconf_verify_work (net/ipv6/addrconf.c:4731 (discriminator 1)) [ 492.867578][ T44] addrconf_verify_work (net/ipv6/addrconf.c:4731 (discriminator 1)) [ 492.867694][ T44] process_one_work (kernel/workqueue.c:3262) [ 492.867817][ T44] ? pwq_dec_nr_in_flight (kernel/workqueue.c:3159) [ 492.867933][ T44] ? assign_work (kernel/workqueue.c:1200) [ 492.868050][ T44] worker_thread (kernel/workqueue.c:3334 (discriminator 2) kernel/workqueue.c:3421 (discriminator 2)) [ 492.868171][ T44] ? process_one_work (kernel/workqueue.c:3367) [ 492.868285][ T44] kthread (kernel/kthread.c:463) [ 492.868371][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 492.868484][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.868598][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 492.868711][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 492.868829][ T44] ret_from_fork (arch/x86/kernel/process.c:164) [ 492.868946][ T44] ? arch_exit_to_user_mode_prepare.isra.0 (arch/x86/entry/syscall_64.c:37) [ 492.869086][ T44] ? __switch_to (./arch/x86/include/asm/cpufeature.h:101 arch/x86/kernel/process_64.c:377 arch/x86/kernel/process_64.c:665) [ 492.869201][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 492.869314][ T44] ret_from_fork_asm (arch/x86/entry/entry_64.S:256) | [ 492.869433][ T44] | [ 492.869522][ T44] INFO: task kworker/u16:0:12 is blocked on a mutex likely owned by task ip:256. [ 492.869713][ T44] INFO: task kworker/2:1:51 blocked for more than 245 seconds. [ 492.869880][ T44] Not tainted 6.19.0-rc1-virtme #1 [ 492.869985][ T44] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 492.870169][ T44] task:kworker/2:1 state:D stack:27344 pid:51 tgid:51 ppid:2 task_flags:0x4208060 flags:0x00080000 [ 492.870414][ T44] Workqueue: events xp_release_deferred [ 492.870527][ T44] Call Trace: [ 492.870611][ T44] [ 492.870675][ T44] __schedule (kernel/sched/core.c:5259 kernel/sched/core.c:6863) [ 492.870795][ T44] ? io_schedule_timeout (kernel/sched/core.c:6719) [ 492.870910][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.871024][ T44] schedule (kernel/sched/core.c:6946 kernel/sched/core.c:6960) [ 492.871110][ T44] schedule_preempt_disabled (kernel/sched/core.c:7018) [ 492.871226][ T44] __mutex_lock (kernel/locking/mutex.c:199 kernel/locking/mutex.c:694 kernel/locking/mutex.c:776) [ 492.871342][ T44] ? xp_release_deferred (net/xdp/xsk_buff_pool.c:282) [ 492.871456][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 492.871570][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 492.871684][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 492.871801][ T44] ? process_one_work (kernel/workqueue.c:3233 (discriminator 1)) [ 492.871917][ T44] ? xp_release_deferred (net/xdp/xsk_buff_pool.c:282) [ 492.872029][ T44] xp_release_deferred (net/xdp/xsk_buff_pool.c:282) [ 492.872147][ T44] process_one_work (kernel/workqueue.c:3262) [ 492.872263][ T44] ? pwq_dec_nr_in_flight (kernel/workqueue.c:3159) [ 492.872377][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 492.872492][ T44] ? assign_work (kernel/workqueue.c:1200) [ 492.872606][ T44] worker_thread (kernel/workqueue.c:3334 (discriminator 2) kernel/workqueue.c:3421 (discriminator 2)) [ 492.872721][ T44] ? process_one_work (kernel/workqueue.c:3367) [ 492.872838][ T44] ? __kthread_parkme (./arch/x86/include/asm/bitops.h:202 (discriminator 1) ./arch/x86/include/asm/bitops.h:232 (discriminator 1) ./include/asm-generic/bitops/instrumented-non-atomic.h:142 (discriminator 1) kernel/kthread.c:290 (discriminator 1)) [ 492.872955][ T44] ? process_one_work (kernel/workqueue.c:3367) [ 492.873068][ T44] kthread (kernel/kthread.c:463) [ 492.873158][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 492.873271][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.873383][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 492.873496][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 492.873611][ T44] ret_from_fork (arch/x86/kernel/process.c:164) [ 492.873723][ T44] ? arch_exit_to_user_mode_prepare.isra.0 (arch/x86/entry/syscall_64.c:37) [ 492.873879][ T44] ? __switch_to (./arch/x86/include/asm/cpufeature.h:101 arch/x86/kernel/process_64.c:377 arch/x86/kernel/process_64.c:665) [ 492.873991][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) [ 492.874105][ T44] ret_from_fork_asm (arch/x86/entry/entry_64.S:256) | [ 492.874225][ T44] | [ 492.874312][ T44] INFO: task kworker/2:1:51 is blocked on a mutex likely owned by task ip:256. [ 492.874502][ T44] INFO: task ip:256 blocked for more than 368 seconds. [ 492.874635][ T44] Not tainted 6.19.0-rc1-virtme #1 [ 492.874746][ T44] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 492.874931][ T44] task:ip state:D stack:25520 pid:256 tgid:256 ppid:1 task_flags:0x400100 flags:0x00080002 [ 492.875178][ T44] Call Trace: [ 492.875266][ T44] [ 492.875328][ T44] __schedule (kernel/sched/core.c:5259 kernel/sched/core.c:6863) [ 492.875446][ T44] ? io_schedule_timeout (kernel/sched/core.c:6719) [ 492.875561][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.875673][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.875792][ T44] schedule (kernel/sched/core.c:6946 kernel/sched/core.c:6960) [ 492.875880][ T44] schedule_preempt_disabled (kernel/sched/core.c:7018) [ 492.875994][ T44] __mutex_lock (kernel/locking/mutex.c:199 kernel/locking/mutex.c:694 kernel/locking/mutex.c:776) [ 492.876108][ T44] ? __folio_put (mm/swap.c:98) [ 492.876228][ T44] ? napi_enable (net/core/dev.c:7618) [ 492.876344][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 492.876458][ T44] ? dma_map_phys (./include/trace/events/dma.h:75 (discriminator 33) kernel/dma/mapping.c:177 (discriminator 33)) [ 492.876572][ T44] ? __asan_memset (mm/kasan/shadow.c:84 (discriminator 2)) [ 492.876688][ T44] ? sg_init_table (lib/scatterlist.c:106) [ 492.876808][ T44] ? try_fill_recv (drivers/net/virtio_net.c:2865 (discriminator 1)) [ 492.876927][ T44] ? napi_enable (net/core/dev.c:7618) [ 492.877040][ T44] napi_enable (net/core/dev.c:7618) [ 492.877128][ T44] __virtnet_rx_resume (./include/linux/bottom_half.h:20 (discriminator 1) drivers/net/virtio_net.c:2894 (discriminator 1) drivers/net/virtio_net.c:2904 (discriminator 1) drivers/net/virtio_net.c:3481 (discriminator 1)) [ 492.877248][ T44] ? queue_delayed_work_on (./arch/x86/include/asm/irqflags.h:26 ./arch/x86/include/asm/irqflags.h:109 ./arch/x86/include/asm/irqflags.h:151 kernel/workqueue.c:2559) [ 492.877363][ T44] virtnet_rx_resume_all (drivers/net/virtio_net.c:3492 (discriminator 1)) [ 492.877480][ T44] virtnet_xdp_set (drivers/net/virtio_net.c:6140 (discriminator 1)) [ 492.877600][ T44] ? virtnet_xdp_set (drivers/net/virtio_net.c:6167) [ 492.877715][ T44] dev_xdp_install (net/core/dev.c:10314) [ 492.877840][ T44] ? netif_set_xps_queue (net/core/dev.c:10282) [ 492.877962][ T44] dev_xdp_attach (net/core/dev.c:10470) [ 492.878079][ T44] ? bpf_xdp_link_update (net/core/dev.c:10360) [ 492.878199][ T44] ? __bpf_prog_get (kernel/bpf/syscall.c:2622) [ 492.878316][ T44] dev_change_xdp_fd (net/core/dev.c:10724) [ 492.878430][ T44] do_setlink.isra.0 (net/core/rtnetlink.c:3392) [ 492.878544][ T44] ? rtnl_newlink_create (net/core/rtnetlink.c:3036) [ 492.878658][ T44] ? rcu_lockdep_current_cpu_online (kernel/rcu/tree.c:4028 (discriminator 2) kernel/rcu/tree.c:4020 (discriminator 2)) [ 492.878807][ T44] ? rcu_read_lock_any_held (kernel/rcu/update.c:386 (discriminator 1) kernel/rcu/update.c:380 (discriminator 1)) [ 492.878921][ T44] ? validate_chain (kernel/locking/lockdep.c:3801 (discriminator 4) kernel/locking/lockdep.c:3821 (discriminator 4) kernel/locking/lockdep.c:3876 (discriminator 4)) [ 492.879034][ T44] ? rcu_read_lock_any_held (./include/linux/lockdep.h:249 kernel/rcu/update.c:388 kernel/rcu/update.c:380) [ 492.879148][ T44] ? stack_depot_save_flags (lib/stackdepot.c:601 (discriminator 4) lib/stackdepot.c:668 (discriminator 4)) [ 492.879262][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 492.879378][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 492.879493][ T44] ? rtnl_newlink (net/core/rtnetlink.c:343 (discriminator 1) net/core/rtnetlink.c:4071 (discriminator 1)) [ 492.879606][ T44] ? lock_acquire (./include/trace/events/lock.h:24 (discriminator 33) kernel/locking/lockdep.c:5831 (discriminator 33)) [ 492.879718][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 492.879837][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 492.879951][ T44] ? trace_contention_end (./include/trace/events/lock.h:122 (discriminator 33)) [ 492.880065][ T44] ? __mutex_lock (kernel/locking/mutex.c:624 (discriminator 3) kernel/locking/mutex.c:776 (discriminator 3)) [ 492.880181][ T44] ? rtnl_newlink (net/core/rtnetlink.c:343 (discriminator 1) net/core/rtnetlink.c:4071 (discriminator 1)) [ 492.880295][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 492.880408][ T44] ? nla_get_range_signed (lib/nlattr.c:396) [ 492.880525][ T44] ? __rtnl_newlink (net/core/rtnetlink.c:3922) [ 492.880640][ T44] rtnl_newlink (net/core/rtnetlink.c:351 (discriminator 1) net/core/rtnetlink.c:4073 (discriminator 1)) [ 492.880758][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.880871][ T44] ? rtnl_setlink (net/core/rtnetlink.c:3963) [ 492.880985][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 492.881101][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 492.881217][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 492.881330][ T44] ? rtnl_setlink (net/core/rtnetlink.c:3963) [ 492.881446][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.881561][ T44] ? rtnl_setlink (net/core/rtnetlink.c:3963) [ 492.881673][ T44] rtnetlink_rcv_msg (net/core/rtnetlink.c:6958) [ 492.881800][ T44] ? rtnl_fdb_dump (net/core/rtnetlink.c:6861) [ 492.881914][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 492.882028][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 492.882143][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 492.882259][ T44] netlink_rcv_skb (net/netlink/af_netlink.c:2550) [ 492.882371][ T44] ? rtnl_fdb_dump (net/core/rtnetlink.c:6861) [ 492.882484][ T44] ? netlink_ack (net/netlink/af_netlink.c:2527) [ 492.882602][ T44] ? netlink_deliver_tap (./include/linux/rcupdate.h:341 (discriminator 1) ./include/linux/rcupdate.h:897 (discriminator 1) ./include/net/netns/generic.h:48 (discriminator 1) net/netlink/af_netlink.c:333 (discriminator 1)) [ 492.882714][ T44] ? netlink_deliver_tap (./include/linux/rcupdate.h:341 (discriminator 1) ./include/linux/rcupdate.h:897 (discriminator 1) net/netlink/af_netlink.c:340 (discriminator 1)) [ 492.882834][ T44] netlink_unicast (net/netlink/af_netlink.c:1319 net/netlink/af_netlink.c:1344) [ 492.882949][ T44] ? netlink_attachskb (net/netlink/af_netlink.c:1329) [ 492.883061][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 492.883179][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 492.883292][ T44] netlink_sendmsg (net/netlink/af_netlink.c:1894) [ 492.883407][ T44] ? netlink_unicast (net/netlink/af_netlink.c:1813) [ 492.883522][ T44] ____sys_sendmsg (net/socket.c:727 (discriminator 4) net/socket.c:742 (discriminator 4) net/socket.c:2592 (discriminator 4)) [ 492.883636][ T44] ? copy_msghdr_from_user (net/socket.c:2532) [ 492.883753][ T44] ? get_timestamp.constprop.0 (net/socket.c:2538) [ 492.883893][ T44] ? move_addr_to_kernel (net/socket.c:2518) [ 492.884021][ T44] ? stack_depot_save_flags (lib/stackdepot.c:601 (discriminator 4) lib/stackdepot.c:668 (discriminator 4)) [ 492.884134][ T44] ? rcu_read_lock_any_held (kernel/rcu/update.c:386 (discriminator 1) kernel/rcu/update.c:380 (discriminator 1)) [ 492.884252][ T44] ___sys_sendmsg (net/socket.c:2648) [ 492.884366][ T44] ? __call_rcu_common.constprop.0 (./arch/x86/include/asm/irqflags.h:26 ./arch/x86/include/asm/irqflags.h:109 ./arch/x86/include/asm/irqflags.h:127 kernel/rcu/tree.c:3121) [ 492.884508][ T44] ? copy_msghdr_from_user (net/socket.c:2635) [ 492.884634][ T44] __sys_sendmsg (net/socket.c:2678 (discriminator 1)) [ 492.884754][ T44] ? __sys_sendmsg_sock (net/socket.c:2663) [ 492.884868][ T44] ? lockdep_hardirqs_on (kernel/locking/lockdep.c:4473) [ 492.884980][ T44] ? __call_rcu_common.constprop.0 (./arch/x86/include/asm/irqflags.h:26 ./arch/x86/include/asm/irqflags.h:109 ./arch/x86/include/asm/irqflags.h:151 kernel/rcu/tree.c:3144) [ 492.885125][ T44] ? 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) [ 492.885243][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 492.885362][ T44] do_syscall_64 (arch/x86/entry/syscall_64.c:63 (discriminator 1) arch/x86/entry/syscall_64.c:94 (discriminator 1)) [ 492.885476][ T44] entry_SYSCALL_64_after_hwframe (arch/x86/entry/entry_64.S:131) [ 492.885617][ T44] RIP: 0033:0x7f73c7ff1c5e [ 492.885745][ T44] RSP: 002b:00007fff00886460 EFLAGS: 00000202 ORIG_RAX: 000000000000002e [ 492.885917][ T44] RAX: ffffffffffffffda RBX: 0000000000000007 RCX: 00007f73c7ff1c5e [ 492.886088][ T44] RDX: 0000000000000000 RSI: 00007fff00886520 RDI: 0000000000000003 [ 492.886259][ T44] RBP: 00007fff00886470 R08: 0000000000000000 R09: 0000000000000000 [ 492.886433][ T44] R10: 0000000000000000 R11: 0000000000000202 R12: 00007fff00886be0 [ 492.886601][ T44] R13: 000000006954d91d R14: 0000000000000000 R15: 0000000000499600 | [ 492.891685][ T44] ? arch_exit_to_user_mode_prepare.isra.0 (arch/x86/entry/syscall_64.c:37) | [ 492.891887][ T44] ? __switch_to (./arch/x86/include/asm/cpufeature.h:101 arch/x86/kernel/process_64.c:377 arch/x86/kernel/process_64.c:665) | [ 492.892000][ T44] ? kthread_is_per_cpu (kernel/kthread.c:412) | [ 492.892112][ T44] ret_from_fork_asm (arch/x86/entry/entry_64.S:256) | [ 492.892289][ T44] [ 492.892377][ T44] INFO: task ip:322 blocked for more than 245 seconds. [ 492.892506][ T44] Not tainted 6.19.0-rc1-virtme #1 [ 492.892611][ T44] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message. [ 492.892845][ T44] task:ip state:D stack:25624 pid:322 tgid:322 ppid:321 task_flags:0x400100 flags:0x00080000 [ 492.893090][ T44] Call Trace: [ 492.893177][ T44] [ 492.893291][ T44] __schedule (kernel/sched/core.c:5259 kernel/sched/core.c:6863) [ 492.893405][ T44] ? io_schedule_timeout (kernel/sched/core.c:6719) [ 492.893519][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.893631][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.893809][ T44] schedule (kernel/sched/core.c:6946 kernel/sched/core.c:6960) [ 492.893895][ T44] schedule_preempt_disabled (kernel/sched/core.c:7018) [ 492.894010][ T44] __mutex_lock (kernel/locking/mutex.c:199 kernel/locking/mutex.c:694 kernel/locking/mutex.c:776) [ 492.894125][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 492.894294][ T44] ? rtnetlink_rcv_msg (net/core/rtnetlink.c:6965) [ 492.894406][ T44] ? write_profile (kernel/stacktrace.c:83) [ 492.894520][ T44] ? ww_mutex_lock (kernel/locking/mutex.c:775) [ 492.894636][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 492.894756][ T44] ? __lock_release.isra.0 (kernel/locking/lockdep.c:5536) [ 492.894874][ T44] ? rtnetlink_rcv_msg (net/core/rtnetlink.c:6965) [ 492.894986][ T44] rtnetlink_rcv_msg (net/core/rtnetlink.c:6965) [ 492.895100][ T44] ? rtnl_fdb_dump (net/core/rtnetlink.c:6861) [ 492.895214][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 492.895329][ T44] ? lock_acquire.part.0 (kernel/locking/lockdep.c:470 kernel/locking/lockdep.c:5870) [ 492.895440][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 492.895554][ T44] netlink_rcv_skb (net/netlink/af_netlink.c:2550) [ 492.895721][ T44] ? rtnl_fdb_dump (net/core/rtnetlink.c:6861) [ 492.895845][ T44] ? netlink_ack (net/netlink/af_netlink.c:2527) [ 492.895961][ T44] ? netlink_deliver_tap (./include/linux/rcupdate.h:341 (discriminator 1) ./include/linux/rcupdate.h:897 (discriminator 1) ./include/net/netns/generic.h:48 (discriminator 1) net/netlink/af_netlink.c:333 (discriminator 1)) [ 492.896074][ T44] ? netlink_deliver_tap (./include/linux/rcupdate.h:341 (discriminator 1) ./include/linux/rcupdate.h:897 (discriminator 1) net/netlink/af_netlink.c:340 (discriminator 1)) [ 492.896247][ T44] netlink_unicast (net/netlink/af_netlink.c:1319 net/netlink/af_netlink.c:1344) [ 492.896361][ T44] ? netlink_attachskb (net/netlink/af_netlink.c:1329) [ 492.896475][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 492.896588][ T44] netlink_sendmsg (net/netlink/af_netlink.c:1894) [ 492.896764][ T44] ? netlink_unicast (net/netlink/af_netlink.c:1813) [ 492.896882][ T44] ____sys_sendmsg (net/socket.c:727 (discriminator 4) net/socket.c:742 (discriminator 4) net/socket.c:2592 (discriminator 4)) [ 492.896999][ T44] ? copy_msghdr_from_user (net/socket.c:2532) [ 492.897112][ T44] ? get_timestamp.constprop.0 (net/socket.c:2538) [ 492.897308][ T44] ? move_addr_to_kernel (net/socket.c:2518) [ 492.897421][ T44] ? rcu_read_lock_any_held (kernel/rcu/update.c:386 (discriminator 1) kernel/rcu/update.c:380 (discriminator 1)) [ 492.897536][ T44] ? rcu_lockdep_current_cpu_online (kernel/rcu/tree.c:4028 (discriminator 2) kernel/rcu/tree.c:4020 (discriminator 2)) [ 492.897679][ T44] ? rcu_read_lock_any_held (kernel/rcu/update.c:386 (discriminator 1) kernel/rcu/update.c:380 (discriminator 1)) [ 492.897802][ T44] ___sys_sendmsg (net/socket.c:2648) [ 492.897915][ T44] ? copy_msghdr_from_user (net/socket.c:2635) [ 492.898033][ T44] ? __lock_acquire (kernel/locking/lockdep.c:5237 (discriminator 1)) [ 492.898151][ T44] ? find_held_lock (kernel/locking/lockdep.c:5350 (discriminator 1)) [ 492.898271][ T44] ? move_addr_to_user (net/socket.c:306 (discriminator 1)) [ 492.898384][ T44] ? do_getsockname (net/socket.c:2119) [ 492.898501][ T44] __sys_sendmsg (net/socket.c:2678 (discriminator 1)) [ 492.898615][ T44] ? __sys_sendmsg_sock (net/socket.c:2663) [ 492.898792][ T44] ? __sys_getsockname (./include/linux/file.h:62 (discriminator 1) ./include/linux/file.h:83 (discriminator 1) net/socket.c:2144 (discriminator 1)) [ 492.898907][ T44] ? rcu_is_watching (./include/linux/context_tracking.h:128 (discriminator 1) kernel/rcu/tree.c:751 (discriminator 1)) [ 492.899019][ T44] do_syscall_64 (arch/x86/entry/syscall_64.c:63 (discriminator 1) arch/x86/entry/syscall_64.c:94 (discriminator 1)) [ 492.899133][ T44] entry_SYSCALL_64_after_hwframe (arch/x86/entry/entry_64.S:131) [ 492.899330][ T44] RIP: 0033:0x7f2470d1fc5e [ 492.899446][ T44] RSP: 002b:00007fff14c31cc0 EFLAGS: 00000202 ORIG_RAX: 000000000000002e [ 492.899617][ T44] RAX: ffffffffffffffda RBX: 0000000000000000 RCX: 00007f2470d1fc5e [ 492.899846][ T44] RDX: 0000000000000000 RSI: 00007fff14c31d80 RDI: 0000000000000004 [ 492.900014][ T44] RBP: 00007fff14c31cd0 R08: 0000000000000000 R09: 0000000000000000 [ 492.900185][ T44] R10: 0000000000000000 R11: 0000000000000202 R12: 00007fff14c3368d Finger prints: __schedule:schedule:schedule_preempt_disabled:__mutex_lock:napi_enable __schedule:schedule:schedule_preempt_disabled:__mutex_lock:addrconf_verify_work __schedule:schedule:schedule_preempt_disabled:__mutex_lock:xp_release_deferred ret_from_fork_asm:__schedule:schedule:schedule_preempt_disabled:__mutex_lock