Results for igt@gem_exec_fair@basic-pace@rcs0

Machine description: shard-tglu-9

Result: Fail

integration-manifest git-log-oneline i915_display_info15 igt_runner15 run15 runtimes15 results15.json i915_display_info_post_exec15 boot15 dmesg15

DetailValue
Duration 5.56 seconds
Hostname
shard-tglu-9
Igt-Version
IGT-Version: 1.29-NO-GIT (x86_64) (Linux: 6.12.0-rc1-CI_DRM_15475-g789d5631453c+ x86_64)
Out
Using IGT_SRANDOM=1727987235 for randomisation
Opened device: /dev/dri/card0
Running on tigerlake
Using Execlists submission
Has kernel scheduler
 - With priority sorting
 - With preemption enabled
 - With HW semaphores enabled
 - With engine busy statistics
 - With timeslicing enabled
CS timestamp frequency: 19200000
Starting subtest: basic-pace
Starting dynamic subtest: rcs0
Interval 16.77ms, range 0.01ms
  3 clients, range: [17.5, 17.6], iqr: [17.5, 17.6], median: 17.6 [0.2, 2.0], mean: 17.6 ± 0.03 ms, cpu: 11%
  7 clients, range: [14.5, 19.1], iqr: [14.5, 18.5], median: 16.4 [9.0, 11.0], mean: 16.4 ± 1.68 ms, cpu: 25%
 15 clients, range: [2.9, 30.4], iqr: [8.8, 28.3], median: 23.6 [13.4, 28.9], mean: 19.0 ± 9.71 ms, cpu: 29%
 31 clients, range: [1.2, 17.5], iqr: [4.0, 5.5], median: 4.5 [28.3, 30.8], mean: 5.4 ± 3.48 ms, cpu: 60%
Stack trace:
  #0 ../lib/igt_core.c:2051 __igt_fail_assert()
  #1 ../tests/intel/gem_exec_fair.c:963 fairness()
  #2 ../tests/intel/gem_exec_fair.c:1423 __igt_unique____real_main1292()
  #3 ../tests/intel/gem_exec_fair.c:1292 main()
  #4 [__libc_init_first+0x8a]
  #5 [__libc_start_main+0x8b]
  #6 [_start+0x25]
Dynamic subtest rcs0: FAIL (5.564s)
Err
Starting subtest: basic-pace
Starting dynamic subtest: rcs0
(gem_exec_fair:1280) CRITICAL: Test assertion failure function fairness, file ../tests/intel/gem_exec_fair.c:958:
(gem_exec_fair:1280) CRITICAL: Failed assertion: iqr[nchild / 2] < result[nchild / 2]
(gem_exec_fair:1280) CRITICAL: Child frame IQR 30.72ms exceeded median threshold 4.45ms
Dynamic subtest rcs0 failed.
**** DEBUG ****
(gem_exec_fair:1280) DEBUG: Test requirement passed: has_ctx_timestamp(i915, cfg, e)
(gem_exec_fair:1280) DEBUG: Test requirement passed: gem_class_has_mutable_submission(i915, e->class)
(gem_exec_fair:1280) DEBUG: CPU usage: 4%
(gem_exec_fair:1280) INFO: Interval 16.77ms, range 0.01ms
(gem_exec_fair:1280) DEBUG: CPU usage: 11%
(gem_exec_fair:1280) INFO:   3 clients, range: [17.5, 17.6], iqr: [17.5, 17.6], median: 17.6 [0.2, 2.0], mean: 17.6 ± 0.03 ms, cpu: 11%
(gem_exec_fair:1280) DEBUG: CPU usage: 25%
(gem_exec_fair:1280) INFO:   7 clients, range: [14.5, 19.1], iqr: [14.5, 18.5], median: 16.4 [9.0, 11.0], mean: 16.4 ± 1.68 ms, cpu: 25%
(gem_exec_fair:1280) DEBUG: CPU usage: 29%
(gem_exec_fair:1280) INFO:  15 clients, range: [2.9, 30.4], iqr: [8.8, 28.3], median: 23.6 [13.4, 28.9], mean: 19.0 ± 9.71 ms, cpu: 29%
(gem_exec_fair:1280) DEBUG: CPU usage: 60%
(gem_exec_fair:1280) INFO:  31 clients, range: [1.2, 17.5], iqr: [4.0, 5.5], median: 4.5 [28.3, 30.8], mean: 5.4 ± 3.48 ms, cpu: 60%
(gem_exec_fair:1280) CRITICAL: Test assertion failure function fairness, file ../tests/intel/gem_exec_fair.c:958:
(gem_exec_fair:1280) CRITICAL: Failed assertion: iqr[nchild / 2] < result[nchild / 2]
(gem_exec_fair:1280) CRITICAL: Child frame IQR 30.72ms exceeded median threshold 4.45ms
(gem_exec_fair:1280) igt_core-INFO: Stack trace:
(gem_exec_fair:1280) igt_core-INFO:   #0 ../lib/igt_core.c:2051 __igt_fail_assert()
(gem_exec_fair:1280) igt_core-INFO:   #1 ../tests/intel/gem_exec_fair.c:963 fairness()
(gem_exec_fair:1280) igt_core-INFO:   #2 ../tests/intel/gem_exec_fair.c:1423 __igt_unique____real_main1292()
(gem_exec_fair:1280) igt_core-INFO:   #3 ../tests/intel/gem_exec_fair.c:1292 main()
(gem_exec_fair:1280) igt_core-INFO:   #4 [__libc_init_first+0x8a]
(gem_exec_fair:1280) igt_core-INFO:   #5 [__libc_start_main+0x8b]
(gem_exec_fair:1280) igt_core-INFO:   #6 [_start+0x25]
****  END  ****
Dynamic subtest rcs0: FAIL (5.564s)
Dmesg
<6> [190.202857] Console: switching to colour dummy device 80x25
<6> [190.203086] [IGT] gem_exec_fair: executing
<7> [190.205644] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [190.206130] i915 0000:00:02.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x000001dc [0x000001dc]
<7> [190.206308] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<7> [190.206800] i915 0000:00:02.0: [drm:i915_gem_open [i915]]
<6> [190.212364] [IGT] gem_exec_fair: starting subtest basic-pace
<6> [190.212610] [IGT] gem_exec_fair: starting dynamic subtest rcs0
<7> [191.132489] i915 0000:00:02.0: [drm:intel_tc_port_update_mode [i915]] Port G/TC#4: TC port mode reset (tbt-alt -> disconnected)
<7> [191.132496] i915 0000:00:02.0: [drm:intel_tc_port_update_mode [i915]] Port F/TC#3: TC port mode reset (tbt-alt -> disconnected)
<7> [191.132568] i915 0000:00:02.0: [drm:intel_tc_port_update_mode [i915]] Port E/TC#2: TC port mode reset (tbt-alt -> disconnected)
<7> [191.132573] i915 0000:00:02.0: [drm:intel_power_well_disable [i915]] disabling TC_cold_off
<7> [191.133094] i915 0000:00:02.0: [drm:__intel_display_power_put_domain [i915]] TC cold unblock succeeded
<7> [191.133494] i915 0000:00:02.0: [drm:intel_tc_port_update_mode [i915]] Port D/TC#1: TC port mode reset (legacy -> disconnected)
<6> [195.776804] [IGT] gem_exec_fair: finished subtest rcs0, FAIL
Created at 2024-10-03 20:47:42