Results for igt@sysfs_heartbeat_interval@precise@vcs0

Result: Fail

integration-manifest git-log-oneline i915_display_info4 igt_runner4 runtimes4 results4.json results4-i915-load.json i915_display_info_post_exec4 boot4 dmesg4

DetailValue
Duration 0.54 seconds
Hostname 
shard-rkl-4
Igt-Version 
IGT-Version: 2.0-g68588b3c8 (x86_64) (Linux: 6.16.0-rc3-CI_DRM_16754-ge4196e8184ee+ x86_64)
Out 
Starting dynamic subtest: vcs0
heartbeat_interval_ms:1, elapsed=14.868ms[14]
heartbeat_interval_ms:50, elapsed=416.277ms[416]
Stack trace:
  #0 ../lib/igt_core.c:2075 __igt_fail_assert()
  #1 ../tests/intel/sysfs_heartbeat_interval.c:241 test_precise()
  #2 ../lib/i915/gem_engine_topology.c:714 dyn_sysfs_engines()
  #3 ../tests/intel/sysfs_heartbeat_interval.c:525 __igt_unique____real_main490()
  #4 ../tests/intel/sysfs_heartbeat_interval.c:490 main()
  #5 [__libc_init_first+0x8a]
  #6 [__libc_start_main+0x8b]
  #7 [_start+0x25]
