Results for igt@perf_pmu@most-busy-idle-check-all

Result: Fail

git-log-oneline i915_display_info16 igt_runner16 runtimes16 results16.json results16-i915-load.json guc_logs16.tar i915_display_info_post_exec16 boot16 dmesg16

DetailValue
Duration 4.57 seconds
Hostname 
shard-dg2-6
Igt-Version 
IGT-Version: 2.3-ge6e7d2715 (x86_64) (Linux: 7.0.0-rc2-CI_DRM_18104-ga48305e6a2e6+ x86_64)
Out 
Using IGT_SRANDOM=1772894615 for randomisation
Opened device: /dev/dri/card0
Starting subtest: most-busy-idle-check-all
Starting dynamic subtest: rcs0
0=0
1=500461771
2=223646679636
3=223659137865
4=223640940626
5=223627723178
6=223676388699
Stack trace:
  #0 ../lib/igt_core.c:2075 __igt_fail_assert()
  #1 ../tests/intel/perf_pmu.c:630 most_busy_check_all()
  #2 ../tests/intel/perf_pmu.c:2378 __igt_unique____real_main2281()
  #3 ../tests/intel/perf_pmu.c:2281 main()
  #4 [__libc_init_first+0x8a]
  #5 [__libc_start_main+0x8b]
  #6 [_start+0x25]
Dynamic subtest rcs0: FAIL (0.679s)
Starting dynamic subtest: bcs0
0=0
1=0
2=0
3=0
4=0
5=0
6=0
Stack trace:
  #0 ../lib/igt_core.c:2075 __igt_fail_assert()
  #1 ../tests/intel/perf_pmu.c:630 most_busy_check_all()
  #2 ../tests/intel/perf_pmu.c:2378 __igt_unique____real_main2281()
  #3 ../tests/intel/perf_pmu.c:2281 main()
  #4 [__libc_init_first+0x8a]
  #5 [__libc_start_main+0x8b]
  #6 [_start+0x25]
Dynamic subtest bcs0: FAIL (0.623s)
Starting dynamic subtest: vcs0
0=500519427
1=500523387
2=0
3=500429219
4=500389531
5=500409323
6=500461250
Dynamic subtest vcs0: SUCCESS (0.655s)
Starting dynamic subtest: vcs1
0=500588490
1=500499948
2=500500313
3=0
4=500480990
5=500449220
6=500466979
Dynamic subtest vcs1: SUCCESS (0.651s)
Starting dynamic subtest: vecs0
0=500517553
1=500521928
2=500438178
3=500409219
4=0
5=500410677
6=500454532
Dynamic subtest vecs0: SUCCESS (0.654s)
Starting dynamic subtest: vecs1
0=500514324
1=500519375
2=500444219
3=500405677
4=500424479
5=0
6=500452709
Dynamic subtest vecs1: SUCCESS (0.654s)
Starting dynamic subtest: ccs0
0=500425834
1=500427291
2=500358750
3=500330417
4=500283907
5=500277709
6=0
Dynamic subtest ccs0: SUCCESS (0.652s)
Subtest most-busy-idle-check-all: FAIL (4.573s)
Opened device: /dev/dri/renderD128
Err 
Starting subtest: most-busy-idle-check-all
Starting dynamic subtest: rcs0
(perf_pmu:2136) CRITICAL: Test assertion failure function most_busy_check_all, file ../tests/intel/perf_pmu.c:627:
(perf_pmu:2136) CRITICAL: Failed assertion: (double)(val[i]) <= (1.0 + (tolerance)) * (double)(slept) && (double)(val[i]) >= (1.0 - (tolerance)) * (double)(slept)
(perf_pmu:2136) CRITICAL: 'val[i]' != 'slept' (223646679636.000000 not within +5.0%/-5.0% tolerance of 500350000.000000)

