[59.550297] Initializing watchdogs [59.550340] /dev/watchdog0 [59.563720] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics] [59.568238] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [59.570354] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [59.573872] [001/134] (960s left) kms_addfb_basic (addfb25-y-tiled-small-legacy) [59.707106] Starting subtest: addfb25-y-tiled-small-legacy [59.711243] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s) [59.838289] [002/134] (960s left) kms_plane_scaling (plane-downscale-factor-0-75-with-modifiers) [59.930072] Starting subtest: plane-downscale-factor-0-75-with-modifiers [59.932525] Starting dynamic subtest: pipe-A [60.318779] Dynamic subtest pipe-A: SUCCESS (0.388s) [60.326616] Starting dynamic subtest: pipe-B [61.758505] Dynamic subtest pipe-B: SUCCESS (1.439s) [61.770467] Starting dynamic subtest: pipe-C [63.214700] Dynamic subtest pipe-C: SUCCESS (1.456s) [63.224780] Starting dynamic subtest: pipe-D [64.630444] Dynamic subtest pipe-D: SUCCESS (1.416s) [64.632799] Subtest plane-downscale-factor-0-75-with-modifiers: SUCCESS (4.701s) [65.818941] [003/134] (954s left) i915_drm_fdinfo (virtual-idle) [65.859820] Starting subtest: virtual-idle [68.941383] Subtest virtual-idle: SUCCESS (3.077s) [69.034138] [004/134] (951s left) gem_userptr_blits (huge-split) [69.109721] Starting subtest: huge-split [69.121253] Subtest huge-split: SUCCESS (0.011s) [69.280836] [005/134] (950s left) kms_psr (fbc-pr-no-drrs) [69.372828] Starting subtest: fbc-pr-no-drrs [69.377329] Subtest fbc-pr-no-drrs: SKIP (0.000s) [69.465360] [006/134] (950s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-cpu) [69.562494] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-cpu [76.663053] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.102s) [76.827576] [007/134] (943s left) kms_cursor_legacy (cursora-vs-flipa-legacy) [76.952554] Starting subtest: cursorA-vs-flipA-legacy [88.116638] Subtest cursorA-vs-flipA-legacy: SUCCESS (11.164s) [88.963823] [008/134] (931s left) kms_psr (psr2-primary-page-flip) [89.088465] Starting subtest: psr2-primary-page-flip [89.090879] Starting dynamic subtest: eDP-1 [90.829982] Dynamic subtest eDP-1: SUCCESS (1.748s) [90.832135] Subtest psr2-primary-page-flip: SUCCESS (1.748s) [91.726710] [009/134] (928s left) i915_pm_rc6_residency (rc6-accuracy) [91.794244] Starting subtest: rc6-accuracy [91.796646] Starting dynamic subtest: gt0 [94.969071] Dynamic subtest gt0: SUCCESS (3.171s) [94.977641] Starting dynamic subtest: gt1 [98.141186] Dynamic subtest gt1: SUCCESS (3.169s) [98.143819] Subtest rc6-accuracy: SUCCESS (6.345s) [98.235631] [010/134] (922s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-blt) [98.338464] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-blt [105.537565] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.202s) [105.707278] [011/134] (914s left) kms_feature_discovery (psr2) [105.807279] Starting subtest: psr2 [105.809199] Subtest psr2: SUCCESS (0.000s) [105.902889] [012/134] (914s left) syncobj_wait (single-wait-all-for-submit-submitted) [105.952644] Starting subtest: single-wait-all-for-submit-submitted [106.058438] Subtest single-wait-all-for-submit-submitted: SUCCESS (0.105s) [106.154714] [013/134] (914s left) kms_flip (2x-wf_vblank-ts-check-interruptible) [106.263398] Starting subtest: 2x-wf_vblank-ts-check-interruptible [106.276697] Subtest 2x-wf_vblank-ts-check-interruptible: SKIP (0.011s) [106.373137] [014/134] (914s left) kms_psr_stress_test (flip-primary-invalidate-overlay) [106.459714] Starting subtest: flip-primary-invalidate-overlay [118.065106] Subtest flip-primary-invalidate-overlay: SUCCESS (11.607s) [118.258657] [015/134] (902s left) i915_drm_fdinfo (busy-idle) [118.303626] Starting subtest: busy-idle [118.305618] Starting dynamic subtest: rcs0 [118.344280] Dynamic subtest rcs0: SKIP (0.040s) [118.354053] Starting dynamic subtest: bcs0 [118.357702] Dynamic subtest bcs0: SKIP (0.001s) [118.364747] Starting dynamic subtest: vcs0 [118.368103] Dynamic subtest vcs0: SKIP (0.000s) [118.374887] Starting dynamic subtest: vcs1 [118.378434] Dynamic subtest vcs1: SKIP (0.000s) [118.384979] Starting dynamic subtest: vecs0 [118.388545] Dynamic subtest vecs0: SKIP (0.000s) [118.395190] Starting dynamic subtest: ccs0 [118.398745] Dynamic subtest ccs0: SKIP (0.000s) [118.402243] Subtest busy-idle: SKIP (0.045s) [118.441446] [016/134] (902s left) gem_exec_params (invalid-bsd2-flag-on-vebox) [118.501315] Starting subtest: invalid-bsd2-flag-on-vebox [118.503655] Subtest invalid-bsd2-flag-on-vebox: SUCCESS (0.000s) [118.626532] [017/134] (902s left) syncobj_wait (single-wait-all-for-submit-signaled) [118.681509] Starting subtest: single-wait-all-for-submit-signaled [118.683227] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s) [118.813863] [018/134] (901s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt) [118.926357] Starting subtest: fbcpsr-rgb101010-draw-blt [125.684188] Subtest fbcpsr-rgb101010-draw-blt: SUCCESS (6.759s) [125.838571] [019/134] (894s left) kms_pm_rpm (modeset-lpsp) [128.074896] Starting subtest: modeset-lpsp [129.541617] Subtest modeset-lpsp: SUCCESS (1.470s) [129.683683] [020/134] (891s left) i915_suspend (sysfs-reader) [129.759962] Starting subtest: sysfs-reader [148.108309] Subtest sysfs-reader: SUCCESS (3.264s) [148.163611] [021/134] (872s left) prime_vgem (sync) [148.299137] Starting subtest: sync [148.301848] Starting dynamic subtest: rcs0 [148.350159] Dynamic subtest rcs0: SUCCESS (0.050s) [148.359146] Starting dynamic subtest: bcs0 [148.433685] Dynamic subtest bcs0: SUCCESS (0.083s) [148.442895] Starting dynamic subtest: vcs0 [148.482399] Dynamic subtest vcs0: SUCCESS (0.048s) [148.491419] Starting dynamic subtest: vcs1 [148.528169] Dynamic subtest vcs1: SUCCESS (0.045s) [148.538125] Starting dynamic subtest: vecs0 [148.576085] Dynamic subtest vecs0: SUCCESS (0.047s) [148.585021] Starting dynamic subtest: ccs0 [148.624682] Dynamic subtest ccs0: SUCCESS (0.048s) [148.627172] Subtest sync: SUCCESS (0.326s) [148.782978] [FACT prime_vgem (sync)] new: kernel.kmod_is_loaded.vgem: true [148.786511] [022/134] (872s left) api_intel_allocator (two-level-inception) [148.845082] Starting subtest: two-level-inception [154.260759] Subtest two-level-inception: SUCCESS (5.413s) [154.435812] [023/134] (866s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move) [154.563754] Starting subtest: psr-2p-primscrn-cur-indfb-move [154.568787] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s) [154.702212] [024/134] (866s left) sriov_basic (bind-unbind-vf) [154.764450] Starting subtest: bind-unbind-vf [154.767303] Starting dynamic subtest: vf-1 [154.857821] Dynamic subtest vf-1: FAIL (0.034s) [154.868076] Starting dynamic subtest: vf-2 [154.949413] Dynamic subtest vf-2: FAIL (0.004s) [154.959658] Starting dynamic subtest: vf-3 [155.041249] Dynamic subtest vf-3: FAIL (0.004s) [155.051182] Starting dynamic subtest: vf-4 [155.133666] Dynamic subtest vf-4: FAIL (0.004s) [155.143675] Starting dynamic subtest: vf-5 [155.225816] Dynamic subtest vf-5: FAIL (0.004s) [155.235552] Starting dynamic subtest: vf-6 [155.310466] Dynamic subtest vf-6: FAIL (0.003s) [155.320129] Starting dynamic subtest: vf-7 [155.388744] Dynamic subtest vf-7: FAIL (0.003s) [155.398617] Starting dynamic subtest: vf-random [155.470620] Dynamic subtest vf-random: FAIL (0.003s) [155.480123] Starting dynamic subtest: vf-last [155.548060] Dynamic subtest vf-last: FAIL (0.548s) [155.550711] Subtest bind-unbind-vf: FAIL (0.612s) [155.590564] [025/134] (865s left) gem_eio (hibernate) [155.814950] Starting subtest: hibernate [170.382312] Subtest hibernate: SUCCESS (14.563s) [178.562329] [026/134] (850s left) kms_vrr (seamless-rr-switch-virtual) [178.674033] Starting subtest: seamless-rr-switch-virtual [178.681462] Subtest seamless-rr-switch-virtual: SKIP (0.000s) [178.765357] [027/134] (850s left) api_intel_bb (render) [178.815722] Starting subtest: render [178.817943] Starting dynamic subtest: render-none-512 [178.914262] Dynamic subtest render-none-512: SUCCESS (0.100s) [178.925062] Starting dynamic subtest: render-none-1024 [179.282831] Dynamic subtest render-none-1024: SUCCESS (0.367s) [179.295105] Starting dynamic subtest: render-x-512 [179.376139] Dynamic subtest render-x-512: SUCCESS (0.093s) [179.388625] Starting dynamic subtest: render-x-1024 [179.709296] Dynamic subtest render-x-1024: SUCCESS (0.333s) [179.721500] Starting dynamic subtest: render-y-512 [179.793299] Dynamic subtest render-y-512: SUCCESS (0.083s) [179.805342] Starting dynamic subtest: render-y-1024 [180.131113] Dynamic subtest render-y-1024: SUCCESS (0.336s) [180.134115] Subtest render: SUCCESS (1.316s) [180.273651] [028/134] (848s left) kms_cursor_legacy (torture-bo) [180.410163] Starting subtest: torture-bo [180.412558] Starting dynamic subtest: pipe-A [186.373570] Dynamic subtest pipe-A: SUCCESS (5.959s) [186.386638] Starting dynamic subtest: pipe-B [192.552480] Dynamic subtest pipe-B: SUCCESS (6.175s) [192.564894] Starting dynamic subtest: pipe-C [199.183712] Dynamic subtest pipe-C: SUCCESS (6.629s) [199.196262] Starting dynamic subtest: pipe-D [206.236358] Dynamic subtest pipe-D: SUCCESS (7.049s) [206.249813] Starting dynamic subtest: all-pipes [212.854296] Dynamic subtest all-pipes: SUCCESS (6.613s) [212.856536] Subtest torture-bo: SUCCESS (32.435s) [213.030744] [029/134] (816s left) kms_rotation_crc (sprite-rotation-270) [213.124394] Starting subtest: sprite-rotation-270 [213.129828] Subtest sprite-rotation-270: SKIP (0.001s) [213.218235] [030/134] (816s left) kms_prime (basic-modeset-hybrid) [213.300501] Subtest basic-modeset-hybrid: SKIP (0.000s) [213.415239] [031/134] (815s left) gem_ctx_persistence (many-contexts) [213.481171] Starting subtest: many-contexts [258.678337] Subtest many-contexts: SUCCESS (45.196s) [258.780687] [032/134] (770s left) gem_create (busy-create) [258.845232] Starting subtest: busy-create [258.847822] Starting dynamic subtest: smem0 [291.989139] Dynamic subtest smem0: SUCCESS (33.141s) [291.992536] Subtest busy-create: SUCCESS (33.143s) [292.199232] [033/134] (737s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt) [292.299339] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt [292.304958] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [292.422823] [034/134] (737s left) kms_psr (fbc-psr-cursor-blt) [292.516967] Starting subtest: fbc-psr-cursor-blt [292.519068] Starting dynamic subtest: eDP-1 [292.523722] Dynamic subtest eDP-1: SKIP (0.000s) [292.528167] Subtest fbc-psr-cursor-blt: SKIP (0.001s) [292.609971] [035/134] (736s left) gem_sync (basic-store-each) [292.693346] Starting subtest: basic-store-each [295.237040] Subtest basic-store-each: SUCCESS (2.557s) [295.452590] [036/134] (734s left) prime_mmap (test_userptr) [295.522334] Starting subtest: test_userptr [295.525208] Starting dynamic subtest: test_userptr-smem [295.528124] Dynamic subtest test_userptr-smem: SUCCESS (0.000s) [295.531242] Subtest test_userptr: SUCCESS (0.001s) [295.639029] [037/134] (733s left) kms_pipe_crc_basic (nonblocking-crc) [295.739987] Starting subtest: nonblocking-crc [295.742349] Starting dynamic subtest: pipe-A-eDP-1 [296.523983] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.782s) [296.534589] Starting dynamic subtest: pipe-B-eDP-1 [297.959122] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.433s) [297.978599] Starting dynamic subtest: pipe-C-eDP-1 [299.327096] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.367s) [299.338520] Starting dynamic subtest: pipe-D-eDP-1 [300.663326] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.332s) [300.665612] Subtest nonblocking-crc: SUCCESS (4.920s) [301.485559] [038/134] (728s left) perf (unprivileged-single-ctx-counters) [301.635040] Starting subtest: unprivileged-single-ctx-counters [301.640130] Subtest unprivileged-single-ctx-counters: SKIP (0.000s) [301.678696] [039/134] (727s left) kms_psr2_sf (psr2-overlay-primary-update-sf-dmg-area) [306.639225] Starting subtest: psr2-overlay-primary-update-sf-dmg-area [306.642112] Starting dynamic subtest: pipe-A-eDP-1 [313.293240] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.655s) [313.302839] Starting dynamic subtest: pipe-B-eDP-1 [319.931297] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.636s) [319.933842] Subtest psr2-overlay-primary-update-sf-dmg-area: SUCCESS (13.295s) [320.834742] [040/134] (708s left) kms_psr2_sf (pr-overlay-plane-move-continuous-sf) [325.873862] Starting subtest: pr-overlay-plane-move-continuous-sf [325.879322] Subtest pr-overlay-plane-move-continuous-sf: SKIP (0.002s) [326.746871] [041/134] (703s left) kms_psr (fbc-psr-sprite-blt) [326.848074] Starting subtest: fbc-psr-sprite-blt [326.850719] Starting dynamic subtest: eDP-1 [326.856091] Dynamic subtest eDP-1: SKIP (0.000s) [326.861253] Subtest fbc-psr-sprite-blt: SKIP (0.001s) [326.943104] [042/134] (702s left) sysfs_timeslice_duration (invalid) [327.005789] Starting subtest: invalid [327.008051] Starting dynamic subtest: vecs0 [327.010568] Dynamic subtest vecs0: SUCCESS (0.000s) [327.020236] Starting dynamic subtest: ccs0 [327.022574] Dynamic subtest ccs0: SUCCESS (0.000s) [327.032097] Starting dynamic subtest: vcs0 [327.034177] Dynamic subtest vcs0: SUCCESS (0.000s) [327.043327] Starting dynamic subtest: bcs0 [327.045558] Dynamic subtest bcs0: SUCCESS (0.000s) [327.054347] Starting dynamic subtest: rcs0 [327.057377] Dynamic subtest rcs0: SUCCESS (0.000s) [327.067180] Starting dynamic subtest: vcs1 [327.070137] Dynamic subtest vcs1: SUCCESS (0.000s) [327.072566] Subtest invalid: SUCCESS (0.005s) [327.149818] [043/134] (702s left) gem_barrier_race (remote-request) [327.224352] Starting subtest: remote-request [327.226674] Starting dynamic subtest: rcs0 [332.381644] Dynamic subtest rcs0: SUCCESS (5.159s) [332.384268] Subtest remote-request: SUCCESS (5.160s) [332.575169] [044/134] (697s left) kms_big_fb (yf-tiled-addfb-size-overflow) [332.679073] Starting subtest: yf-tiled-addfb-size-overflow [332.684576] Subtest yf-tiled-addfb-size-overflow: SKIP (0.000s) [332.809779] [045/134] (697s left) vgem_basic (busy-fence) [332.861132] Starting subtest: busy-fence [332.863592] Subtest busy-fence: SUCCESS (0.000s) [332.944357] [046/134] (697s left) gem_mmap (bad-object) [333.006154] Subtest bad-object: SKIP (0.000s) [333.077160] [047/134] (696s left) kms_big_fb (x-tiled-64bpp-rotate-180) [333.177990] Starting subtest: x-tiled-64bpp-rotate-180 [334.780209] Subtest x-tiled-64bpp-rotate-180: SUCCESS (1.601s) [334.993737] [048/134] (695s left) syncobj_timeline (etime-multi-wait-submitted) [335.059194] Starting subtest: etime-multi-wait-submitted [335.159425] Subtest etime-multi-wait-submitted: SUCCESS (0.101s) [335.260843] [049/134] (694s left) gem_readwrite (read-write) [335.328499] Subtest read-write: SKIP (0.000s) [335.409364] [050/134] (694s left) kms_content_protection (mei-interface) [335.554646] Starting subtest: mei-interface [335.560153] Subtest mei-interface: SKIP (0.001s) [335.728306] [051/134] (694s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip) [335.833737] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip [336.501900] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.670s) [336.688849] [052/134] (693s left) gem_mmap_gtt (isolation) [336.752353] Subtest isolation: SKIP (0.000s) [336.821175] [053/134] (693s left) kms_cursor_edge_walk (64x64-top-edge) [336.925083] Starting subtest: 64x64-top-edge [336.927934] Starting dynamic subtest: pipe-A-eDP-1 [340.383325] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.457s) [340.394244] Starting dynamic subtest: pipe-D-eDP-1 [343.496627] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.112s) [343.499192] Subtest 64x64-top-edge: SUCCESS (6.572s) [344.338662] [054/134] (685s left) syncobj_wait (wait-all-snapshot) [344.409960] Starting subtest: wait-all-snapshot [344.489906] Subtest wait-all-snapshot: SUCCESS (0.082s) [344.589834] [055/134] (685s left) kms_frontbuffer_tracking (fbcpsr-argb161616f-draw-mmap-cpu) [344.695330] Starting subtest: fbcpsr-argb161616f-draw-mmap-cpu [344.700799] Subtest fbcpsr-argb161616f-draw-mmap-cpu: SKIP (0.000s) [344.824337] [056/134] (685s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt) [344.927869] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt [344.932873] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [345.057780] [057/134] (685s left) gem_create (create-invalid-size) [345.121303] Starting subtest: create-invalid-size [345.124178] Subtest create-invalid-size: SUCCESS (0.000s) [345.331204] [058/134] (685s left) gem_render_copy (y-tiled-ccs-to-yf-tiled) [345.398270] Starting subtest: y-tiled-ccs-to-yf-tiled [345.403213] Subtest y-tiled-ccs-to-yf-tiled: SKIP (0.000s) [345.607292] [059/134] (684s left) kms_frontbuffer_tracking (psr-argb161616f-draw-mmap-wc) [345.704585] Starting subtest: psr-argb161616f-draw-mmap-wc [345.709468] Subtest psr-argb161616f-draw-mmap-wc: SKIP (0.000s) [345.836792] [060/134] (684s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu) [345.946491] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu [345.950999] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [346.075121] [061/134] (684s left) kms_joiner (switch-modeset-ultra-joiner-big-joiner) [346.191075] Starting subtest: switch-modeset-ultra-joiner-big-joiner [346.195434] Subtest switch-modeset-ultra-joiner-big-joiner: SKIP (0.000s) [346.280874] [062/134] (684s left) sw_sync (sync_merge_same) [346.321220] Starting subtest: sync_merge_same [346.324143] Subtest sync_merge_same: SUCCESS (0.000s) [346.410314] [063/134] (684s left) kms_plane_scaling (planes-downscale-factor-0-75-unity-scaling) [346.503914] Starting subtest: planes-downscale-factor-0-75-unity-scaling [346.506328] Starting dynamic subtest: pipe-A [346.568213] Dynamic subtest pipe-A: SUCCESS (0.064s) [346.581320] Starting dynamic subtest: pipe-B [347.746299] Dynamic subtest pipe-B: SUCCESS (1.175s) [347.755928] Starting dynamic subtest: pipe-C [348.863896] Dynamic subtest pipe-C: SUCCESS (1.116s) [348.873328] Starting dynamic subtest: pipe-D [350.002754] Dynamic subtest pipe-D: SUCCESS (1.138s) [350.005619] Subtest planes-downscale-factor-0-75-unity-scaling: SUCCESS (3.499s) [351.175818] [064/134] (679s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa [351.241592] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled [351.244208] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.000s) [351.359212] [065/134] (679s left) gem_render_copy (linear-to-vebox-yf-tiled) [351.426326] Starting subtest: linear-to-vebox-yf-tiled [351.431781] Subtest linear-to-vebox-yf-tiled: SKIP (0.000s) [351.632231] [066/134] (679s left) kms_flip (flip-vs-dpms-off-vs-modeset-interruptible) [351.747669] Starting subtest: flip-vs-dpms-off-vs-modeset-interruptible [351.750155] Starting dynamic subtest: A-eDP1 [355.293099] Dynamic subtest A-eDP1: SUCCESS (3.543s) [355.304185] Starting dynamic subtest: B-eDP1 [358.490551] Dynamic subtest B-eDP1: SUCCESS (3.196s) [358.500647] Starting dynamic subtest: C-eDP1 [361.622544] Dynamic subtest C-eDP1: SUCCESS (3.132s) [361.633344] Starting dynamic subtest: D-eDP1 [364.734778] Dynamic subtest D-eDP1: SUCCESS (3.109s) [364.737029] Subtest flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (12.987s) [365.557596] [067/134] (665s left) kms_chamelium_color (ctm-limited-range) [365.667987] Subtest ctm-limited-range: SKIP (0.000s) [365.712520] [068/134] (665s left) gem_mmap_wc (write) [365.784993] Subtest write: SKIP (0.000s) [365.849965] [069/134] (665s left) prime_mmap (test_correct) [365.908325] Starting subtest: test_correct [365.910767] Starting dynamic subtest: test_correct-smem [365.936461] Dynamic subtest test_correct-smem: SUCCESS (0.030s) [365.939344] Subtest test_correct: SUCCESS (0.031s) [366.079034] [070/134] (664s left) device_reset (cold-reset-bound) [366.128607] Starting subtest: cold-reset-bound [366.134178] Subtest cold-reset-bound: SKIP (0.000s) [366.245151] [071/134] (664s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-blt) [366.351126] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-blt [373.210353] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.862s) [373.406374] [072/134] (657s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-cpu) [373.510240] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-cpu [377.696973] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (4.190s) [378.888795] [073/134] (652s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs) [378.993120] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs [378.995677] Starting dynamic subtest: pipe-A-eDP-1 [379.020842] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [379.030826] Starting dynamic subtest: pipe-B-eDP-1 [379.056363] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [379.066100] Starting dynamic subtest: pipe-C-eDP-1 [379.091885] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [379.102093] Starting dynamic subtest: pipe-D-eDP-1 [379.127189] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [379.131904] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs: SKIP (0.006s) [381.246559] [074/134] (649s left) gem_exec_fence (syncobj-channel) [381.688591] Starting subtest: syncobj-channel [382.708256] Subtest syncobj-channel: SUCCESS (1.015s) [383.109331] [075/134] (648s left) gem_exec_reloc (basic-gtt-noreloc) [383.174409] Subtest basic-gtt-noreloc: SKIP (0.000s) [383.262634] [076/134] (648s left) kms_flip (dpms-off-confusion-interruptible) [383.357056] Starting subtest: dpms-off-confusion-interruptible [383.359889] Starting dynamic subtest: A-eDP1 [392.024485] Dynamic subtest A-eDP1: SUCCESS (8.667s) [392.037001] Starting dynamic subtest: B-eDP1 [400.662133] Dynamic subtest B-eDP1: SUCCESS (8.636s) [400.673334] Starting dynamic subtest: C-eDP1 [409.284992] Dynamic subtest C-eDP1: SUCCESS (8.619s) [409.295880] Starting dynamic subtest: D-eDP1 [417.919131] Dynamic subtest D-eDP1: SUCCESS (8.630s) [417.921928] Subtest dpms-off-confusion-interruptible: SUCCESS (34.563s) [419.122458] [077/134] (612s left) kms_vblank (wait-forked-busy) [419.230322] Starting subtest: wait-forked-busy [419.233198] Starting dynamic subtest: pipe-A-eDP-1 [421.112882] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.880s) [421.130978] Starting dynamic subtest: pipe-D-eDP-1 [423.667326] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.552s) [423.670333] Subtest wait-forked-busy: SUCCESS (4.437s) [424.492021] [078/134] (606s left) kms_chamelium_frames (dp-frame-dump) [424.883255] Subtest dp-frame-dump: SKIP (0.000s) [425.668769] [079/134] (605s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-mc-ccs) [425.763891] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-mc-ccs [425.766203] Starting dynamic subtest: pipe-A-eDP-1 [425.835109] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [425.846629] Starting dynamic subtest: pipe-B-eDP-1 [425.917871] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [425.929341] Starting dynamic subtest: pipe-C-eDP-1 [425.997938] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [426.009306] Starting dynamic subtest: pipe-D-eDP-1 [426.076541] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [426.081100] Subtest crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.009s) [427.986868] [080/134] (603s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt) [428.091284] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt [428.096957] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s) [428.235437] [081/134] (603s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180) [428.344826] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180 [428.349461] Subtest y-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s) [428.484680] [082/134] (603s left) gen7_exec_parse (cmd-crossing-page) [428.542098] Subtest cmd-crossing-page: SKIP (0.000s) [428.610719] [083/134] (602s left) kms_atomic_transition (modeset-transition-nonblocking) [428.700951] Starting subtest: modeset-transition-nonblocking [428.703227] Starting dynamic subtest: 1x-outputs [439.491435] Dynamic subtest 1x-outputs: SUCCESS (10.791s) [439.494095] Subtest modeset-transition-nonblocking: SUCCESS (10.792s) [440.379966] [084/134] (591s left) kms_draw_crc (draw-method-mmap-cpu) [440.484158] Starting subtest: draw-method-mmap-cpu [440.486595] Starting dynamic subtest: xrgb8888-untiled [440.704083] Dynamic subtest xrgb8888-untiled: SUCCESS (0.222s) [440.714284] Starting dynamic subtest: rgb565-untiled [440.915268] Dynamic subtest rgb565-untiled: SUCCESS (0.210s) [440.925214] Starting dynamic subtest: xrgb2101010-untiled [441.127074] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.210s) [441.137236] Starting dynamic subtest: xbgr16161616f-untiled [441.348357] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.220s) [441.360875] Starting dynamic subtest: xrgb8888-xtiled [441.481649] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.133s) [441.493534] Starting dynamic subtest: rgb565-xtiled [441.616224] Dynamic subtest rgb565-xtiled: SUCCESS (0.132s) [441.626258] Starting dynamic subtest: xrgb2101010-xtiled [441.737390] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.121s) [441.747344] Starting dynamic subtest: xbgr16161616f-xtiled [441.859970] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.122s) [441.873151] Starting dynamic subtest: xrgb8888-4tiled [442.015004] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.152s) [442.028140] Starting dynamic subtest: rgb565-4tiled [442.159541] Dynamic subtest rgb565-4tiled: SUCCESS (0.142s) [442.169672] Starting dynamic subtest: xrgb2101010-4tiled [442.292576] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.132s) [442.302124] Starting dynamic subtest: xbgr16161616f-4tiled [442.437481] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.144s) [442.439663] Subtest draw-method-mmap-cpu: SUCCESS (1.957s) [442.567585] [085/134] (589s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs-cc) [442.668622] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs-cc [442.670912] Starting dynamic subtest: pipe-A-eDP-1 [442.818743] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.142s) [442.830098] Starting dynamic subtest: pipe-B-eDP-1 [442.847306] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.010s) [442.856892] Starting dynamic subtest: pipe-C-eDP-1 [442.877010] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.011s) [442.886105] Starting dynamic subtest: pipe-D-eDP-1 [442.905117] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.011s) [442.906955] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.179s) [445.130134] [086/134] (586s left) gem_exec_schedule (u-semaphore-user) [445.213052] Starting subtest: u-semaphore-user [445.259336] Subtest u-semaphore-user: SUCCESS (0.058s) [447.045757] [087/134] (584s left) gem_exec_fence (basic-await) [447.226239] Starting subtest: basic-await [447.229628] Starting dynamic subtest: rcs0 [447.302363] Dynamic subtest rcs0: SUCCESS (0.076s) [447.316106] Starting dynamic subtest: bcs0 [447.375331] Dynamic subtest bcs0: SUCCESS (0.071s) [447.387649] Starting dynamic subtest: vcs0 [447.447691] Dynamic subtest vcs0: SUCCESS (0.071s) [447.460242] Starting dynamic subtest: vcs1 [447.520058] Dynamic subtest vcs1: SUCCESS (0.071s) [447.533328] Starting dynamic subtest: vecs0 [447.593525] Dynamic subtest vecs0: SUCCESS (0.072s) [447.609402] Starting dynamic subtest: ccs0 [447.668378] Dynamic subtest ccs0: SUCCESS (0.074s) [447.671230] Subtest basic-await: SUCCESS (0.443s) [449.100147] [088/134] (582s left) kms_rotation_crc (cursor-rotation-180) [449.210212] Starting subtest: cursor-rotation-180 [450.781478] Subtest cursor-rotation-180: SUCCESS (1.572s) [452.002026] [089/134] (579s left) kms_cursor_crc (cursor-onscreen-512x170) [452.293245] Starting subtest: cursor-onscreen-512x170 [452.299123] Subtest cursor-onscreen-512x170: SKIP (0.001s) [452.478737] [090/134] (579s left) kms_big_fb (linear-addfb) [452.581613] Starting subtest: linear-addfb [452.584136] Subtest linear-addfb: SUCCESS (0.000s) [452.710094] [091/134] (579s left) gem_exec_whisper (basic-queues) [452.769338] Starting subtest: basic-queues [459.279856] Subtest basic-queues: SUCCESS (6.506s) [459.485101] [092/134] (572s left) gem_exec_reloc (basic-scanout) [459.555217] Subtest basic-scanout: SKIP (0.000s) [459.646990] [093/134] (572s left) kms_plane_lowres (tiling-4) [459.760350] Starting subtest: tiling-4 [459.762680] Starting dynamic subtest: pipe-A-eDP-1 [459.767258] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [460.053710] Starting dynamic subtest: pipe-B-eDP-1 [460.058364] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [460.068152] Starting dynamic subtest: pipe-C-eDP-1 [460.072793] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [460.083551] Starting dynamic subtest: pipe-D-eDP-1 [460.089262] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [460.095156] Subtest tiling-4: SKIP (0.292s) [460.924194] [094/134] (571s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-onoff) [461.052307] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-onoff [468.043352] Subtest fbcpsr-1p-primscrn-spr-indfb-onoff: SUCCESS (6.992s) [468.229647] [095/134] (563s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-cpu) [468.345479] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-cpu [472.021862] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (3.681s) [473.244809] [096/134] (558s left) gem_ctx_create (basic) [473.310338] Starting subtest: basic [473.313311] Subtest basic: SUCCESS (0.000s) [473.518421] [097/134] (558s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-downscaling) [473.618168] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-downscaling [473.621062] Starting dynamic subtest: pipe-A-default-mode [474.782323] Dynamic subtest pipe-A-default-mode: SKIP (1.161s) [474.787557] Subtest flip-64bpp-xtile-to-32bpp-xtile-downscaling: SKIP (1.162s) [474.978815] [098/134] (557s left) gem_pwrite (basic-exhaustion) [475.048603] Subtest basic-exhaustion: SKIP (0.000s) [475.114928] [099/134] (557s left) kms_atomic_transition (plane-all-transition-nonblocking) [475.214209] Starting subtest: plane-all-transition-nonblocking [475.217079] Starting dynamic subtest: pipe-A-eDP-1 [477.714126] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.498s) [478.023883] Starting dynamic subtest: pipe-B-eDP-1 [481.292116] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.280s) [481.605918] Subtest plane-all-transition-nonblocking: SUCCESS (6.390s) [482.437023] [100/134] (549s left) kms_color_pipeline (plane-lut1d-lut1d) [482.535165] Starting subtest: plane-lut1d-lut1d [482.549039] Starting dynamic subtest: pipe-A-eDP-1 [483.314195] Dynamic subtest pipe-A-eDP-1: FAIL (0.306s) [483.887603] Starting dynamic subtest: pipe-B-eDP-1 [484.884224] Dynamic subtest pipe-B-eDP-1: FAIL (0.301s) [485.218201] Starting dynamic subtest: pipe-C-eDP-1 [486.240195] Dynamic subtest pipe-C-eDP-1: FAIL (0.246s) [486.553970] Starting dynamic subtest: pipe-D-eDP-1 [487.494552] Dynamic subtest pipe-D-eDP-1: FAIL (0.280s) [487.496953] Subtest plane-lut1d-lut1d: FAIL (4.588s) [487.961695] [101/134] (544s left) gem_lmem_swapping (verify-random) [488.009171] Subtest verify-random: SKIP (0.000s) [488.062089] [102/134] (544s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-wc) [488.171128] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-wc [488.176215] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [488.305073] [103/134] (544s left) sw_sync (sync_random_merge) [488.349088] Starting subtest: sync_random_merge [488.383522] Subtest sync_random_merge: SUCCESS (0.037s) [488.469164] [104/134] (544s left) syncobj_timeline (invalid-signal-bad-pad) [488.530047] Starting subtest: invalid-signal-bad-pad [488.532525] Subtest invalid-signal-bad-pad: SUCCESS (0.000s) [488.652188] [105/134] (543s left) gem_mmap_gtt (basic) [488.719510] Subtest basic: SKIP (0.000s) [488.788753] [106/134] (543s left) gem_exec_balancer (invalid-balancer) [488.846251] Starting subtest: invalid-balancer [489.722496] Subtest invalid-balancer: SUCCESS (0.875s) [490.035870] [107/134] (542s left) kms_big_fb (y-tiled-8bpp-rotate-90) [490.139254] Starting subtest: y-tiled-8bpp-rotate-90 [490.144692] Subtest y-tiled-8bpp-rotate-90: SKIP (0.000s) [490.272769] [108/134] (542s left) gem_render_linear_blits (basic) [490.346322] Starting subtest: basic [490.382406] Subtest basic: SUCCESS (0.039s) [490.500019] [109/134] (542s left) gem_ctx_shared (q-promotion) [490.572077] Starting subtest: Q-promotion [490.574991] Starting dynamic subtest: rcs0 [490.686746] Dynamic subtest rcs0: SUCCESS (0.114s) [490.701816] Starting dynamic subtest: vcs0 [490.807527] Dynamic subtest vcs0: SUCCESS (0.119s) [490.823964] Starting dynamic subtest: vcs1 [490.895020] Dynamic subtest vcs1: SUCCESS (0.088s) [490.914026] Starting dynamic subtest: vecs0 [491.004062] Dynamic subtest vecs0: SUCCESS (0.105s) [491.022138] Starting dynamic subtest: ccs0 [491.095989] Dynamic subtest ccs0: SUCCESS (0.092s) [491.099006] Subtest Q-promotion: SUCCESS (0.524s) [492.102322] [110/134] (540s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-pwrite) [492.206032] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-pwrite [492.211159] Subtest fbc-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [492.327614] [111/134] (540s left) syncobj_timeline (single-wait-for-submit-available-submitted) [492.386925] Starting subtest: single-wait-for-submit-available-submitted [492.389694] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.000s) [492.523192] [112/134] (540s left) gem_flink_basic (bad-open) [492.575148] Starting subtest: bad-open [492.578149] Subtest bad-open: SUCCESS (0.000s) [492.709628] [113/134] (540s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc) [492.800262] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc [492.803214] Starting dynamic subtest: pipe-A-eDP-1 [493.617498] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.809s) [493.630052] Starting dynamic subtest: pipe-B-eDP-1 [495.158290] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.540s) [495.168992] Starting dynamic subtest: pipe-C-eDP-1 [496.635887] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.474s) [496.648021] Starting dynamic subtest: pipe-D-eDP-1 [498.181017] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.541s) [498.183967] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.369s) [499.382164] [114/134] (533s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-wc) [499.486179] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-wc [499.491348] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [499.621546] [115/134] (533s left) kms_hdr (bpc-switch-dpms) [499.726638] Starting subtest: bpc-switch-dpms [500.832456] Starting dynamic subtest: pipe-A-eDP-1 [505.370019] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.537s) [505.372596] Subtest bpc-switch-dpms: SUCCESS (5.645s) [505.533731] [116/134] (527s left) kms_chamelium_hpd (hdmi-hpd) [505.911311] Subtest hdmi-hpd: SKIP (0.000s) [506.738948] [117/134] (526s left) kms_rotation_crc (primary-yf-tiled-reflect-x-270) [506.831725] Starting subtest: primary-yf-tiled-reflect-x-270 [506.836447] Subtest primary-yf-tiled-reflect-x-270: SKIP (0.001s) [506.934489] [118/134] (526s left) prime_vgem (basic-write) [507.041179] Starting subtest: basic-write [507.065172] Subtest basic-write: SKIP (0.022s) [507.203380] [119/134] (525s left) gem_ctx_freq (sysfs) [507.271487] Starting subtest: sysfs [507.274315] Starting dynamic subtest: gt0 [512.813941] Dynamic subtest gt0: SUCCESS (5.542s) [512.825844] Starting dynamic subtest: gt1 [553.986753] Dynamic subtest gt1: SUCCESS (41.167s) [553.989608] Subtest sysfs: SUCCESS (46.712s) [554.150028] [120/134] (479s left) kms_cursor_crc (cursor-onscreen-max-size) [554.474984] Starting subtest: cursor-onscreen-max-size [554.482305] Subtest cursor-onscreen-max-size: SKIP (0.000s) [554.610079] [121/134] (478s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt) [554.719153] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt [554.724964] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [554.874646] [122/134] (478s left) perf (per-context-mode-unprivileged) [554.983843] Starting subtest: per-context-mode-unprivileged [554.988944] Subtest per-context-mode-unprivileged: SKIP (0.000s) [555.035678] [123/134] (478s left) kms_setmode (basic) [555.105774] Starting subtest: basic [555.438613] Starting dynamic subtest: pipe-A-eDP-1 [557.494105] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.051s) [557.832210] Starting dynamic subtest: pipe-B-eDP-1 [559.923887] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.096s) [560.235129] Subtest basic: SUCCESS (5.125s) [561.094856] [124/134] (472s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip) [561.207373] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip [561.886885] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.681s) [562.093998] [125/134] (471s left) kms_atomic_transition (plane-use-after-nonblocking-unbind) [562.187239] Starting subtest: plane-use-after-nonblocking-unbind [562.189758] Starting dynamic subtest: pipe-A-eDP-1 [562.250025] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.062s) [562.546077] Starting dynamic subtest: pipe-B-eDP-1 [563.377067] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.841s) [563.684252] Subtest plane-use-after-nonblocking-unbind: SUCCESS (1.493s) [564.562383] [126/134] (468s left) kms_atomic_interruptible (universal-setplane-primary) [564.663242] Starting subtest: universal-setplane-primary [564.666138] Starting dynamic subtest: pipe-A-eDP-1 [572.069286] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.403s) [572.072292] Subtest universal-setplane-primary: SUCCESS (7.405s) [572.946813] [127/134] (460s left) kms_pm_backlight (fade-with-dpms) [573.062629] Starting subtest: fade-with-dpms [575.422177] Starting dynamic subtest: eDP-1 [578.116039] Dynamic subtest eDP-1: SUCCESS (2.694s) [578.118750] Subtest fade-with-dpms: SUCCESS (5.054s) [578.933730] [128/134] (454s left) perf_pmu (event-wait) [578.983565] Starting subtest: event-wait [578.986058] Starting dynamic subtest: rcs0 [578.991198] Dynamic subtest rcs0: SKIP (0.000s) [578.995869] Subtest event-wait: SKIP (0.001s) [579.123463] [129/134] (454s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt) [579.228212] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt [579.233352] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [579.356682] [130/134] (454s left) gem_exec_whisper (basic-contexts-all) [579.433464] Starting subtest: basic-contexts-all [588.966347] Subtest basic-contexts-all: SUCCESS (9.531s) [589.176703] [131/134] (444s left) gem_spin_batch (spin-each) [589.252364] Starting subtest: spin-each [592.634051] Subtest spin-each: SUCCESS (3.381s) [593.098130] [132/134] (440s left) kms_universal_plane (disable-primary-vs-flip) [593.198409] Starting subtest: disable-primary-vs-flip [593.201003] Starting dynamic subtest: pipe-A-eDP-1 [594.683269] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.487s) [594.695592] Starting dynamic subtest: pipe-B-eDP-1 [596.876763] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.193s) [596.889353] Starting dynamic subtest: pipe-C-eDP-1 [599.099089] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.219s) [599.115821] Starting dynamic subtest: pipe-D-eDP-1 [601.239688] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.141s) [601.242352] Subtest disable-primary-vs-flip: SUCCESS (8.044s) [602.062758] [133/134] (431s left) gem_exec_schedule (preemptive-hang) [602.248796] Starting subtest: preemptive-hang [602.251599] Starting dynamic subtest: rcs0 [611.117572] Dynamic subtest rcs0: SUCCESS (8.865s) [611.129317] Starting dynamic subtest: bcs0 [620.138303] Dynamic subtest bcs0: SUCCESS (9.019s) [620.151289] Starting dynamic subtest: vcs0 [629.100312] Dynamic subtest vcs0: SUCCESS (8.962s) [629.111012] Starting dynamic subtest: vcs1 [638.121618] Dynamic subtest vcs1: SUCCESS (9.017s) [638.135112] Starting dynamic subtest: vecs0 [647.081609] Dynamic subtest vecs0: SUCCESS (8.957s) [647.094424] Starting dynamic subtest: ccs0 [656.107543] Dynamic subtest ccs0: SUCCESS (9.027s) [656.110330] Subtest preemptive-hang: SUCCESS (53.855s) [656.359605] [134/134] (377s left) syncobj_wait (invalid-signal-bad-pad) [656.418192] Starting subtest: invalid-signal-bad-pad [656.421166] Subtest invalid-signal-bad-pad: SUCCESS (0.000s) [656.538744] Closing watchdogs results: parsing output: 0/ for test: kms_addfb_basic results: parsing output: 1/ for test: kms_plane_scaling results: parsing output: 2/ for test: i915_drm_fdinfo results: parsing output: 3/ for test: gem_userptr_blits results: parsing output: 4/ for test: kms_psr results: parsing output: 5/ for test: kms_frontbuffer_tracking results: parsing output: 6/ for test: kms_cursor_legacy results: parsing output: 7/ for test: kms_psr results: parsing output: 8/ for test: i915_pm_rc6_residency results: parsing output: 9/ for test: kms_frontbuffer_tracking results: parsing output: 10/ for test: kms_feature_discovery results: parsing output: 11/ for test: syncobj_wait results: parsing output: 12/ for test: kms_flip results: parsing output: 13/ for test: kms_psr_stress_test results: parsing output: 14/ for test: i915_drm_fdinfo results: parsing output: 15/ for test: gem_exec_params results: parsing output: 16/ for test: syncobj_wait results: parsing output: 17/ for test: kms_frontbuffer_tracking results: parsing output: 18/ for test: kms_pm_rpm results: parsing output: 19/ for test: i915_suspend results: parsing output: 20/ for test: prime_vgem results: parsing output: 21/ for test: api_intel_allocator results: parsing output: 22/ for test: kms_frontbuffer_tracking results: parsing output: 23/ for test: sriov_basic results: parsing output: 24/ for test: gem_eio results: parsing output: 25/ for test: kms_vrr results: parsing output: 26/ for test: api_intel_bb results: parsing output: 27/ for test: kms_cursor_legacy results: parsing output: 28/ for test: kms_rotation_crc results: parsing output: 29/ for test: kms_prime results: parsing output: 30/ for test: gem_ctx_persistence results: parsing output: 31/ for test: gem_create results: parsing output: 32/ for test: kms_frontbuffer_tracking results: parsing output: 33/ for test: kms_psr results: parsing output: 34/ for test: gem_sync results: parsing output: 35/ for test: prime_mmap results: parsing output: 36/ for test: kms_pipe_crc_basic results: parsing output: 37/ for test: perf results: parsing output: 38/ for test: kms_psr2_sf results: parsing output: 39/ for test: kms_psr2_sf results: parsing output: 40/ for test: kms_psr results: parsing output: 41/ for test: sysfs_timeslice_duration results: parsing output: 42/ for test: gem_barrier_race results: parsing output: 43/ for test: kms_big_fb results: parsing output: 44/ for test: vgem_basic results: parsing output: 45/ for test: gem_mmap results: parsing output: 46/ for test: kms_big_fb results: parsing output: 47/ for test: syncobj_timeline results: parsing output: 48/ for test: gem_readwrite results: parsing output: 49/ for test: kms_content_protection results: parsing output: 50/ for test: kms_big_fb results: parsing output: 51/ for test: gem_mmap_gtt results: parsing output: 52/ for test: kms_cursor_edge_walk results: parsing output: 53/ for test: syncobj_wait results: parsing output: 54/ for test: kms_frontbuffer_tracking results: parsing output: 55/ for test: kms_frontbuffer_tracking results: parsing output: 56/ for test: gem_create results: parsing output: 57/ for test: gem_render_copy results: parsing output: 58/ for test: kms_frontbuffer_tracking results: parsing output: 59/ for test: kms_frontbuffer_tracking results: parsing output: 60/ for test: kms_joiner results: parsing output: 61/ for test: sw_sync results: parsing output: 62/ for test: kms_plane_scaling results: parsing output: 63/ for test: syncobj_timeline results: parsing output: 64/ for test: gem_render_copy results: parsing output: 65/ for test: kms_flip results: parsing output: 66/ for test: kms_chamelium_color results: parsing output: 67/ for test: gem_mmap_wc results: parsing output: 68/ for test: prime_mmap results: parsing output: 69/ for test: device_reset results: parsing output: 70/ for test: kms_frontbuffer_tracking results: parsing output: 71/ for test: kms_frontbuffer_tracking results: parsing output: 72/ for test: kms_ccs results: parsing output: 73/ for test: gem_exec_fence results: parsing output: 74/ for test: gem_exec_reloc results: parsing output: 75/ for test: kms_flip results: parsing output: 76/ for test: kms_vblank results: parsing output: 77/ for test: kms_chamelium_frames results: parsing output: 78/ for test: kms_ccs results: parsing output: 79/ for test: kms_frontbuffer_tracking results: parsing output: 80/ for test: kms_big_fb results: parsing output: 81/ for test: gen7_exec_parse results: parsing output: 82/ for test: kms_atomic_transition results: parsing output: 83/ for test: kms_draw_crc results: parsing output: 84/ for test: kms_ccs results: parsing output: 85/ for test: gem_exec_schedule results: parsing output: 86/ for test: gem_exec_fence results: parsing output: 87/ for test: kms_rotation_crc results: parsing output: 88/ for test: kms_cursor_crc results: parsing output: 89/ for test: kms_big_fb results: parsing output: 90/ for test: gem_exec_whisper results: parsing output: 91/ for test: gem_exec_reloc results: parsing output: 92/ for test: kms_plane_lowres results: parsing output: 93/ for test: kms_frontbuffer_tracking results: parsing output: 94/ for test: kms_frontbuffer_tracking results: parsing output: 95/ for test: gem_ctx_create results: parsing output: 96/ for test: kms_flip_scaled_crc results: parsing output: 97/ for test: gem_pwrite results: parsing output: 98/ for test: kms_atomic_transition results: parsing output: 99/ for test: kms_color_pipeline results: parsing output: 100/ for test: gem_lmem_swapping results: parsing output: 101/ for test: kms_frontbuffer_tracking results: parsing output: 102/ for test: sw_sync results: parsing output: 103/ for test: syncobj_timeline results: parsing output: 104/ for test: gem_mmap_gtt results: parsing output: 105/ for test: gem_exec_balancer results: parsing output: 106/ for test: kms_big_fb results: parsing output: 107/ for test: gem_render_linear_blits results: parsing output: 108/ for test: gem_ctx_shared results: parsing output: 109/ for test: kms_frontbuffer_tracking results: parsing output: 110/ for test: syncobj_timeline results: parsing output: 111/ for test: gem_flink_basic results: parsing output: 112/ for test: kms_ccs results: parsing output: 113/ for test: kms_frontbuffer_tracking results: parsing output: 114/ for test: kms_hdr results: parsing output: 115/ for test: kms_chamelium_hpd results: parsing output: 116/ for test: kms_rotation_crc results: parsing output: 117/ for test: prime_vgem results: parsing output: 118/ for test: gem_ctx_freq results: parsing output: 119/ for test: kms_cursor_crc results: parsing output: 120/ for test: kms_frontbuffer_tracking results: parsing output: 121/ for test: perf results: parsing output: 122/ for test: kms_setmode results: parsing output: 123/ for test: kms_big_fb results: parsing output: 124/ for test: kms_atomic_transition results: parsing output: 125/ for test: kms_atomic_interruptible results: parsing output: 126/ for test: kms_pm_backlight results: parsing output: 127/ for test: perf_pmu results: parsing output: 128/ for test: kms_frontbuffer_tracking results: parsing output: 129/ for test: gem_exec_whisper results: parsing output: 130/ for test: gem_spin_batch results: parsing output: 131/ for test: kms_universal_plane results: parsing output: 132/ for test: gem_exec_schedule results: parsing output: 133/ for test: syncobj_wait Done.