igt@xe_exec_reset@long-spin-comp-reuse-many-preempt-threads on shard-bmg@xe-pw-164654v5 Test details

Detail	Value
Duration	12.05 seconds
Hostname	shard-bmg-2
Igt-Version	IGT-Version: 2.4-g3e5747e53 (x86_64) (Linux: 7.1.0-rc2-lgci-xe-xe-pw-164654v5-debug+ x86_64)
Out	Using IGT_SRANDOM=1778206274 for randomisation Opened device: /dev/dri/card0 Starting subtest: long-spin-comp-reuse-many-preempt-threads [thread:11541] Stack trace: [thread:11541] #0 ../lib/igt_core.c:2075 __igt_fail_assert() [thread:11541] #1 [xe_exec+0x48] [thread:11541] #2 ../lib/xe/xe_legacy.c:239 xe_legacy_test_mode() [thread:11541] #3 ../tests/intel/xe_exec_reset.c:787 thread() [thread:11541] #4 [pthread_condattr_setpshared+0x684] [thread:11541] #5 [__clone+0x24c] Subtest long-spin-comp-reuse-many-preempt-threads: FAIL (12.047s)
Err	Starting subtest: long-spin-comp-reuse-many-preempt-threads (xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: Test assertion failure function xe_exec, file ../lib/xe/xe_ioctl.c:652: (xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: Failed assertion: __xe_exec(fd, exec) == 0 (xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: error: -125 != 0 (xe_exec_reset:11534) igt_thread-CRITICAL: Failure in a thread! Subtest long-spin-comp-reuse-many-preempt-threads failed. ** DEBUG (xe_exec_reset:11534) [thread:11538] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20 (xe_exec_reset:11534) [thread:11540] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20 (xe_exec_reset:11534) [thread:11539] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20 (xe_exec_reset:11534) [thread:11535] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20 (xe_exec_reset:11534) [thread:11537] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20 (xe_exec_reset:11534) [thread:11541] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20 (xe_exec_reset:11534) [thread:11536] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20 (xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: Test assertion failure function xe_exec, file ../lib/xe/xe_ioctl.c:652: (xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: Failed assertion: __xe_exec(fd, exec) == 0 (xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: error: -125 != 0 (xe_exec_reset:11534) [thread:11541] igt_core-INFO: Stack trace: (xe_exec_reset:11534) [thread:11541] igt_core-INFO: #0 ../lib/igt_core.c:2075 __igt_fail_assert() (xe_exec_reset:11534) [thread:11541] igt_core-INFO: #1 [xe_exec+0x48] (xe_exec_reset:11534) [thread:11541] igt_core-INFO: #2 ../lib/xe/xe_legacy.c:239 xe_legacy_test_mode() (xe_exec_reset:11534) [thread:11541] igt_core-INFO: #3 ../tests/intel/xe_exec_reset.c:787 thread() (xe_exec_reset:11534) [thread:11541] igt_core-INFO: #4 [pthread_condattr_setpshared+0x684] (xe_exec_reset:11534) [thread:11541] igt_core-INFO: #5 [__clone+0x24c] (xe_exec_reset:11534) igt_thread-CRITICAL: Failure in a thread! END ** Subtest long-spin-comp-reuse-many-preempt-threads: FAIL (12.047s)
Dmesg	<6> [408.978953] Console: switching to colour dummy device 80x25 <6> [408.979254] [IGT] xe_exec_reset: executing <6> [408.989356] [IGT] xe_exec_reset: starting subtest long-spin-comp-reuse-many-preempt-threads <7> [410.556646] xe 0000:03:00.0: [drm:xe_hwmon_read [xe]] thermal data for group 0 val 0x32332f2f <7> [410.556803] xe 0000:03:00.0: [drm:xe_hwmon_read [xe]] thermal data for group 1 val 0x31313232 <7> [410.756387] xe 0000:03:00.0: [drm:intel_power_well_enable [xe]] enabling AUX_TC2 <7> [410.860371] xe 0000:03:00.0: [drm:intel_power_well_disable [xe]] disabling AUX_TC2 <7> [414.215072] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT1: Proceeding with manual engine snapshot <7> [414.216044] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=7, running_time_ms=2724, timeout_ms=5000, diff=0x02f86c0c <7> [414.216707] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT0: Proceeding with manual engine snapshot <7> [414.217484] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=12, running_time_ms=522, timeout_ms=5000, diff=0x0091eca7 <7> [414.218299] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT1: Proceeding with manual engine snapshot <7> [414.218415] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=5, running_time_ms=2724, timeout_ms=5000, diff=0x02f86a4b <7> [414.218638] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT1: Proceeding with manual engine snapshot <7> [414.218749] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=3, running_time_ms=2728, timeout_ms=5000, diff=0x02f9868b <7> [414.218979] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT1: Proceeding with manual engine snapshot <7> [414.219088] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=6, running_time_ms=234880, timeout_ms=5000, diff=0xffffffb1 <7> [414.219108] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT0: Proceeding with manual engine snapshot <7> [414.219207] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=11, running_time_ms=2199, timeout_ms=5000, diff=0x0265ceab <7> [414.219343] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT0: Proceeding with manual engine snapshot <5> [414.219442] xe 0000:03:00.0: [drm] Tile0: GT1: Timedout job: seqno=4294967169, lrc_seqno=4294967169, guc_id=6, flags=0x0 in xe_exec_reset [11534] <7> [414.219429] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=13, running_time_ms=2736, timeout_ms=5000, diff=0x02fb8941 <7> [414.219515] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=8, running_time_ms=2176, timeout_ms=5000, diff=0x025f5850 <7> [414.219606] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=10, running_time_ms=2735, timeout_ms=5000, diff=0x02fb56a5 <7> [414.219687] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=9, running_time_ms=565, timeout_ms=5000, diff=0x009e11fd <6> [414.397943] xe 0000:03:00.0: [drm] Xe device coredump has been created <6> [414.397966] xe 0000:03:00.0: [drm] Check your /sys/class/drm/card0/device/devcoredump/data <7> [414.398065] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=2, running_time_ms=2820, timeout_ms=5000, diff=0x03130f8c <7> [414.398201] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=1, running_time_ms=2825, timeout_ms=5000, diff=0x0314794a <7> [414.398310] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=4, running_time_ms=2915, timeout_ms=5000, diff=0x032dd7ca <7> [414.398414] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=0, running_time_ms=2822, timeout_ms=5000, diff=0x0313af4c <7> [414.621820] xe 0000:03:00.0: [drm:xe_exec_ioctl [xe]] Ioctl argument check failed at drivers/gpu/drm/xe/xe_exec.c:153: q->ops->reset_status(q) <7> [419.332454] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=9, running_time_ms=2291, timeout_ms=5000, diff=0x027f8787 <7> [419.332980] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=12, running_time_ms=2228, timeout_ms=5000, diff=0x026dc5a9 <6> [421.037562] [IGT] xe_exec_reset: finished subtest long-spin-comp-reuse-many-preempt-threads, FAIL <6> [421.039944] [IGT] xe_exec_reset: exiting, ret=98 <6> [421.042306] Console: switching to colour frame buffer device 240x67 <7> [421.060986] xe 0000:03:00.0: [drm:drm_client_dev_restore] fbdev: ret=0

Detail

Value

Duration

12.05 seconds

Hostname

shard-bmg-2

Igt-Version

IGT-Version: 2.4-g3e5747e53 (x86_64) (Linux: 7.1.0-rc2-lgci-xe-xe-pw-164654v5-debug+ x86_64)

Out

Using IGT_SRANDOM=1778206274 for randomisation
Opened device: /dev/dri/card0
Starting subtest: long-spin-comp-reuse-many-preempt-threads
[thread:11541] Stack trace:
[thread:11541]   #0 ../lib/igt_core.c:2075 __igt_fail_assert()
[thread:11541]   #1 [xe_exec+0x48]
[thread:11541]   #2 ../lib/xe/xe_legacy.c:239 xe_legacy_test_mode()
[thread:11541]   #3 ../tests/intel/xe_exec_reset.c:787 thread()
[thread:11541]   #4 [pthread_condattr_setpshared+0x684]
[thread:11541]   #5 [__clone+0x24c]
Subtest long-spin-comp-reuse-many-preempt-threads: FAIL (12.047s)

Err

Starting subtest: long-spin-comp-reuse-many-preempt-threads
(xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: Test assertion failure function xe_exec, file ../lib/xe/xe_ioctl.c:652:
(xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: Failed assertion: __xe_exec(fd, exec) == 0
(xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: error: -125 != 0
(xe_exec_reset:11534) igt_thread-CRITICAL: Failure in a thread!
Subtest long-spin-comp-reuse-many-preempt-threads failed.
**** DEBUG ****
(xe_exec_reset:11534) [thread:11538] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20
(xe_exec_reset:11534) [thread:11540] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20
(xe_exec_reset:11534) [thread:11539] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20
(xe_exec_reset:11534) [thread:11535] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20
(xe_exec_reset:11534) [thread:11537] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20
(xe_exec_reset:11534) [thread:11541] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20
(xe_exec_reset:11534) [thread:11536] xe/xe_legacy-DEBUG: Test requirement passed: intel_gen(intel_get_drm_devid(fd)) >= 20
(xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: Test assertion failure function xe_exec, file ../lib/xe/xe_ioctl.c:652:
(xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: Failed assertion: __xe_exec(fd, exec) == 0
(xe_exec_reset:11534) [thread:11541] xe/xe_ioctl-CRITICAL: error: -125 != 0
(xe_exec_reset:11534) [thread:11541] igt_core-INFO: Stack trace:
(xe_exec_reset:11534) [thread:11541] igt_core-INFO:   #0 ../lib/igt_core.c:2075 __igt_fail_assert()
(xe_exec_reset:11534) [thread:11541] igt_core-INFO:   #1 [xe_exec+0x48]
(xe_exec_reset:11534) [thread:11541] igt_core-INFO:   #2 ../lib/xe/xe_legacy.c:239 xe_legacy_test_mode()
(xe_exec_reset:11534) [thread:11541] igt_core-INFO:   #3 ../tests/intel/xe_exec_reset.c:787 thread()
(xe_exec_reset:11534) [thread:11541] igt_core-INFO:   #4 [pthread_condattr_setpshared+0x684]
(xe_exec_reset:11534) [thread:11541] igt_core-INFO:   #5 [__clone+0x24c]
(xe_exec_reset:11534) igt_thread-CRITICAL: Failure in a thread!
****  END  ****
Subtest long-spin-comp-reuse-many-preempt-threads: FAIL (12.047s)

Dmesg

<6> [408.978953] Console: switching to colour dummy device 80x25

<6> [408.979254] [IGT] xe_exec_reset: executing

<6> [408.989356] [IGT] xe_exec_reset: starting subtest long-spin-comp-reuse-many-preempt-threads

<7> [410.556646] xe 0000:03:00.0: [drm:xe_hwmon_read [xe]] thermal data for group 0 val 0x32332f2f

<7> [410.556803] xe 0000:03:00.0: [drm:xe_hwmon_read [xe]] thermal data for group 1 val 0x31313232

<7> [410.756387] xe 0000:03:00.0: [drm:intel_power_well_enable [xe]] enabling AUX_TC2

<7> [410.860371] xe 0000:03:00.0: [drm:intel_power_well_disable [xe]] disabling AUX_TC2

<7> [414.215072] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT1: Proceeding with manual engine snapshot

<7> [414.216044] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=7, running_time_ms=2724, timeout_ms=5000, diff=0x02f86c0c

<7> [414.216707] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT0: Proceeding with manual engine snapshot

<7> [414.217484] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=12, running_time_ms=522, timeout_ms=5000, diff=0x0091eca7

<7> [414.218299] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT1: Proceeding with manual engine snapshot

<7> [414.218415] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=5, running_time_ms=2724, timeout_ms=5000, diff=0x02f86a4b

<7> [414.218638] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT1: Proceeding with manual engine snapshot

<7> [414.218749] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=3, running_time_ms=2728, timeout_ms=5000, diff=0x02f9868b

<7> [414.218979] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT1: Proceeding with manual engine snapshot

<7> [414.219088] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=6, running_time_ms=234880, timeout_ms=5000, diff=0xffffffb1

<7> [414.219108] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT0: Proceeding with manual engine snapshot

<7> [414.219207] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=11, running_time_ms=2199, timeout_ms=5000, diff=0x0265ceab

<7> [414.219343] xe 0000:03:00.0: [drm:xe_hw_engine_snapshot_capture [xe]] Tile0: GT0: Proceeding with manual engine snapshot

<5> [414.219442] xe 0000:03:00.0: [drm] Tile0: GT1: Timedout job: seqno=4294967169, lrc_seqno=4294967169, guc_id=6, flags=0x0 in xe_exec_reset [11534]

<7> [414.219429] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=13, running_time_ms=2736, timeout_ms=5000, diff=0x02fb8941

<7> [414.219515] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=8, running_time_ms=2176, timeout_ms=5000, diff=0x025f5850

<7> [414.219606] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=10, running_time_ms=2735, timeout_ms=5000, diff=0x02fb56a5

<7> [414.219687] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=9, running_time_ms=565, timeout_ms=5000, diff=0x009e11fd

<6> [414.397943] xe 0000:03:00.0: [drm] Xe device coredump has been created

<6> [414.397966] xe 0000:03:00.0: [drm] Check your /sys/class/drm/card0/device/devcoredump/data

<7> [414.398065] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=2, running_time_ms=2820, timeout_ms=5000, diff=0x03130f8c

<7> [414.398201] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=1, running_time_ms=2825, timeout_ms=5000, diff=0x0314794a

<7> [414.398310] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=4, running_time_ms=2915, timeout_ms=5000, diff=0x032dd7ca

<7> [414.398414] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT1: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=0, running_time_ms=2822, timeout_ms=5000, diff=0x0313af4c

<7> [414.621820] xe 0000:03:00.0: [drm:xe_exec_ioctl [xe]] Ioctl argument check failed at drivers/gpu/drm/xe/xe_exec.c:153: q->ops->reset_status(q)

<7> [419.332454] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=9, running_time_ms=2291, timeout_ms=5000, diff=0x027f8787

<7> [419.332980] xe 0000:03:00.0: [drm:guc_exec_queue_timedout_job [xe]] Tile0: GT0: Check job timeout: seqno=4294967169, lrc_seqno=4294967169, guc_id=12, running_time_ms=2228, timeout_ms=5000, diff=0x026dc5a9

<6> [421.037562] [IGT] xe_exec_reset: finished subtest long-spin-comp-reuse-many-preempt-threads, FAIL

<6> [421.039944] [IGT] xe_exec_reset: exiting, ret=98

<6> [421.042306] Console: switching to colour frame buffer device 240x67

<7> [421.060986] xe 0000:03:00.0: [drm:drm_client_dev_restore] fbdev: ret=0

Results for igt@xe_exec_reset@long-spin-comp-reuse-many-preempt-threads