Dynamic subtest rcs0 failed.
**** DEBUG ****
(perf_pmu:2136) intel_allocator_reloc-DEBUG: Using reloc allocator
(perf_pmu:2136) igt_dummyload-DEBUG: Test requirement passed: nengine
(perf_pmu:2136) DEBUG: Test requirement passed: spin
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) INFO: 0=0
1=500461771
2=223646679636
3=223659137865
4=223640940626
5=223627723178
6=223676388699
(perf_pmu:2136) CRITICAL: Test assertion failure function most_busy_check_all, file ../tests/intel/perf_pmu.c:627:
(perf_pmu:2136) CRITICAL: Failed assertion: (double)(val[i]) <= (1.0 + (tolerance)) * (double)(slept) && (double)(val[i]) >= (1.0 - (tolerance)) * (double)(slept)
(perf_pmu:2136) CRITICAL: 'val[i]' != 'slept' (223646679636.000000 not within +5.0%/-5.0% tolerance of 500350000.000000)

(perf_pmu:2136) igt_core-INFO: Stack trace:
(perf_pmu:2136) igt_core-INFO:   #0 ../lib/igt_core.c:2075 __igt_fail_assert()
(perf_pmu:2136) igt_core-INFO:   #1 ../tests/intel/perf_pmu.c:630 most_busy_check_all()
(perf_pmu:2136) igt_core-INFO:   #2 ../tests/intel/perf_pmu.c:2378 __igt_unique____real_main2281()
(perf_pmu:2136) igt_core-INFO:   #3 ../tests/intel/perf_pmu.c:2281 main()
(perf_pmu:2136) igt_core-INFO:   #4 [__libc_init_first+0x8a]
(perf_pmu:2136) igt_core-INFO:   #5 [__libc_start_main+0x8b]
(perf_pmu:2136) igt_core-INFO:   #6 [_start+0x25]
****  END  ****
Dynamic subtest rcs0: FAIL (0.679s)
Starting dynamic subtest: bcs0
(perf_pmu:2136) CRITICAL: Test assertion failure function most_busy_check_all, file ../tests/intel/perf_pmu.c:627:
(perf_pmu:2136) CRITICAL: Failed assertion: (double)(val[i]) <= (1.0 + (tolerance)) * (double)(slept) && (double)(val[i]) >= (1.0 - (tolerance)) * (double)(slept)
(perf_pmu:2136) CRITICAL: 'val[i]' != 'slept' (0.000000 not within +5.0%/-5.0% tolerance of 500349000.000000)

Dynamic subtest bcs0 failed.
**** DEBUG ****
(perf_pmu:2136) intel_allocator_reloc-DEBUG: Using reloc allocator
(perf_pmu:2136) igt_dummyload-DEBUG: Test requirement passed: nengine
(perf_pmu:2136) DEBUG: Test requirement passed: spin
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) DEBUG: Test requirement passed: !(fd < 0 && errno == ENODEV)
(perf_pmu:2136) INFO: 0=0
1=0
2=0
3=0
4=0
5=0
6=0
(perf_pmu:2136) CRITICAL: Test assertion failure function most_busy_check_all, file ../tests/intel/perf_pmu.c:627:
(perf_pmu:2136) CRITICAL: Failed assertion: (double)(val[i]) <= (1.0 + (tolerance)) * (double)(slept) && (double)(val[i]) >= (1.0 - (tolerance)) * (double)(slept)
(perf_pmu:2136) CRITICAL: 'val[i]' != 'slept' (0.000000 not within +5.0%/-5.0% tolerance of 500349000.000000)

