Results for igt@gem_busy@close-race

Result: Abort

integration-manifest git-log-oneline i915_display_info17 igt_runner17 runtimes17 results17.json guc_logs17.tar i915_display_info_post_exec17 boot17 dmesg17

DetailValue
Duration unknown
Hostname 
shard-tglu-3
Igt-Version 
IGT-Version: 2.3-g33f5420a2 (x86_64) (Linux: 7.0.0-rc4-CI_DRM_18158-g59dc99dde24b+ x86_64)
Out 
Using IGT_SRANDOM=1773743015 for randomisation
Opened device: /dev/dri/card0
Starting subtest: close-race
Opened device: /dev/dri/card1
runner: This test was killed due to a kernel taint (0x4244).

This test caused an abort condition: Child refuses to die, tainted 0x4244.
Err 
Starting subtest: close-race
Received signal SIGQUIT.
Stack trace: 
Received signal SIGQUIT.
Stack trace: 
 #0 [fa t#a0l_ s[igf_ahatnadll_esirg+_h0anxd1le7rb+]0
x17b]
 #1  #[1_ _[s_i_gsaicgtaicotni+o0nx+500]x
50]
 #2 [wait4+0 x#521 ][
poll+0x4d]
 #3 [__igt_waitc h#i3l d[reing+t0_xf5o7r]k
_hang_detector+0x138]
 #4 [igt_wait c#h4i l[d_r_eing+t0_x2udn]i
que____real_main472+0x #155 8[d_]_
igt_u n#iq5ue __[__mraeail_nma+in04x722+0dx1]d0
1]
 #6 [main+0x2d]
 #7 [__libc_init_first+0x8a]
 #6 [__libc_init_first+0x8a]
 #8 [__libc_start_main+0x8b]
 #9 [_start+0x25]
 #7 [__libc_start_main+0x8b]
 #8 [_start+0x25]