Dynamic subtest vcs0: FAIL (0.536s)
Err 
Starting dynamic subtest: vcs0
(sysfs_heartbeat_interval:2144) CRITICAL: Test assertion failure function test_precise, file ../tests/intel/sysfs_heartbeat_interval.c:259:
(sysfs_heartbeat_interval:2144) CRITICAL: Failed assertion: elapsed / 1000 / 1000 < 3 * delays[i] + 150
(sysfs_heartbeat_interval:2144) CRITICAL: Heartbeat interval (and CPR) exceeded request!
Dynamic subtest vcs0 failed.
**** DEBUG ****
(sysfs_heartbeat_interval:2144) i915/gem_engine_topology-DEBUG: Test requirement passed: fstatat(engine, file, &st, 0) == 0
(sysfs_heartbeat_interval:2144) DEBUG: set preempt_timeout_ms:1
(sysfs_heartbeat_interval:2144) DEBUG: Test requirement passed: igt_sysfs_printf(engine, attr, "%u", value) > 0
(sysfs_heartbeat_interval:2144) DEBUG: Initial heartbeat_interval_ms:2500
(sysfs_heartbeat_interval:2144) DEBUG: set heartbeat_interval_ms:1
(sysfs_heartbeat_interval:2144) DEBUG: Test requirement passed: igt_sysfs_printf(engine, attr, "%u", value) > 0
(sysfs_heartbeat_interval:2144) intel_allocator_reloc-DEBUG: Using reloc allocator
(sysfs_heartbeat_interval:2144) igt_dummyload-DEBUG: Test requirement passed: gem_class_can_store_dword(fd, class)
(sysfs_heartbeat_interval:2144) igt_dummyload-DEBUG: Test requirement passed: nengine
(sysfs_heartbeat_interval:2144) intel_allocator_reloc-DEBUG: Using reloc allocator
(sysfs_heartbeat_interval:2144) igt_dummyload-DEBUG: Test requirement passed: gem_class_can_store_dword(fd, class)
(sysfs_heartbeat_interval:2144) igt_dummyload-DEBUG: Test requirement passed: nengine
(sysfs_heartbeat_interval:2144) INFO: heartbeat_interval_ms:1, elapsed=14.868ms[14]
(sysfs_heartbeat_interval:2144) DEBUG: set heartbeat_interval_ms:50
(sysfs_heartbeat_interval:2144) DEBUG: Test requirement passed: igt_sysfs_printf(engine, attr, "%u", value) > 0
(sysfs_heartbeat_interval:2144) intel_allocator_reloc-DEBUG: Using reloc allocator
(sysfs_heartbeat_interval:2144) igt_dummyload-DEBUG: Test requirement passed: gem_class_can_store_dword(fd, class)
(sysfs_heartbeat_interval:2144) igt_dummyload-DEBUG: Test requirement passed: nengine
(sysfs_heartbeat_interval:2144) intel_allocator_reloc-DEBUG: Using reloc allocator
(sysfs_heartbeat_interval:2144) igt_dummyload-DEBUG: Test requirement passed: gem_class_can_store_dword(fd, class)
(sysfs_heartbeat_interval:2144) igt_dummyload-DEBUG: Test requirement passed: nengine
(sysfs_heartbeat_interval:2144) INFO: heartbeat_interval_ms:50, elapsed=416.277ms[416]
(sysfs_heartbeat_interval:2144) CRITICAL: Test assertion failure function test_precise, file ../tests/intel/sysfs_heartbeat_interval.c:259:
(sysfs_heartbeat_interval:2144) CRITICAL: Failed assertion: elapsed / 1000 / 1000 < 3 * delays[i] + 150
(sysfs_heartbeat_interval:2144) CRITICAL: Heartbeat interval (and CPR) exceeded request!
(sysfs_heartbeat_interval:2144) igt_core-INFO: Stack trace:
(sysfs_heartbeat_interval:2144) igt_core-INFO:   #0 ../lib/igt_core.c:2075 __igt_fail_assert()
(sysfs_heartbeat_interval:2144) igt_core-INFO:   #1 ../tests/intel/sysfs_heartbeat_interval.c:241 test_precise()
(sysfs_heartbeat_interval:2144) igt_core-INFO:   #2 ../lib/i915/gem_engine_topology.c:714 dyn_sysfs_engines()
(sysfs_heartbeat_interval:2144) igt_core-INFO:   #3 ../tests/intel/sysfs_heartbeat_interval.c:525 __igt_unique____real_main490()
(sysfs_heartbeat_interval:2144) igt_core-INFO:   #4 ../tests/intel/sysfs_heartbeat_interval.c:490 main()
(sysfs_heartbeat_interval:2144) igt_core-INFO:   #5 [__libc_init_first+0x8a]
(sysfs_heartbeat_interval:2144) igt_core-INFO:   #6 [__libc_start_main+0x8b]
(sysfs_heartbeat_interval:2144) igt_core-INFO:   #7 [_start+0x25]
****  END  ****
Dynamic subtest vcs0: FAIL (0.536s)
Dmesg
<6> [132.381645] [IGT] sysfs_heartbeat_interval: starting dynamic subtest vcs0
<7> [132.382456] i915 0000:00:02.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x0000005c [0x0000005c]
<5> [132.383575] i915 0000:00:02.0: [drm] vcs0 heartbeat interval adjusted to a non-default value which may cause engine resets to target innocent contexts!
<7> [132.384579] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:508
<7> [132.388263] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:508
<5> [132.402835] i915 0000:00:02.0: [drm] Resetting vcs0 for preemption time out
<6> [132.403789] i915 0000:00:02.0: [drm] GPU HANG: ecode 12:4:24dffffd, in sysfs_heartbeat [2144]
<7> [132.404149] i915 0000:00:02.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x0000005c [0x0000005c]
<7> [132.439736] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:508
<7> [132.445829] [drm:eb_validate_vma [i915]] EINVAL at eb_validate_vma:508
<5> [132.862671] i915 0000:00:02.0: [drm] Resetting vcs0 for preemption time out
<6> [132.863387] i915 0000:00:02.0: [drm] GPU HANG: ecode 12:4:277ffefe, in sysfs_heartbeat [2144]
<7> [132.863653] i915 0000:00:02.0: [drm:i915_drop_caches_set [i915]] Dropping caches: 0x0000005c [0x0000005c]
<6> [132.917925] [IGT] sysfs_heartbeat_interval: finished subtest vcs0, FAIL
Created at 2025-06-25 16:18:02