(perf_pmu:2136) igt_core-INFO: Stack trace:
(perf_pmu:2136) igt_core-INFO:   #0 ../lib/igt_core.c:2075 __igt_fail_assert()
(perf_pmu:2136) igt_core-INFO:   #1 ../tests/intel/perf_pmu.c:630 most_busy_check_all()
(perf_pmu:2136) igt_core-INFO:   #2 ../tests/intel/perf_pmu.c:2378 __igt_unique____real_main2281()
(perf_pmu:2136) igt_core-INFO:   #3 ../tests/intel/perf_pmu.c:2281 main()
(perf_pmu:2136) igt_core-INFO:   #4 [__libc_init_first+0x8a]
(perf_pmu:2136) igt_core-INFO:   #5 [__libc_start_main+0x8b]
(perf_pmu:2136) igt_core-INFO:   #6 [_start+0x25]
****  END  ****
Dynamic subtest bcs0: FAIL (0.623s)
Starting dynamic subtest: vcs0
Dynamic subtest vcs0: SUCCESS (0.655s)
Starting dynamic subtest: vcs1
Dynamic subtest vcs1: SUCCESS (0.651s)
Starting dynamic subtest: vecs0
Dynamic subtest vecs0: SUCCESS (0.654s)
Starting dynamic subtest: vecs1
Dynamic subtest vecs1: SUCCESS (0.654s)
Starting dynamic subtest: ccs0
Dynamic subtest ccs0: SUCCESS (0.652s)
Subtest most-busy-idle-check-all: FAIL (4.573s)
Dmesg
<6> [125.710951] Console: switching to colour dummy device 80x25
<6> [125.711009] [IGT] perf_pmu: executing
<7> [125.724072] i915 0000:03:00.0: [drm:i915_gem_open [i915]]
<7> [125.725850] i915 0000:03:00.0: [drm:i915_gem_open [i915]]
<6> [125.733466] [IGT] perf_pmu: starting subtest most-busy-idle-check-all
<6> [125.733657] [IGT] perf_pmu: starting dynamic subtest rcs0
<7> [125.734095] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:509
<6> [126.413235] [IGT] perf_pmu: finished subtest rcs0, FAIL
<6> [126.413667] [IGT] perf_pmu: starting dynamic subtest bcs0
<7> [126.413918] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:509
<6> [127.036615] [IGT] perf_pmu: finished subtest bcs0, FAIL
<6> [127.036864] [IGT] perf_pmu: starting dynamic subtest vcs0
<7> [127.037217] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:509
<7> [127.650782] i915 0000:03:00.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x0000005c [0x0000005c]
<6> [127.692573] [IGT] perf_pmu: finished subtest vcs0, SUCCESS
<6> [127.693488] [IGT] perf_pmu: starting dynamic subtest vcs1
<7> [127.694186] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:509
<7> [128.305559] i915 0000:03:00.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x0000005c [0x0000005c]
<6> [128.344899] [IGT] perf_pmu: finished subtest vcs1, SUCCESS
<6> [128.345077] [IGT] perf_pmu: starting dynamic subtest vecs0
<7> [128.345354] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:509
<7> [128.958515] i915 0000:03:00.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x0000005c [0x0000005c]
<6> [128.999093] [IGT] perf_pmu: finished subtest vecs0, SUCCESS
<6> [128.999289] [IGT] perf_pmu: starting dynamic subtest vecs1
<7> [128.999463] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:509
<7> [129.611140] i915 0000:03:00.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x0000005c [0x0000005c]
<6> [129.653436] [IGT] perf_pmu: finished subtest vecs1, SUCCESS
<6> [129.653610] [IGT] perf_pmu: starting dynamic subtest ccs0
<7> [129.653813] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:509
<7> [130.264321] i915 0000:03:00.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x0000005c [0x0000005c]
<6> [130.305886] [IGT] perf_pmu: finished subtest ccs0, SUCCESS
<6> [130.306839] [IGT] perf_pmu: finished subtest most-busy-idle-check-all, FAIL
<7> [130.351895] i915 0000:03:00.0: [drm:i915_gem_open [i915]]
<7> [130.354594] i915 0000:03:00.0: [drm:i915_gem_open [i915]]
<7> [130.358682] i915 0000:03:00.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x0000005c [0x0000005c]
<7> [130.390501] i915 0000:03:00.0: [drm:drm_client_dev_restore] fbdev: ret=0
<6> [130.390607] [IGT] perf_pmu: exiting, ret=98
<6> [130.407204] Console: switching to colour frame buffer device 240x67
Created at 2026-03-07 15:36:43