Dmesg
<6> [266.254463] Console: switching to colour dummy device 80x25
<6> [266.255215] [IGT] gem_busy: executing
<7> [266.257766] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [266.258456] i915 0000:00:02.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x000001dc [0x000001dc]
<7> [266.259025] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [266.259684] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<6> [266.270694] [IGT] gem_busy: starting subtest close-race
<7> [266.272650] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [266.283264] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [266.297099] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [266.305653] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [266.317408] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [266.323573] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [266.324072] i915 0000:00:02.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x00000070 [0x00000070]
<7> [266.409375] i915 0000:00:02.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x00000070 [0x00000070]
<7> [267.002643] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling TC_cold_off
<7> [267.002633] i915 0000:00:02.0: [drm:intel_tc_port_reset_mode [i915]] Port F/TC#3: TC port mode reset (tbt-alt -> disconnected) pin assignment: - max lanes: 4
<7> [267.002629] i915 0000:00:02.0: [drm:intel_tc_port_reset_mode [i915]] Port G/TC#4: TC port mode reset (tbt-alt -> disconnected) pin assignment: - max lanes: 4
<7> [267.002640] i915 0000:00:02.0: [drm:intel_tc_port_reset_mode [i915]] Port E/TC#2: TC port mode reset (tbt-alt -> disconnected) pin assignment: - max lanes: 4
<7> [267.002960] i915 0000:00:02.0: [drm:tgl_tc_cold_request [i915]] TC cold unblock succeeded
<7> [267.003225] i915 0000:00:02.0: [drm:intel_tc_port_reset_mode [i915]] Port D/TC#1: TC port mode reset (legacy -> disconnected) pin assignment: - max lanes: 4
<3> [352.983619] rcu: INFO: rcu_preempt detected stalls on CPUs/tasks:
<3> [352.983640] rcu: Tasks blocked on level-0 rcu_node (CPUs 0-7): P2208
<3> [352.983807] rcu: (detected by 7, t=65002 jiffies, g=180861, q=26015 ncpus=8)
<6> [352.983816] task:gem_busy state:R running task stack:0 pid:2208 tgid:2208 ppid:2202 task_flags:0x400040 flags:0x00080800
<6> [352.983822] Call Trace:
<6> [352.983823] <TASK>
<6> [352.983826] __schedule+0x12db/0x1dd0
<6> [352.983833] ? sysvec_apic_timer_interrupt+0x57/0xc0
<6> [352.983836] ? sysvec_apic_timer_interrupt+0x57/0xc0
<6> [352.983840] ? irqentry_exit+0x6a/0x780
<6> [352.983843] ? sysvec_apic_timer_interrupt+0x57/0xc0
<6> [352.983845] ? trace_hardirqs_on+0x22/0x100
<6> [352.983850] ? sysvec_apic_timer_interrupt+0x57/0xc0
<6> [352.983854] irqentry_exit+0x6a/0x780
<6> [352.983856] ? sysvec_apic_timer_interrupt+0x57/0xc0
<6> [352.983859] ? trace_hardirqs_on+0x22/0x100
<6> [352.983863] ? irqentry_exit+0x6a/0x780
<6> [352.983865] ? trace_hardirqs_off_finish+0xe1/0x100
<6> [352.983870] ? sysvec_apic_timer_interrupt+0x57/0xc0
<6> [352.983873] ? asm_sysvec_apic_timer_interrupt+0x1b/0x20
<6> [352.983878] ? lock_is_held_type+0xa3/0x130
<6> [352.983883] ? rcu_read_lock_held+0x2e/0x60
<6> [352.983887] ? dma_resv_list_entry+0x71/0xd0
<6> [352.983892] ? dma_resv_iter_walk_unlocked.part.0+0x179/0x1d0
<6> [352.983896] ? dma_resv_iter_first_unlocked+0x69/0x290
<6> [352.983900] ? i915_gem_busy_ioctl+0xb8/0xb80 [i915]
<6> [352.984071] ? __pfx_i915_gem_busy_ioctl+0x10/0x10 [i915]
<6> [352.984206] ? drm_ioctl_kernel+0xb3/0x120
<6> [352.984213] ? drm_ioctl+0x2d4/0x5a0
<6> [352.984216] ? __pfx_i915_gem_busy_ioctl+0x10/0x10 [i915]
<6> [352.984348] ? find_held_lock+0x31/0x90
<6> [352.984357] ? __x64_sys_ioctl+0xa5/0x100
<6> [352.984364] ? x64_sys_call+0x1250/0x26e0
<6> [352.984368] ? do_syscall_64+0xdd/0x1470
<6> [352.984371] ? __might_fault+0x89/0xb0
<6> [352.984375] ? __might_fault+0x53/0xb0
<6> [352.984378] ? _copy_to_user+0x23/0x70
<6> [352.984382] ? drm_ioctl+0x30f/0x5a0
<6> [352.984385] ? __pfx_i915_gem_busy_ioctl+0x10/0x10 [i915]
<6> [352.984523] ? __x64_sys_ioctl+0xa5/0x100
<6> [352.984527] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [352.984532] ? do_syscall_64+0x22e/0x1470
<6> [352.984535] ? do_syscall_64+0x22e/0x1470
<6> [352.984541] ? __x64_sys_ioctl+0xa5/0x100
<6> [352.984544] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [352.984548] ? do_syscall_64+0x22e/0x1470
<6> [352.984551] ? __x64_sys_ioctl+0xa5/0x100
<6> [352.984554] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [352.984560] ? do_syscall_64+0x22e/0x1470
<6> [352.984564] ? __x64_sys_ioctl+0xa5/0x100
<6> [352.984568] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [352.984572] ? do_syscall_64+0x22e/0x1470
<6> [352.984574] ? do_syscall_64+0x22e/0x1470
<6> [352.984577] ? do_syscall_64+0x22e/0x1470
<6> [352.984579] ? clear_bhb_loop+0x30/0x80
<6> [352.984584] ? entry_SYSCALL_64_after_hwframe+0x76/0x7e
<6> [352.984592] </TASK>
<3> [431.034764] INFO: task systemd:1 blocked for more than 61 seconds.
<3> [431.034821] Tainted: G S U W L 7.0.0-rc4-CI_DRM_18158-g59dc99dde24b+ #1
<3> [431.034832] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
<6> [431.034842] task:systemd state:D stack:0 pid:1 tgid:1 ppid:0 task_flags:0x400100 flags:0x00080000
<6> [431.034846] Call Trace:
<6> [431.034848] <TASK>
<6> [431.034852] __schedule+0x5bc/0x1dd0
<6> [431.034857] ? lock_acquire+0xc4/0x2f0
<6> [431.034864] ? schedule+0x10e/0x180
<6> [431.034867] ? lock_release+0xd0/0x2b0
<6> [431.034872] schedule+0x3a/0x180
<6> [431.034876] schedule_timeout+0x117/0x130
<6> [431.034878] ? __wait_for_common+0xb4/0x1f0
<6> [431.034882] ? _raw_spin_unlock_irq+0x27/0x70
<6> [431.034885] ? __wait_for_common+0xb4/0x1f0
<6> [431.034888] ? trace_hardirqs_on+0x22/0x100
<6> [431.034895] __wait_for_common+0xc0/0x1f0
<6> [431.034898] ? __pfx_schedule_timeout+0x10/0x10
<6> [431.034903] ? cgroup_procs_write_start+0x5e/0x3f0
<6> [431.034906] wait_for_completion+0x24/0x40
<6> [431.034910] synchronize_rcu_normal+0xc1/0xf0
<6> [431.034919] synchronize_rcu+0x1c4/0x1d0
<6> [431.034923] rcu_sync_enter+0x58/0x110
<6> [431.034929] percpu_down_write+0x56/0x2f0
<6> [431.034931] ? cgroup_procs_write_start+0x233/0x3f0
<6> [431.034934] ? cgroup_procs_write_start+0x5e/0x3f0
<6> [431.034938] ? cgroup_procs_write_start+0x5e/0x3f0
<6> [431.034940] cgroup_procs_write_start+0x233/0x3f0
<6> [431.034943] ? mutex_lock_nested+0x1b/0x30
<6> [431.034947] __cgroup_procs_write+0x5c/0x2e0
<6> [431.034953] cgroup_procs_write+0x17/0x30
<6> [431.034956] cgroup_file_write+0xa6/0x2c0
<6> [431.034959] ? lock_is_held_type+0xa3/0x130
<6> [431.034965] kernfs_fop_write_iter+0x188/0x240
<6> [431.034971] vfs_write+0x283/0x540
<6> [431.034978] ksys_write+0x6f/0xf0
<6> [431.034982] __x64_sys_write+0x19/0x30
<6> [431.034985] x64_sys_call+0x259/0x26e0
<6> [431.034989] do_syscall_64+0xdd/0x1470
<6> [431.034993] ? find_held_lock+0x31/0x90
<6> [431.034996] ? free_to_partial_list+0x46d/0x640
<6> [431.035000] ? lock_release+0xd0/0x2b0
<6> [431.035003] ? _raw_spin_unlock_irqrestore+0x51/0x80
<6> [431.035006] ? free_to_partial_list+0x46d/0x640
<6> [431.035009] ? trace_hardirqs_on+0x22/0x100
<6> [431.035013] ? _raw_spin_unlock_irqrestore+0x51/0x80
<6> [431.035016] ? free_to_partial_list+0x46d/0x640
<6> [431.035019] ? putname+0x41/0x90
<6> [431.035024] ? __slab_free+0x129/0x2b0
<6> [431.035028] ? __pcs_replace_full_main+0x2ad/0x710
<6> [431.035033] ? putname+0x41/0x90
<6> [431.035035] ? kmem_cache_free+0x165/0x510
<6> [431.035042] ? __x64_sys_fcntl+0x97/0x130
<6> [431.035046] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [431.035050] ? do_syscall_64+0x22e/0x1470
<6> [431.035053] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [431.035057] ? do_syscall_64+0x22e/0x1470
<6> [431.035059] ? __x64_sys_rt_sigprocmask+0x75/0xe0
<6> [431.035063] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [431.035067] ? do_syscall_64+0x22e/0x1470
<6> [431.035069] ? clear_bhb_loop+0x30/0x80
<6> [431.035075] entry_SYSCALL_64_after_hwframe+0x76/0x7e
<6> [431.035077] RIP: 0033:0x749aea91c5a4
<6> [431.035080] RSP: 002b:00007ffda38367d8 EFLAGS: 00000202 ORIG_RAX: 0000000000000001
<6> [431.035083] RAX: ffffffffffffffda RBX: 0000000000000005 RCX: 0000749aea91c5a4
<6> [431.035085] RDX: 0000000000000005 RSI: 00007ffda38369aa RDI: 0000000000000043
<6> [431.035086] RBP: 00007ffda3836800 R08: 0000749aeaa02228 R09: 0000000000000000
<6> [431.035088] R10: 0000000000000000 R11: 0000000000000202 R12: 0000000000000005
<6> [431.035089] R13: 00007ffda38369aa R14: 000058afd4711ee0 R15: 0000000000000005
<6> [431.035097] </TASK>
<3> [431.035122] INFO: task (wnloader):2216 blocked for more than 61 seconds.
<3> [431.035131] Tainted: G S U W L 7.0.0-rc4-CI_DRM_18158-g59dc99dde24b+ #1
<3> [431.035141] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
<6> [431.035151] task:(wnloader) state:D stack:0 pid:2216 tgid:2216 ppid:1 task_flags:0x400100 flags:0x00080000
<6> [431.035154] Call Trace:
<6> [431.035155] <TASK>
<6> [431.035158] __schedule+0x5bc/0x1dd0
<6> [431.035161] ? lock_acquire+0xc4/0x2f0
<6> [431.035166] ? schedule+0x10e/0x180
<6> [431.035169] ? lock_release+0xd0/0x2b0
<6> [431.035175] schedule+0x3a/0x180
<6> [431.035178] schedule_preempt_disabled+0x15/0x30
<6> [431.035181] __mutex_lock+0x738/0x10e0
<6> [431.035185] ? cgroup_kn_lock_live+0x4f/0x250
<6> [431.035192] mutex_lock_nested+0x1b/0x30
<6> [431.035194] ? mutex_lock_nested+0x1b/0x30
<6> [431.035196] cgroup_kn_lock_live+0x4f/0x250
<6> [431.035201] __cgroup_procs_write+0x3d/0x2e0
<6> [431.035204] ? kernfs_root+0x80/0x1b0
<6> [431.035209] cgroup_procs_write+0x17/0x30
<6> [431.035212] cgroup_file_write+0xa6/0x2c0
<6> [431.035215] ? lock_is_held_type+0xa3/0x130
<6> [431.035219] kernfs_fop_write_iter+0x188/0x240
<6> [431.035224] vfs_write+0x283/0x540
<6> [431.035231] ksys_write+0x6f/0xf0
<6> [431.035235] __x64_sys_write+0x19/0x30
<6> [431.035237] x64_sys_call+0x259/0x26e0
<6> [431.035241] do_syscall_64+0xdd/0x1470
<6> [431.035245] ? find_held_lock+0x31/0x90
<6> [431.035247] ? exc_page_fault+0x96/0x2c0
<6> [431.035251] ? lock_release+0xd0/0x2b0
<6> [431.035256] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [431.035260] ? irqentry_exit+0x17d/0x780
<6> [431.035265] ? clear_bhb_loop+0x30/0x80
<6> [431.035269] entry_SYSCALL_64_after_hwframe+0x76/0x7e
<6> [431.035271] RIP: 0033:0x71de85f1c5a4
<6> [431.035273] RSP: 002b:00007fffe59c5fb8 EFLAGS: 00000202 ORIG_RAX: 0000000000000001
<6> [431.035275] RAX: ffffffffffffffda RBX: 0000000000000005 RCX: 000071de85f1c5a4
<6> [431.035277] RDX: 0000000000000005 RSI: 00007fffe59c618a RDI: 0000000000000003
<6> [431.035278] RBP: 00007fffe59c5fe0 R08: 000071de86002228 R09: 0000000000000000
<6> [431.035279] R10: 0000000000000000 R11: 0000000000000202 R12: 0000000000000005
<6> [431.035281] R13: 00007fffe59c618a R14: 000057726a6462d0 R15: 0000000000000005
<6> [431.035288] </TASK>
<3> [431.035290] INFO: task (wnloader):2216 is blocked on a mutex likely owned by task systemd:1.
<4> [431.035300]
Showing all locks held in the system:
<4> [431.035302] 5 locks held by systemd/1:
<4> [431.035304] #0: ffff88810a8f1420 (sb_writers#8){.+.+}-{0:0}, at: ksys_write+0x6f/0xf0
<4> [431.035312] #1: ffff88811690c488 (&of->mutex#2){+.+.}-{3:3}, at: kernfs_fop_write_iter+0x127/0x240
<4> [431.035319] #2: ffffffff8369b688 (cgroup_mutex){+.+.}-{3:3}, at: cgroup_kn_lock_live+0x4f/0x250
<4> [431.035326] #3: ffffffff834893d0 (cpu_hotplug_lock){++++}-{0:0}, at: cgroup_procs_write_start+0x227/0x3f0
<4> [431.035333] #4: ffffffff8369b450 (cgroup_threadgroup_rwsem){++++}-{0:0}, at: cgroup_procs_write_start+0x233/0x3f0
<4> [431.035345] 1 lock held by khungtaskd/69:
<4> [431.035347] #0: ffffffff835c5be0 (rcu_read_lock){....}-{1:2}, at: debug_show_all_locks+0x37/0x220
<4> [431.035363] 1 lock held by in:imklog/719:
<4> [431.035365] #0: ffff88811c541538 (&f->f_pos_lock){+.+.}-{3:3}, at: fdget_pos+0x81/0xd0
<4> [431.035377] 1 lock held by dmesg/2051:
<4> [431.035378] #0: ffff88811bf540d0 (&user->lock){+.+.}-{3:3}, at: devkmsg_read+0x5a/0x210
<4> [431.035388] 2 locks held by gem_busy/2208:
<4> [431.035389] 3 locks held by (wnloader)/2216:
<4> [431.035390] #0: ffff88810a8f1420 (sb_writers#8){.+.+}-{0:0}, at: ksys_write+0x6f/0xf0
<4> [431.035397] #1: ffff88811690b288 (&of->mutex#2){+.+.}-{3:3}, at: kernfs_fop_write_iter+0x127/0x240
<4> [431.035404] #2: ffffffff8369b688 (cgroup_mutex){+.+.}-{3:3}, at: cgroup_kn_lock_live+0x4f/0x250
<4> [431.035411]
<4> [431.035413] =============================================
<3> [492.473726] INFO: task systemd:1 blocked for more than 122 seconds.
<3> [492.473740] Tainted: G S U W L 7.0.0-rc4-CI_DRM_18158-g59dc99dde24b+ #1
<3> [492.473751] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
<6> [492.473761] task:systemd state:D stack:0 pid:1 tgid:1 ppid:0 task_flags:0x400100 flags:0x00080000
<6> [492.473765] Call Trace:
<6> [492.473767] <TASK>
<6> [492.473770] __schedule+0x5bc/0x1dd0
<6> [492.473776] ? lock_acquire+0xc4/0x2f0
<6> [492.473782] ? schedule+0x10e/0x180
<6> [492.473786] ? lock_release+0xd0/0x2b0
<6> [492.473791] schedule+0x3a/0x180
<6> [492.473795] schedule_timeout+0x117/0x130
<6> [492.473798] ? __wait_for_common+0xb4/0x1f0
<6> [492.473801] ? _raw_spin_unlock_irq+0x27/0x70
<6> [492.473804] ? __wait_for_common+0xb4/0x1f0
<6> [492.473807] ? trace_hardirqs_on+0x22/0x100
<6> [492.473813] __wait_for_common+0xc0/0x1f0
<6> [492.473817] ? __pfx_schedule_timeout+0x10/0x10
<6> [492.473822] ? cgroup_procs_write_start+0x5e/0x3f0
<6> [492.473826] wait_for_completion+0x24/0x40
<6> [492.473830] synchronize_rcu_normal+0xc1/0xf0
<6> [492.473839] synchronize_rcu+0x1c4/0x1d0
<6> [492.473843] rcu_sync_enter+0x58/0x110
<6> [492.473850] percpu_down_write+0x56/0x2f0
<6> [492.473852] ? cgroup_procs_write_start+0x233/0x3f0
<6> [492.473855] ? cgroup_procs_write_start+0x5e/0x3f0
<6> [492.473858] ? cgroup_procs_write_start+0x5e/0x3f0
<6> [492.473861] cgroup_procs_write_start+0x233/0x3f0
<6> [492.473863] ? mutex_lock_nested+0x1b/0x30
<6> [492.473868] __cgroup_procs_write+0x5c/0x2e0
<6> [492.473874] cgroup_procs_write+0x17/0x30
<6> [492.473877] cgroup_file_write+0xa6/0x2c0
<6> [492.473880] ? lock_is_held_type+0xa3/0x130
<6> [492.473885] kernfs_fop_write_iter+0x188/0x240
<6> [492.473891] vfs_write+0x283/0x540
<6> [492.473899] ksys_write+0x6f/0xf0
<6> [492.473903] __x64_sys_write+0x19/0x30
<6> [492.473905] x64_sys_call+0x259/0x26e0
<6> [492.473909] do_syscall_64+0xdd/0x1470
<6> [492.473913] ? find_held_lock+0x31/0x90
<6> [492.473916] ? free_to_partial_list+0x46d/0x640
<6> [492.473920] ? lock_release+0xd0/0x2b0
<6> [492.473924] ? _raw_spin_unlock_irqrestore+0x51/0x80
<6> [492.473926] ? free_to_partial_list+0x46d/0x640
<6> [492.473929] ? trace_hardirqs_on+0x22/0x100
<6> [492.473933] ? _raw_spin_unlock_irqrestore+0x51/0x80
<6> [492.473936] ? free_to_partial_list+0x46d/0x640
<6> [492.473939] ? putname+0x41/0x90
<6> [492.473944] ? __slab_free+0x129/0x2b0
<6> [492.473949] ? __pcs_replace_full_main+0x2ad/0x710
<6> [492.473953] ? putname+0x41/0x90
<6> [492.473955] ? kmem_cache_free+0x165/0x510
<6> [492.473961] ? __x64_sys_fcntl+0x97/0x130
<6> [492.473966] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [492.473970] ? do_syscall_64+0x22e/0x1470
<6> [492.473972] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [492.473976] ? do_syscall_64+0x22e/0x1470
<6> [492.473979] ? __x64_sys_rt_sigprocmask+0x75/0xe0
<6> [492.473983] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [492.473987] ? do_syscall_64+0x22e/0x1470
<6> [492.473989] ? clear_bhb_loop+0x30/0x80
<6> [492.473994] entry_SYSCALL_64_after_hwframe+0x76/0x7e
<6> [492.473996] RIP: 0033:0x749aea91c5a4
<6> [492.473999] RSP: 002b:00007ffda38367d8 EFLAGS: 00000202 ORIG_RAX: 0000000000000001
<6> [492.474002] RAX: ffffffffffffffda RBX: 0000000000000005 RCX: 0000749aea91c5a4
<6> [492.474004] RDX: 0000000000000005 RSI: 00007ffda38369aa RDI: 0000000000000043
<6> [492.474005] RBP: 00007ffda3836800 R08: 0000749aeaa02228 R09: 0000000000000000
<6> [492.474007] R10: 0000000000000000 R11: 0000000000000202 R12: 0000000000000005
<6> [492.474009] R13: 00007ffda38369aa R14: 000058afd4711ee0 R15: 0000000000000005
<6> [492.474016] </TASK>
<3> [492.474044] INFO: task (wnloader):2216 blocked for more than 122 seconds.
<3> [492.474054] Tainted: G S U W L 7.0.0-rc4-CI_DRM_18158-g59dc99dde24b+ #1
<3> [492.474064] "echo 0 > /proc/sys/kernel/hung_task_timeout_secs" disables this message.
<6> [492.474073] task:(wnloader) state:D stack:0 pid:2216 tgid:2216 ppid:1 task_flags:0x400100 flags:0x00080000
<6> [492.474076] Call Trace:
<6> [492.474078] <TASK>
<6> [492.474081] __schedule+0x5bc/0x1dd0
<6> [492.474084] ? lock_acquire+0xc4/0x2f0
<6> [492.474088] ? schedule+0x10e/0x180
<6> [492.474092] ? lock_release+0xd0/0x2b0
<6> [492.474097] schedule+0x3a/0x180
<6> [492.474100] schedule_preempt_disabled+0x15/0x30
<6> [492.474103] __mutex_lock+0x738/0x10e0
<6> [492.474107] ? cgroup_kn_lock_live+0x4f/0x250
<6> [492.474114] mutex_lock_nested+0x1b/0x30
<6> [492.474116] ? mutex_lock_nested+0x1b/0x30
<6> [492.474118] cgroup_kn_lock_live+0x4f/0x250
<6> [492.474123] __cgroup_procs_write+0x3d/0x2e0
<6> [492.474126] ? kernfs_root+0x80/0x1b0
<6> [492.474131] cgroup_procs_write+0x17/0x30
<6> [492.474134] cgroup_file_write+0xa6/0x2c0
<6> [492.474137] ? lock_is_held_type+0xa3/0x130
<6> [492.474142] kernfs_fop_write_iter+0x188/0x240
<6> [492.474147] vfs_write+0x283/0x540
<6> [492.474154] ksys_write+0x6f/0xf0
<6> [492.474158] __x64_sys_write+0x19/0x30
<6> [492.474160] x64_sys_call+0x259/0x26e0
<6> [492.474163] do_syscall_64+0xdd/0x1470
<6> [492.474167] ? find_held_lock+0x31/0x90
<6> [492.474170] ? exc_page_fault+0x96/0x2c0
<6> [492.474174] ? lock_release+0xd0/0x2b0
<6> [492.474178] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [492.474182] ? irqentry_exit+0x17d/0x780
<6> [492.474187] ? clear_bhb_loop+0x30/0x80
<6> [492.474191] entry_SYSCALL_64_after_hwframe+0x76/0x7e
<6> [492.474193] RIP: 0033:0x71de85f1c5a4
<6> [492.474195] RSP: 002b:00007fffe59c5fb8 EFLAGS: 00000202 ORIG_RAX: 0000000000000001
<6> [492.474198] RAX: ffffffffffffffda RBX: 0000000000000005 RCX: 000071de85f1c5a4
<6> [492.474199] RDX: 0000000000000005 RSI: 00007fffe59c618a RDI: 0000000000000003
<6> [492.474200] RBP: 00007fffe59c5fe0 R08: 000071de86002228 R09: 0000000000000000
<6> [492.474202] R10: 0000000000000000 R11: 0000000000000202 R12: 0000000000000005
<6> [492.474203] R13: 00007fffe59c618a R14: 000057726a6462d0 R15: 0000000000000005
<6> [492.474211] </TASK>
<3> [492.474212] INFO: task (wnloader):2216 is blocked on a mutex likely owned by task systemd:1.
<4> [492.474223]
Showing all locks held in the system:
<4> [492.474225] 5 locks held by systemd/1:
<4> [492.474227] #0: ffff88810a8f1420 (sb_writers#8){.+.+}-{0:0}, at: ksys_write+0x6f/0xf0
<4> [492.474235] #1: ffff88811690c488 (&of->mutex#2){+.+.}-{3:3}, at: kernfs_fop_write_iter+0x127/0x240
<4> [492.474242] #2: ffffffff8369b688 (cgroup_mutex){+.+.}-{3:3}, at: cgroup_kn_lock_live+0x4f/0x250
<4> [492.474249] #3: ffffffff834893d0 (cpu_hotplug_lock){++++}-{0:0}, at: cgroup_procs_write_start+0x227/0x3f0
<4> [492.474256] #4: ffffffff8369b450 (cgroup_threadgroup_rwsem){++++}-{0:0}, at: cgroup_procs_write_start+0x233/0x3f0
<4> [492.474266] 1 lock held by khungtaskd/69:
<4> [492.474268] #0: ffffffff835c5be0 (rcu_read_lock){....}-{1:2}, at: debug_show_all_locks+0x37/0x220
<4> [492.474284] 1 lock held by in:imklog/719:
<4> [492.474285] #0: ffff88811c541538 (&f->f_pos_lock){+.+.}-{3:3}, at: fdget_pos+0x81/0xd0
<4> [492.474295] 1 lock held by dmesg/2051:
<4> [492.474297] #0: ffff88811bf540d0 (&user->lock){+.+.}-{3:3}, at: devkmsg_read+0x5a/0x210
<4> [492.474305] 2 locks held by gem_busy/2208:
<4> [492.474306] 3 locks held by (wnloader)/2216:
<4> [492.474308] #0: ffff88810a8f1420 (sb_writers#8){.+.+}-{0:0}, at: ksys_write+0x6f/0xf0
<4> [492.474314] #1: ffff88811690b288 (&of->mutex#2){+.+.}-{3:3}, at: kernfs_fop_write_iter+0x127/0x240
<4> [492.474322] #2: ffffffff8369b688 (cgroup_mutex){+.+.}-{3:3}, at: cgroup_kn_lock_live+0x4f/0x250
<4> [492.474328]
<4> [492.474329] =============================================
<3> [547.987667] rcu: INFO: rcu_preempt detected stalls on CPUs/tasks:
<3> [547.987689] rcu: Tasks blocked on level-0 rcu_node (CPUs 0-7): P2208
<3> [547.987701] rcu: (detected by 3, t=260008 jiffies, g=180861, q=83386 ncpus=8)
<6> [547.987712] task:gem_busy state:R running task stack:0 pid:2208 tgid:2208 ppid:2202 task_flags:0x400040 flags:0x00080802
<6> [547.987717] Call Trace:
<6> [547.987719] <TASK>
<6> [547.987722] __schedule+0x12db/0x1dd0
<6> [547.987728] ? raw_irqentry_exit_cond_resched+0x3e/0x50
<6> [547.987733] ? sysvec_apic_timer_interrupt+0x57/0xc0
<6> [547.987737] ? irqentry_exit+0x6a/0x780
<6> [547.987740] ? sysvec_apic_timer_interrupt+0x57/0xc0
<6> [547.987744] ? trace_hardirqs_on+0x22/0x100
<6> [547.987753] ? irqentry_exit+0x6a/0x780
<6> [547.987755] ? trace_hardirqs_off_finish+0xe1/0x100
<6> [547.987760] ? sysvec_apic_timer_interrupt+0x57/0xc0
<6> [547.987763] ? asm_sysvec_apic_timer_interrupt+0x1b/0x20
<6> [547.987771] ? lock_is_held_type+0x43/0x130
<6> [547.987775] ? lock_is_held_type+0xa3/0x130
<6> [547.987779] ? rcu_read_lock_held+0x43/0x60
<6> [547.987785] ? dma_resv_iter_walk_unlocked.part.0+0x170/0x1d0
<6> [547.987789] ? dma_resv_iter_first_unlocked+0x69/0x290
<6> [547.987793] ? i915_gem_busy_ioctl+0xb8/0xb80 [i915]
<6> [547.987962] ? __pfx_i915_gem_busy_ioctl+0x10/0x10 [i915]
<6> [547.988093] ? drm_ioctl_kernel+0xb3/0x120
<6> [547.988100] ? drm_ioctl+0x2d4/0x5a0
<6> [547.988103] ? __pfx_i915_gem_busy_ioctl+0x10/0x10 [i915]
<6> [547.988234] ? find_held_lock+0x31/0x90
<6> [547.988243] ? __x64_sys_ioctl+0xa5/0x100
<6> [547.988249] ? x64_sys_call+0x1250/0x26e0
<6> [547.988252] ? do_syscall_64+0xdd/0x1470
<6> [547.988256] ? __might_fault+0x89/0xb0
<6> [547.988259] ? __might_fault+0x53/0xb0
<6> [547.988262] ? _copy_to_user+0x23/0x70
<6> [547.988266] ? drm_ioctl+0x30f/0x5a0
<6> [547.988269] ? __pfx_i915_gem_busy_ioctl+0x10/0x10 [i915]
<6> [547.988404] ? __x64_sys_ioctl+0xa5/0x100
<6> [547.988407] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [547.988412] ? do_syscall_64+0x22e/0x1470
<6> [547.988415] ? do_syscall_64+0x22e/0x1470
<6> [547.988421] ? __x64_sys_ioctl+0xa5/0x100
<6> [547.988424] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [547.988428] ? do_syscall_64+0x22e/0x1470
<6> [547.988430] ? __x64_sys_ioctl+0xa5/0x100
<6> [547.988433] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [547.988437] ? do_syscall_64+0x22e/0x1470
<6> [547.988439] ? __x64_sys_ioctl+0xa5/0x100
<6> [547.988443] ? trace_hardirqs_on_prepare+0xe1/0x100
<6> [547.988446] ? do_syscall_64+0x22e/0x1470
<6> [547.988449] ? do_syscall_64+0x22e/0x1470
<6> [547.988451] ? do_syscall_64+0x22e/0x1470
<6> [547.988453] ? clear_bhb_loop+0x30/0x80
<6> [547.988458] ? entry_SYSCALL_64_after_hwframe+0x76/0x7e
<6> [547.988466] </TASK>
Created at 2026-03-17 11:39:24