[157.156121] Initializing watchdogs
[157.156170]   /dev/watchdog0
[157.171665] [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]
[157.176280] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[157.178802] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[157.180775] [001/156] (960s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[157.361510] Starting subtest: cursor-rapid-movement-32x10
[157.412811] Subtest cursor-rapid-movement-32x10: SKIP (0.048s)
[157.670838] [002/156] (960s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-signa
[157.717449] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-signaled
[157.836121] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-signaled: SUCCESS (0.109s)
[157.892628] [003/156] (959s left) gem_exec_basic (basic)
[157.944846] Starting subtest: basic
[157.945851] Starting dynamic subtest: rcs0-smem
[157.947731] Dynamic subtest rcs0-smem: SUCCESS (0.003s)
[157.954374] Starting dynamic subtest: bcs0-smem
[157.955406] Dynamic subtest bcs0-smem: SUCCESS (0.001s)
[157.961965] Starting dynamic subtest: vcs0-smem
[157.962979] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[157.969111] Starting dynamic subtest: vcs1-smem
[157.970053] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[157.976056] Starting dynamic subtest: vecs0-smem
[157.976965] Dynamic subtest vecs0-smem: SUCCESS (0.001s)
[157.983133] Starting dynamic subtest: ccs0-smem
[157.984018] Dynamic subtest ccs0-smem: SUCCESS (0.002s)
[157.984942] Subtest basic: SUCCESS (0.011s)
[159.370495] [004/156] (958s left) kms_plane_scaling (planes-downscale-factor-0-5-unity-scaling)
[159.459608] Starting subtest: planes-downscale-factor-0-5-unity-scaling
[159.460570] Starting dynamic subtest: pipe-A
[159.479473] Dynamic subtest pipe-A: SKIP (0.019s)
[159.486303] Starting dynamic subtest: pipe-B
[159.516421] Dynamic subtest pipe-B: SKIP (0.036s)
[159.523348] Starting dynamic subtest: pipe-C
[159.550937] Dynamic subtest pipe-C: SKIP (0.035s)
[159.557284] Starting dynamic subtest: pipe-D
[159.585658] Dynamic subtest pipe-D: SKIP (0.035s)
[159.587355] Subtest planes-downscale-factor-0-5-unity-scaling: SKIP (0.126s)
[159.680220] [005/156] (958s left) kms_prop_blob (invalid-get-prop)
[159.738568] Starting subtest: invalid-get-prop
[159.739581] Subtest invalid-get-prop: SUCCESS (0.000s)
[159.824777] [006/156] (958s left) drm_read (short-buffer-wakeup)
[160.002766] Starting subtest: short-buffer-wakeup
[192.228879] Subtest short-buffer-wakeup: SUCCESS (32.215s)
[192.355708] [007/156] (925s left) gem_ctx_freq (sysfs)
[192.421708] Starting subtest: sysfs
[192.422770] Starting dynamic subtest: gt0
[197.915192] Dynamic subtest gt0: SUCCESS (5.492s)
[197.926477] Starting dynamic subtest: gt1
[239.333943] Dynamic subtest gt1: SUCCESS (41.407s)
[239.335168] Subtest sysfs: SUCCESS (46.901s)
[239.439409] [008/156] (878s left) i915_pm_rc6_residency (rc6-fence)
[239.492354] Starting subtest: rc6-fence
[239.507370] Starting dynamic subtest: gt0
[251.839644] Dynamic subtest gt0: SUCCESS (12.321s)
[251.851612] Starting dynamic subtest: gt1
[266.342490] Dynamic subtest gt1: SUCCESS (14.502s)
[266.343582] Subtest rc6-fence: SUCCESS (26.841s)
[266.402903] [009/156] (851s left) gem_softpin (overlap)
[266.454038] Starting subtest: overlap
[267.419315] Subtest overlap: SUCCESS (0.957s)
[267.546359] [010/156] (850s left) kms_pipe_stress (stress-xrgb8888-xtiled)
[267.640170] Starting subtest: stress-xrgb8888-xtiled
[273.508179] Subtest stress-xrgb8888-xtiled: SUCCESS (5.868s)
[273.554301] [011/156] (844s left) gem_exec_reloc (basic-cpu-wc-active)
[273.601731] Subtest basic-cpu-wc-active: SKIP (0.000s)
[273.661947] [012/156] (844s left) kms_big_fb (4-tiled-8bpp-rotate-180)
[273.753781] Starting subtest: 4-tiled-8bpp-rotate-180
[274.967489] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (1.214s)
[275.071919] [013/156] (842s left) kms_chamelium_edid (dp-mode-timings)
[276.224894] Subtest dp-mode-timings: SKIP (0.000s)
[276.537424] [014/156] (841s left) gem_partial_pwrite_pread (writes-after-reads-uncached)
[276.593072] Subtest writes-after-reads-uncached: SKIP (0.000s)
[276.649937] [015/156] (841s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-exceed-fully-sf)
[276.739731] Starting subtest: fbc-pr-overlay-plane-move-continuous-exceed-fully-sf
[276.741614] Subtest fbc-pr-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[276.810927] [016/156] (841s left) kms_setmode (invalid-clone-single-crtc)
[276.863514] Starting subtest: invalid-clone-single-crtc
[276.866761] Subtest invalid-clone-single-crtc: SKIP (0.000s)
[276.975293] [017/156] (841s left) kms_psr (psr2-cursor-blt)
[277.064142] Starting subtest: psr2-cursor-blt
[277.064977] Starting dynamic subtest: eDP-1
[278.754961] Dynamic subtest eDP-1: SUCCESS (1.691s)
[278.756085] Subtest psr2-cursor-blt: SUCCESS (1.691s)
[279.636316] [018/156] (838s left) sriov_basic (enable-vfs-autoprobe-on)
[279.691535] Starting subtest: enable-vfs-autoprobe-on
[279.692631] Starting dynamic subtest: numvfs-1
[279.695463] Dynamic subtest numvfs-1: SKIP (0.001s)
[279.705998] Starting dynamic subtest: numvfs-2
[279.707905] Dynamic subtest numvfs-2: SKIP (0.001s)
[279.715441] Starting dynamic subtest: numvfs-3
[279.717223] Dynamic subtest numvfs-3: SKIP (0.001s)
[279.724040] Starting dynamic subtest: numvfs-4
[279.725729] Dynamic subtest numvfs-4: SKIP (0.001s)
[279.732525] Starting dynamic subtest: numvfs-5
[279.734073] Dynamic subtest numvfs-5: SKIP (0.001s)
[279.740947] Starting dynamic subtest: numvfs-6
[279.743054] Dynamic subtest numvfs-6: SKIP (0.001s)
[279.749632] Starting dynamic subtest: numvfs-7
[279.751422] Dynamic subtest numvfs-7: SKIP (0.001s)
[279.758394] Starting dynamic subtest: numvfs-random
[279.760288] Dynamic subtest numvfs-random: SKIP (0.001s)
[279.766913] Starting dynamic subtest: numvfs-all
[279.768677] Dynamic subtest numvfs-all: SKIP (0.001s)
[279.770439] Subtest enable-vfs-autoprobe-on: SKIP (0.008s)
[279.803668] [019/156] (838s left) kms_chamelium_hpd (vga-hpd-without-ddc)
[280.191522] Subtest vga-hpd-without-ddc: SKIP (0.000s)
[281.041629] [020/156] (837s left) kms_psr (fbc-pr-cursor-plane-move)
[281.132447] Starting subtest: fbc-pr-cursor-plane-move
[281.134285] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s)
[281.211280] [021/156] (837s left) kms_frontbuffer_tracking (fbchdr-1p-pri-indfb-multidraw)
[281.297819] Starting subtest: fbchdr-1p-pri-indfb-multidraw
[281.299665] Subtest fbchdr-1p-pri-indfb-multidraw: SKIP (0.000s)
[281.384068] [022/156] (836s left) gem_workarounds (basic-read)
[281.449633] Starting subtest: basic-read
[281.459937] Subtest basic-read: SUCCESS (0.010s)
[281.580014] [023/156] (836s left) kms_sequence (get-busy)
[281.673457] Starting subtest: get-busy
[281.674452] Starting dynamic subtest: pipe-A-eDP-1
[283.610459] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.936s)
[283.619444] Starting dynamic subtest: pipe-B-eDP-1
[286.281746] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.670s)
[286.289119] Starting dynamic subtest: pipe-C-eDP-1
[288.892867] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.611s)
[288.901204] Starting dynamic subtest: pipe-D-eDP-1
[291.523684] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.629s)
[291.524581] Subtest get-busy: SUCCESS (9.850s)
[292.395141] [024/156] (826s left) kms_busy (extended-pageflip-hang-newfb)
[292.485345] Starting subtest: extended-pageflip-hang-newfb
[292.486178] Starting dynamic subtest: pipe-A
[320.126062] Dynamic subtest pipe-A: SUCCESS (27.639s)
[320.134904] Starting dynamic subtest: pipe-D
[345.073398] Dynamic subtest pipe-D: SUCCESS (24.944s)
[345.075459] Subtest extended-pageflip-hang-newfb: SUCCESS (52.588s)
[345.966658] [025/156] (772s left) sysfs_heartbeat_interval (mixed)
[346.018474] Starting subtest: mixed
[346.019528] Starting dynamic subtest: vecs0
[351.246850] Dynamic subtest vecs0: SUCCESS (5.228s)
[351.258687] Starting dynamic subtest: ccs0
[356.444689] Dynamic subtest ccs0: SUCCESS (5.196s)
[356.454834] Starting dynamic subtest: vcs0
[361.632886] Dynamic subtest vcs0: SUCCESS (5.187s)
[361.644497] Starting dynamic subtest: bcs0
[366.832618] Dynamic subtest bcs0: SUCCESS (5.198s)
[366.848337] Starting dynamic subtest: rcs0
[372.029739] Dynamic subtest rcs0: SUCCESS (5.196s)
[372.039096] Starting dynamic subtest: vcs1
[377.268914] Dynamic subtest vcs1: SUCCESS (5.239s)
[377.270625] Subtest mixed: SUCCESS (31.250s)
[377.338284] [026/156] (741s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[377.443844] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt
[377.445592] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[377.537762] [027/156] (740s left) kms_psr (fbc-psr-sprite-blt)
[377.619135] Starting subtest: fbc-psr-sprite-blt
[377.620029] Starting dynamic subtest: eDP-1
[377.621834] Dynamic subtest eDP-1: SKIP (0.000s)
[377.623404] Subtest fbc-psr-sprite-blt: SKIP (0.001s)
[377.685791] [028/156] (740s left) kms_cursor_crc (cursor-onscreen-64x21)
[377.863199] Starting subtest: cursor-onscreen-64x21
[377.905561] Subtest cursor-onscreen-64x21: SKIP (0.042s)
[378.109611] [029/156] (740s left) kms_pm_rpm (dpms-non-lpsp)
[379.637232] Starting subtest: dpms-non-lpsp
[379.640384] Subtest dpms-non-lpsp: SKIP (0.001s)
[380.406283] [030/156] (738s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[380.491837] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[380.493643] Subtest fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[380.570155] [031/156] (738s left) gem_eio (wait-10ms)
[380.791030] Starting subtest: wait-10ms
[381.139391] Subtest wait-10ms: SUCCESS (0.349s)
[381.283881] [032/156] (737s left) syncobj_timeline (invalid-query-bad-pad)
[381.335195] Starting subtest: invalid-query-bad-pad
[381.336212] Subtest invalid-query-bad-pad: SUCCESS (0.000s)
[381.422731] [033/156] (737s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0)
[381.520046] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0
[381.521804] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[381.614385] [034/156] (737s left) kms_frontbuffer_tracking (psrhdr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[381.698571] Starting subtest: psrhdr-1p-offscreen-pri-indfb-draw-mmap-gtt
[381.700409] Subtest psrhdr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[381.784593] [035/156] (736s left) kms_frontbuffer_tracking (fbchdr-tiling-linear)
[381.866246] Starting subtest: fbchdr-tiling-linear
[381.868029] Subtest fbchdr-tiling-linear: SKIP (0.000s)
[381.960512] [036/156] (736s left) gem_exec_balancer (indices)
[382.024219] Starting subtest: indices
[383.300770] Subtest indices: SUCCESS (1.267s)
[383.600371] [037/156] (735s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs)
[383.696141] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs
[383.697058] Starting dynamic subtest: pipe-A-eDP-1
[383.705762] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[383.713824] Starting dynamic subtest: pipe-B-eDP-1
[383.722063] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[383.729365] Starting dynamic subtest: pipe-C-eDP-1
[383.737303] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[383.744689] Starting dynamic subtest: pipe-D-eDP-1
[383.752629] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[383.754394] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[385.971116] [038/156] (732s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-spr-indfb-onoff)
[386.068796] Starting subtest: fbcpsrhdr-1p-primscrn-spr-indfb-onoff
[386.070765] Subtest fbcpsrhdr-1p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[386.167821] [039/156] (732s left) gem_exec_schedule (u-submit-golden-slice)
[386.233138] Starting subtest: u-submit-golden-slice
[386.234216] Starting dynamic subtest: rcs0
[386.270164] Dynamic subtest rcs0: SUCCESS (0.037s)
[386.278738] Starting dynamic subtest: bcs0
[386.303627] Dynamic subtest bcs0: SUCCESS (0.033s)
[386.311905] Starting dynamic subtest: vcs0
[386.334056] Dynamic subtest vcs0: SUCCESS (0.030s)
[386.343615] Starting dynamic subtest: vcs1
[386.370340] Dynamic subtest vcs1: SUCCESS (0.036s)
[386.382499] Starting dynamic subtest: vecs0
[386.402545] Dynamic subtest vecs0: SUCCESS (0.031s)
[386.411088] Starting dynamic subtest: ccs0
[386.435949] Dynamic subtest ccs0: SUCCESS (0.033s)
[386.436718] Subtest u-submit-golden-slice: SUCCESS (0.203s)
[388.406740] [040/156] (730s left) kms_chamelium_color (ctm-max)
[388.498650] Subtest ctm-max: SKIP (0.000s)
[388.535106] [041/156] (730s left) i915_drm_fdinfo (virtual-busy-hang-all)
[388.568143] Starting subtest: virtual-busy-hang-all
[388.569863] Subtest virtual-busy-hang-all: SKIP (0.000s)
[388.632494] [042/156] (730s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-blt)
[388.721335] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-blt
[388.722968] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[388.812851] [043/156] (730s left) kms_frontbuffer_tracking (basic)
[388.908767] Starting subtest: basic
[392.388306] Subtest basic: SUCCESS (3.482s)
[392.504435] [044/156] (726s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[392.606389] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[392.608342] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[392.699797] [045/156] (726s left) gem_exec_schedule (pi-common)
[392.887462] Starting subtest: pi-common
[392.888788] Starting dynamic subtest: rcs0
[392.964903] Dynamic subtest rcs0: SUCCESS (0.084s)
[392.977672] Starting dynamic subtest: bcs0
[392.992067] Dynamic subtest bcs0: SUCCESS (0.026s)
[393.004854] Starting dynamic subtest: vcs0
[393.018269] Dynamic subtest vcs0: SUCCESS (0.026s)
[393.030590] Starting dynamic subtest: vcs1
[393.044716] Dynamic subtest vcs1: SUCCESS (0.026s)
[393.057603] Starting dynamic subtest: vecs0
[393.070816] Dynamic subtest vecs0: SUCCESS (0.025s)
[393.083901] Starting dynamic subtest: ccs0
[393.095772] Dynamic subtest ccs0: SUCCESS (0.024s)
[393.096629] Subtest pi-common: SUCCESS (0.216s)
[393.330148] [FACT gem_exec_schedule (pi-common)] new: kernel.kmod_is_loaded.vgem: true
[393.331736] [046/156] (725s left) gem_exec_reloc (basic-write-wc)
[393.379192] Subtest basic-write-wc: SKIP (0.000s)
[393.448110] [047/156] (725s left) kms_frontbuffer_tracking (hdr-1p-offscreen-pri-shrfb-draw-render)
[393.546281] Starting subtest: hdr-1p-offscreen-pri-shrfb-draw-render
[393.547828] Subtest hdr-1p-offscreen-pri-shrfb-draw-render: SKIP (0.000s)
[393.644774] [048/156] (725s left) kms_invalid_mode (bad-hsync-start)
[393.726817] Starting subtest: bad-hsync-start
[393.727774] Starting dynamic subtest: pipe-A-eDP-1
[394.023936] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.298s)
[394.032376] Starting dynamic subtest: pipe-B-eDP-1
[394.033302] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[394.040810] Starting dynamic subtest: pipe-C-eDP-1
[394.041717] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[394.049243] Starting dynamic subtest: pipe-D-eDP-1
[394.050156] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[394.050999] Subtest bad-hsync-start: SUCCESS (0.303s)
[394.912112] [049/156] (724s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[395.011458] Starting subtest: fbchdr-2p-primscrn-pri-indfb-draw-mmap-gtt
[395.013134] Subtest fbchdr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[395.113412] [050/156] (724s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-gtt)
[395.199571] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-gtt
[395.201465] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[395.284391] [051/156] (724s left) gem_madvise (dontneed-before-exec)
[395.312818] Starting subtest: dontneed-before-exec
[395.330568] Subtest dontneed-before-exec: SKIP (0.017s)
[395.389699] [052/156] (723s left) kms_psr (fbc-psr2-sprite-plane-move)
[395.478224] Starting subtest: fbc-psr2-sprite-plane-move
[395.479815] Starting dynamic subtest: eDP-1
[395.482198] Dynamic subtest eDP-1: SKIP (0.000s)
[395.484355] Subtest fbc-psr2-sprite-plane-move: SKIP (0.001s)
[395.558782] [053/156] (723s left) i915_hangman (engine-engine-error)
[395.615862] Starting subtest: engine-engine-error
[395.616922] Starting dynamic subtest: rcs0
[397.317944] Dynamic subtest rcs0: SUCCESS (1.693s)
[397.328479] Starting dynamic subtest: bcs0
[399.301837] Dynamic subtest bcs0: SUCCESS (1.981s)
[399.313882] Starting dynamic subtest: vcs0
[401.286981] Dynamic subtest vcs0: SUCCESS (1.983s)
[401.298240] Starting dynamic subtest: vcs1
[403.333655] Dynamic subtest vcs1: SUCCESS (2.044s)
[403.345563] Starting dynamic subtest: vecs0
[405.316050] Dynamic subtest vecs0: SUCCESS (1.981s)
[405.330143] Starting dynamic subtest: ccs0
[407.301901] Dynamic subtest ccs0: SUCCESS (1.984s)
[407.303443] Subtest engine-engine-error: SUCCESS (11.678s)
[407.439039] [054/156] (711s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-mc-ccs)
[407.484816] Starting subtest: y-tiled-ccs-to-yf-tiled-mc-ccs
[407.486596] Subtest y-tiled-ccs-to-yf-tiled-mc-ccs: SKIP (0.000s)
[407.664326] [055/156] (711s left) gem_exec_create (forked)
[407.736940] Starting subtest: forked
[407.738058] Starting dynamic subtest: smem
[427.925680] Dynamic subtest smem: SUCCESS (20.188s)
[427.926942] Subtest forked: SUCCESS (20.189s)
[428.121434] [056/156] (691s left) perf_pmu (render-node-busy-idle)
[428.187884] Starting subtest: render-node-busy-idle
[428.189364] Starting dynamic subtest: rcs0
[428.885468] Dynamic subtest rcs0: SUCCESS (0.697s)
[428.896981] Starting dynamic subtest: bcs0
[429.560459] Dynamic subtest bcs0: SUCCESS (0.673s)
[429.572043] Starting dynamic subtest: vcs0
[431.334774] Dynamic subtest vcs0: SUCCESS (1.763s)
[431.346068] Starting dynamic subtest: vcs1
[433.318891] Dynamic subtest vcs1: SUCCESS (1.982s)
[433.330564] Starting dynamic subtest: vecs0
[435.365975] Dynamic subtest vecs0: SUCCESS (2.045s)
[435.376220] Starting dynamic subtest: ccs0
[436.032349] Dynamic subtest ccs0: SUCCESS (0.673s)
[436.033658] Subtest render-node-busy-idle: SUCCESS (7.845s)
[436.110118] [057/156] (683s left) syncobj_wait (wait-any-complex)
[436.154643] Starting subtest: wait-any-complex
[436.218379] Subtest wait-any-complex: SUCCESS (0.063s)
[436.309801] [058/156] (683s left) core_getstats (basic)
[436.361584] Starting subtest: basic
[436.362917] Subtest basic: SUCCESS (0.000s)
[436.451418] [059/156] (683s left) gem_mmap_gtt (close-race)
[436.495053] Subtest close-race: SKIP (0.000s)
[436.554776] [060/156] (683s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-spr-indfb-onoff)
[436.646421] Starting subtest: psrhdr-1p-primscrn-spr-indfb-onoff
[436.648200] Subtest psrhdr-1p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[436.748960] [061/156] (682s left) gem_exec_flush (basic-wb-prw-default)
[436.802912] Starting subtest: basic-wb-prw-default
[442.266034] Subtest basic-wb-prw-default: SUCCESS (5.463s)
[442.462345] [062/156] (677s left) i915_pm_rps (thresholds-idle)
[442.524706] Starting subtest: thresholds-idle
[442.526768] Subtest thresholds-idle: SKIP (0.001s)
[442.625431] [063/156] (677s left) kms_lease (atomic-implicit-crtc)
[442.718177] Starting subtest: atomic-implicit-crtc
[442.719098] Starting dynamic subtest: pipe-A-eDP-1
[442.724335] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[442.736771] Starting dynamic subtest: pipe-B-eDP-1
[442.740897] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.010s)
[442.749024] Starting dynamic subtest: pipe-C-eDP-1
[442.753770] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.010s)
[442.761747] Starting dynamic subtest: pipe-D-eDP-1
[442.766171] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.010s)
[442.767037] Subtest atomic-implicit-crtc: SUCCESS (0.035s)
[442.876710] [064/156] (676s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-downscaling)
[442.955168] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-downscaling
[442.956069] Starting dynamic subtest: pipe-A-default-mode
[444.090512] Dynamic subtest pipe-A-default-mode: SKIP (1.133s)
[444.092436] Subtest flip-64bpp-xtile-to-32bpp-xtile-downscaling: SKIP (1.134s)
[444.234226] [065/156] (675s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-render)
[444.334220] Starting subtest: fbcpsr-rgb101010-draw-render
[449.335677] Subtest fbcpsr-rgb101010-draw-render: SUCCESS (5.002s)
[449.455608] [066/156] (670s left) syncobj_timeline (invalid-signal-zero-handles)
[449.502639] Starting subtest: invalid-signal-zero-handles
[449.503687] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[449.610837] [067/156] (670s left) kms_flip (blocking-absolute-wf_vblank-interruptible)
[449.700441] Starting subtest: blocking-absolute-wf_vblank-interruptible
[449.702714] Starting dynamic subtest: A-eDP1
[458.478061] Dynamic subtest A-eDP1: SUCCESS (8.750s)
[458.488893] Starting dynamic subtest: B-eDP1
[467.204534] Dynamic subtest B-eDP1: SUCCESS (8.725s)
[467.213904] Starting dynamic subtest: C-eDP1
[475.932991] Dynamic subtest C-eDP1: SUCCESS (8.714s)
[475.943832] Starting dynamic subtest: D-eDP1
[484.659613] Dynamic subtest D-eDP1: SUCCESS (8.723s)
[484.661162] Subtest blocking-absolute-wf_vblank-interruptible: SUCCESS (34.921s)
[485.825841] [068/156] (634s left) gen9_exec_parse (basic-rejected)
[485.882315] Subtest basic-rejected: SKIP (0.000s)
[485.943972] [069/156] (633s left) gem_mmap_gtt (big-copy-odd)
[485.996906] Subtest big-copy-odd: SKIP (0.000s)
[486.047676] [070/156] (633s left) syncobj_wait (wait-for-submit-complex)
[486.095956] Starting subtest: wait-for-submit-complex
[486.158353] Subtest wait-for-submit-complex: SUCCESS (0.062s)
[486.228886] [071/156] (633s left) kms_dither (fb-8bpc-vs-panel-8bpc)
[486.311582] Starting subtest: fb-8bpc-vs-panel-8bpc
[486.312592] Starting dynamic subtest: pipe-A-eDP-1
[487.726945] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.415s)
[487.727782] Subtest fb-8bpc-vs-panel-8bpc: SUCCESS (1.416s)
[488.591411] [072/156] (631s left) kms_big_fb (x-tiled-64bpp-rotate-90)
[488.689506] Starting subtest: x-tiled-64bpp-rotate-90
[488.709352] Subtest x-tiled-64bpp-rotate-90: SKIP (0.019s)
[488.807808] [073/156] (631s left) gem_eio (in-flight-1us)
[489.035019] Starting subtest: in-flight-1us
[497.067800] Subtest in-flight-1us: SUCCESS (8.032s)
[497.183403] [074/156] (622s left) kms_flip (flip-vs-dpms-on-nop)
[497.262824] Starting subtest: flip-vs-dpms-on-nop
[497.265484] Starting dynamic subtest: A-eDP1
[499.192200] Dynamic subtest A-eDP1: SUCCESS (1.927s)
[499.205381] Starting dynamic subtest: B-eDP1
[501.020412] Dynamic subtest B-eDP1: SUCCESS (1.827s)
[501.031734] Starting dynamic subtest: C-eDP1
[502.844741] Dynamic subtest C-eDP1: SUCCESS (1.821s)
[502.854618] Starting dynamic subtest: D-eDP1
[504.690326] Dynamic subtest D-eDP1: SUCCESS (1.842s)
[504.691537] Subtest flip-vs-dpms-on-nop: SUCCESS (7.428s)
[505.861210] [075/156] (614s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs)
[505.943770] Starting subtest: crc-sprite-planes-basic-4-tiled-bmg-ccs
[505.945416] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[507.091984] [076/156] (613s left) kms_big_fb (y-tiled-32bpp-rotate-0)
[507.184410] Starting subtest: y-tiled-32bpp-rotate-0
[507.186364] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s)
[507.275805] [077/156] (612s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[507.369509] Starting subtest: plane-upscale-20x20-with-rotation
[507.370406] Starting dynamic subtest: pipe-A
[507.595100] Dynamic subtest pipe-A: SUCCESS (0.227s)
[507.603818] Starting dynamic subtest: pipe-B
[508.879235] Dynamic subtest pipe-B: SUCCESS (1.283s)
[508.887487] Starting dynamic subtest: pipe-C
[510.212832] Dynamic subtest pipe-C: SUCCESS (1.333s)
[510.221374] Starting dynamic subtest: pipe-D
[511.546911] Dynamic subtest pipe-D: SUCCESS (1.333s)
[511.548044] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.179s)
[512.740390] [078/156] (607s left) kms_frontbuffer_tracking (hdr-1p-primscrn-spr-indfb-fullscreen)
[512.828397] Starting subtest: hdr-1p-primscrn-spr-indfb-fullscreen
[512.830151] Subtest hdr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[512.915966] [079/156] (607s left) gem_flink_basic (basic)
[512.960530] Starting subtest: basic
[512.961643] Subtest basic: SUCCESS (0.000s)
[513.054601] [080/156] (607s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted-signaled)
[513.097289] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[513.098449] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[513.202666] [081/156] (607s left) gem_create (create-massive)
[513.244544] Starting subtest: create-massive
[513.245493] Subtest create-massive: SUCCESS (0.000s)
[513.439378] [082/156] (606s left) kms_async_flips (async-flip-dpms)
[513.522688] Starting subtest: async-flip-dpms
[513.894974] Starting dynamic subtest: pipe-A-eDP-1
[517.832552] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.937s)
[518.201393] Starting dynamic subtest: pipe-B-eDP-1
[521.095485] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.901s)
[521.486358] Starting dynamic subtest: pipe-C-eDP-1
[524.359653] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.880s)
[524.746559] Starting dynamic subtest: pipe-D-eDP-1
[527.629298] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.890s)
[527.630186] Subtest async-flip-dpms: SUCCESS (14.108s)
[528.809665] [083/156] (591s left) kms_rotation_crc (primary-x-tiled-reflect-x-180)
[528.904332] Starting subtest: primary-x-tiled-reflect-x-180
[535.858481] Subtest primary-x-tiled-reflect-x-180: SUCCESS (6.954s)
[537.096171] [084/156] (583s left) gem_exec_fence (syncobj-import)
[537.536063] Starting subtest: syncobj-import
[537.542374] Subtest syncobj-import: SUCCESS (0.007s)
[538.407257] [085/156] (582s left) gem_mmap_offset (open-flood)
[538.455769] Starting subtest: open-flood
[559.946585] Subtest open-flood: SUCCESS (21.489s)
[560.048793] [086/156] (560s left) gem_ctx_sseu (mmap-args)
[560.108178] Subtest mmap-args: SKIP (0.000s)
[560.174324] [087/156] (560s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-wc)
[560.270222] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-wc
[560.271997] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[560.363388] [088/156] (560s left) perf (create-destroy-userspace-config)
[560.487825] Starting subtest: create-destroy-userspace-config
[560.507668] Subtest create-destroy-userspace-config: SUCCESS (0.020s)
[560.551833] [089/156] (560s left) kms_psr (psr2-sprite-render)
[560.636633] Starting subtest: psr2-sprite-render
[560.637602] Starting dynamic subtest: eDP-1
[562.401499] Dynamic subtest eDP-1: SUCCESS (1.763s)
[562.402933] Subtest psr2-sprite-render: SUCCESS (1.764s)
[563.281116] [090/156] (557s left) syncobj_basic (bad-pad-fd-to-handle)
[563.332600] Starting subtest: bad-pad-fd-to-handle
[563.333712] Subtest bad-pad-fd-to-handle: SUCCESS (0.000s)
[563.418562] [091/156] (557s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc)
[563.504278] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc
[563.505124] Starting dynamic subtest: pipe-A-eDP-1
[563.513398] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[563.522072] Starting dynamic subtest: pipe-B-eDP-1
[563.530393] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[563.538956] Starting dynamic subtest: pipe-C-eDP-1
[563.547040] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[563.555377] Starting dynamic subtest: pipe-D-eDP-1
[563.563219] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[563.564796] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[565.764012] [092/156] (554s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-spr-indfb-onoff)
[565.864075] Starting subtest: hdr-2p-scndscrn-spr-indfb-onoff
[565.865866] Subtest hdr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[565.941107] [093/156] (554s left) kms_lease (lease-uevent)
[566.030221] Starting subtest: lease-uevent
[567.048404] Subtest lease-uevent: SUCCESS (1.018s)
[567.157329] [094/156] (553s left) kms_content_protection (dp-mst-type-0-hdcp14)
[567.288722] Starting subtest: dp-mst-type-0-hdcp14
[567.290615] Subtest dp-mst-type-0-hdcp14: SKIP (0.000s)
[567.413649] [095/156] (553s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[567.507541] Starting subtest: hdr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[567.509197] Subtest hdr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[567.632224] [096/156] (553s left) kms_frontbuffer_tracking (psr-2p-rte)
[567.729490] Starting subtest: psr-2p-rte
[567.731508] Subtest psr-2p-rte: SKIP (0.000s)
[567.821617] [097/156] (553s left) gem_exec_params (mmapped)
[567.871288] Starting subtest: mmapped
[567.873062] Subtest mmapped: SUCCESS (0.003s)
[567.989515] [098/156] (552s left) syncobj_wait (single-wait-submitted)
[568.042578] Starting subtest: single-wait-submitted
[568.147073] Subtest single-wait-submitted: SUCCESS (0.104s)
[568.232105] [099/156] (552s left) gem_mmap_gtt (basic-small-copy-xy)
[568.288517] Subtest basic-small-copy-XY: SKIP (0.000s)
[568.341273] [100/156] (552s left) gem_eio (wait-wedge-10ms)
[568.560168] Starting subtest: wait-wedge-10ms
[570.478677] Subtest wait-wedge-10ms: SUCCESS (1.919s)
[570.609132] [101/156] (550s left) syncobj_timeline (wait-all-delayed-signal)
[570.665102] Starting subtest: wait-all-delayed-signal
[570.767894] Subtest wait-all-delayed-signal: SUCCESS (0.102s)
[570.843823] [102/156] (550s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-plflip-blt)
[570.939391] Starting subtest: psr-2p-primscrn-indfb-plflip-blt
[570.941230] Subtest psr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[571.039342] [103/156] (550s left) gem_eio (wait-wedge-immediate)
[571.254863] Starting subtest: wait-wedge-immediate
[572.397354] Subtest wait-wedge-immediate: SUCCESS (1.145s)
[572.532580] [104/156] (548s left) kms_plane (pixel-format-4-tiled-lnl-ccs-modifier-source-clamping)
[572.620088] Starting subtest: pixel-format-4-tiled-lnl-ccs-modifier-source-clamping
[572.621911] Subtest pixel-format-4-tiled-lnl-ccs-modifier-source-clamping: SKIP (0.000s)
[572.689881] [105/156] (548s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-shrfb-draw-blt)
[572.779702] Starting subtest: fbcpsrhdr-1p-offscreen-pri-shrfb-draw-blt
[572.781370] Subtest fbcpsrhdr-1p-offscreen-pri-shrfb-draw-blt: SKIP (0.000s)
[572.883323] [106/156] (548s left) kms_vrr (negative-basic)
[572.975662] Starting subtest: negative-basic
[572.978437] Starting dynamic subtest: pipe-A-eDP-1
[578.439688] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.414s)
[578.714269] Subtest negative-basic: SUCCESS (5.739s)
[579.593320] [107/156] (541s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[579.696209] Starting subtest: fbcpsrhdr-2p-primscrn-pri-shrfb-draw-mmap-wc
[579.697821] Subtest fbcpsrhdr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[579.779099] [108/156] (541s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-cur-indfb-draw-blt)
[579.866087] Starting subtest: psrhdr-2p-scndscrn-cur-indfb-draw-blt
[579.867808] Subtest psrhdr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[579.966568] [109/156] (541s left) kms_flip (2x-flip-vs-rmfb-interruptible)
[580.052687] Starting subtest: 2x-flip-vs-rmfb-interruptible
[580.065133] Subtest 2x-flip-vs-rmfb-interruptible: SKIP (0.012s)
[580.158653] [110/156] (541s left) gen3_render_linear_blits
[580.256913] [111/156] (541s left) gem_busy (busy)
[580.308848] Starting subtest: busy
[580.309965] Starting dynamic subtest: all-engines
[580.364660] Dynamic subtest all-engines: SUCCESS (0.056s)
[580.375812] Starting dynamic subtest: rcs0
[582.316216] Dynamic subtest rcs0: SUCCESS (1.943s)
[582.326193] Starting dynamic subtest: bcs0
[582.349088] Dynamic subtest bcs0: SUCCESS (0.038s)
[582.358613] Starting dynamic subtest: vcs0
[582.388620] Dynamic subtest vcs0: SUCCESS (0.038s)
[582.397056] Starting dynamic subtest: vcs1
[584.364847] Dynamic subtest vcs1: SUCCESS (1.965s)
[584.375371] Starting dynamic subtest: vecs0
[586.347794] Dynamic subtest vecs0: SUCCESS (1.979s)
[586.357502] Starting dynamic subtest: ccs0
[588.332420] Dynamic subtest ccs0: SUCCESS (1.983s)
[588.333572] Subtest busy: SUCCESS (8.013s)
[588.678922] [112/156] (532s left) kms_frontbuffer_tracking (hdr-2p-primscrn-pri-shrfb-draw-render)
[588.781947] Starting subtest: hdr-2p-primscrn-pri-shrfb-draw-render
[588.783624] Subtest hdr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[588.878300] [113/156] (532s left) kms_draw_crc (draw-method-mmap-wc)
[588.969066] Starting subtest: draw-method-mmap-wc
[588.970150] Starting dynamic subtest: xrgb8888-untiled
[589.201037] Dynamic subtest xrgb8888-untiled: SUCCESS (0.233s)
[589.211264] Starting dynamic subtest: rgb565-untiled
[589.445966] Dynamic subtest rgb565-untiled: SUCCESS (0.243s)
[589.458118] Starting dynamic subtest: xrgb2101010-untiled
[589.656726] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.209s)
[589.666521] Starting dynamic subtest: xbgr16161616f-untiled
[589.867999] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.209s)
[589.880034] Starting dynamic subtest: xrgb8888-xtiled
[590.012100] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.142s)
[590.022065] Starting dynamic subtest: rgb565-xtiled
[590.145459] Dynamic subtest rgb565-xtiled: SUCCESS (0.133s)
[590.156388] Starting dynamic subtest: xrgb2101010-xtiled
[590.268027] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.121s)
[590.277198] Starting dynamic subtest: xbgr16161616f-xtiled
[590.401114] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.132s)
[590.411443] Starting dynamic subtest: xrgb8888-4tiled
[590.557382] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.155s)
[590.570042] Starting dynamic subtest: rgb565-4tiled
[590.712478] Dynamic subtest rgb565-4tiled: SUCCESS (0.153s)
[590.722987] Starting dynamic subtest: xrgb2101010-4tiled
[590.868238] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.153s)
[590.881039] Starting dynamic subtest: xbgr16161616f-4tiled
[591.057388] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.188s)
[591.058637] Subtest draw-method-mmap-wc: SUCCESS (2.090s)
[591.150421] [114/156] (530s left) gem_ctx_shared (create-shared-gtt)
[591.219386] Starting subtest: create-shared-gtt
[593.415575] Subtest create-shared-gtt: SUCCESS (2.151s)
[593.728665] [115/156] (527s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-blt)
[593.820674] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-blt
[601.331421] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.512s)
[601.443553] [116/156] (520s left) kms_big_fb (yf-tiled-32bpp-rotate-0)
[601.537964] Starting subtest: yf-tiled-32bpp-rotate-0
[601.540080] Subtest yf-tiled-32bpp-rotate-0: SKIP (0.000s)
[601.634686] [117/156] (520s left) gem_lmem_swapping (parallel-random)
[601.669400] Subtest parallel-random: SKIP (0.000s)
[601.709325] [118/156] (519s left) kms_psr2_sf (fbc-psr2-overlay-primary-update-sf-dmg-area)
[601.795359] Starting subtest: fbc-psr2-overlay-primary-update-sf-dmg-area
[601.796368] Starting dynamic subtest: pipe-A-eDP-1
[601.918199] Dynamic subtest pipe-A-eDP-1: SKIP (0.122s)
[601.929690] Starting dynamic subtest: pipe-B-eDP-1
[603.107975] Dynamic subtest pipe-B-eDP-1: SKIP (1.188s)
[603.110435] Subtest fbc-psr2-overlay-primary-update-sf-dmg-area: SKIP (1.313s)
[604.397544] [119/156] (517s left) syncobj_timeline (multi-wait-submitted-signaled)
[604.442097] Starting subtest: multi-wait-submitted-signaled
[604.442931] Subtest multi-wait-submitted-signaled: SUCCESS (0.001s)
[604.535797] [120/156] (517s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-spr-indfb-draw-render)
[604.637407] Starting subtest: psrhdr-2p-scndscrn-spr-indfb-draw-render
[604.639273] Subtest psrhdr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[604.730406] [121/156] (517s left) gem_render_copy (yf-tiled-ccs-to-x-tiled)
[604.785469] Starting subtest: yf-tiled-ccs-to-x-tiled
[604.787378] Subtest yf-tiled-ccs-to-x-tiled: SKIP (0.000s)
[604.962552] [122/156] (516s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-render)
[605.055554] Starting subtest: psr-1p-primscrn-spr-indfb-draw-render
[611.920432] Subtest psr-1p-primscrn-spr-indfb-draw-render: SUCCESS (6.866s)
[612.066571] [123/156] (509s left) kms_setmode (invalid-clone-exclusive-crtc)
[612.120052] Starting subtest: invalid-clone-exclusive-crtc
[612.122687] Subtest invalid-clone-exclusive-crtc: SKIP (0.000s)
[612.228816] [124/156] (509s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[612.316908] Starting subtest: fbchdr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[612.319204] Subtest fbchdr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[612.419967] [125/156] (509s left) api_intel_allocator (alloc-simple)
[612.476066] Starting subtest: alloc-simple
[612.478017] Subtest alloc-simple: SUCCESS (0.003s)
[612.601722] [126/156] (509s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[612.693356] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[612.695096] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[612.789411] [127/156] (509s left) kms_big_fb (4-tiled-16bpp-rotate-180)
[612.880634] Starting subtest: 4-tiled-16bpp-rotate-180
[614.171281] Subtest 4-tiled-16bpp-rotate-180: SUCCESS (1.290s)
[614.299643] [128/156] (507s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-cur-indfb-onoff)
[614.395780] Starting subtest: psrhdr-1p-primscrn-cur-indfb-onoff
[614.397511] Subtest psrhdr-1p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[614.503190] [129/156] (507s left) kms_cursor_crc (cursor-tearing-position-change)
[614.610013] Starting subtest: cursor-tearing-position-change
[614.611090] Starting dynamic subtest: pipe-A-eDP-1
[615.193745] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.583s)
[615.202324] Starting dynamic subtest: pipe-D-eDP-1
[616.486660] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.290s)
[616.487653] Subtest cursor-tearing-position-change: SUCCESS (1.876s)
[617.316400] [130/156] (504s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[617.409062] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt
[617.410741] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[617.511797] [131/156] (504s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-indfb-msflip-blt)
[617.602017] Starting subtest: fbcpsrhdr-1p-primscrn-indfb-msflip-blt
[617.603627] Subtest fbcpsrhdr-1p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[617.688530] [132/156] (504s left) kms_addfb_basic (small-bo)
[617.784558] Starting subtest: small-bo
[617.785510] Subtest small-bo: SUCCESS (0.000s)
[617.879151] [133/156] (504s left) perf_pmu (busy-check-all)
[617.916381] Starting subtest: busy-check-all
[617.917281] Starting dynamic subtest: rcs0
[618.474783] Dynamic subtest rcs0: SUCCESS (0.557s)
[618.488551] Starting dynamic subtest: bcs0
[619.025435] Dynamic subtest bcs0: SUCCESS (0.549s)
[619.041608] Starting dynamic subtest: vcs0
[620.317186] Dynamic subtest vcs0: SUCCESS (1.289s)
[620.330553] Starting dynamic subtest: vcs1
[622.312740] Dynamic subtest vcs1: SUCCESS (1.982s)
[622.321787] Starting dynamic subtest: vecs0
[624.359632] Dynamic subtest vecs0: SUCCESS (2.044s)
[624.369913] Starting dynamic subtest: ccs0
[624.903994] Dynamic subtest ccs0: SUCCESS (0.551s)
[624.907189] Subtest busy-check-all: SUCCESS (6.988s)
[625.022870] [134/156] (497s left) kms_color (ctm-blue-to-red)
[625.115256] Starting subtest: ctm-blue-to-red
[625.116132] Starting dynamic subtest: pipe-A-eDP-1
[625.812695] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.697s)
[625.821928] Starting dynamic subtest: pipe-B-eDP-1
[627.237725] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.424s)
[627.246191] Starting dynamic subtest: pipe-C-eDP-1
[628.589890] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.352s)
[628.599053] Starting dynamic subtest: pipe-D-eDP-1
[629.947217] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.356s)
[629.948136] Subtest ctm-blue-to-red: SUCCESS (4.832s)
[630.832211] [135/156] (491s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb565-draw-mmap-gtt)
[630.929560] Starting subtest: fbcpsrhdr-rgb565-draw-mmap-gtt
[630.931317] Subtest fbcpsrhdr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[631.039935] [136/156] (491s left) kms_plane (pixel-format-y-tiled-modifier)
[631.120536] Starting subtest: pixel-format-y-tiled-modifier
[631.122238] Subtest pixel-format-y-tiled-modifier: SKIP (0.000s)
[631.201997] [137/156] (491s left) kms_cursor_legacy (flip-vs-cursor-atomic)
[631.313534] Starting subtest: flip-vs-cursor-atomic
[639.028921] Subtest flip-vs-cursor-atomic: SUCCESS (7.714s)
[639.858715] [138/156] (482s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-cur-indfb-onoff)
[639.945068] Starting subtest: fbchdr-2p-scndscrn-cur-indfb-onoff
[639.946677] Subtest fbchdr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[640.035298] [139/156] (482s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[640.083822] Subtest no-spare-fences-interruptible: SKIP (0.000s)
[640.147220] [140/156] (482s left) gem_exec_whisper (basic-contexts)
[640.197344] Starting subtest: basic-contexts
[646.793051] Subtest basic-contexts: SUCCESS (6.595s)
[646.972728] [141/156] (475s left) gem_reg_read (timestamp-moving)
[647.020973] Starting subtest: timestamp-moving
[648.032028] Subtest timestamp-moving: SUCCESS (1.001s)
[648.096977] [142/156] (474s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset)
[648.194997] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset
[648.197065] Starting dynamic subtest: A-eDP1
[651.796210] Dynamic subtest A-eDP1: SUCCESS (3.598s)
[651.805158] Starting dynamic subtest: B-eDP1
[655.096390] Dynamic subtest B-eDP1: SUCCESS (3.300s)
[655.105621] Starting dynamic subtest: C-eDP1
[658.317441] Dynamic subtest C-eDP1: SUCCESS (3.219s)
[658.326341] Starting dynamic subtest: D-eDP1
[661.548721] Dynamic subtest D-eDP1: SUCCESS (3.230s)
[661.551347] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (13.355s)
[662.362752] [143/156] (460s left) gem_pwrite (basic-random)
[662.418737] Subtest basic-random: SKIP (0.000s)
[662.478350] [144/156] (460s left) gem_userptr_blits (stress-mm-invalidate-close-overlap)
[662.537618] Starting subtest: stress-mm-invalidate-close-overlap
[664.732197] Subtest stress-mm-invalidate-close-overlap: SUCCESS (2.148s)
[664.794017] [145/156] (457s left) kms_frontbuffer_tracking (fbcpsr-tiling-4)
[664.886868] Starting subtest: fbcpsr-tiling-4
[672.086578] Subtest fbcpsr-tiling-4: SUCCESS (7.201s)
[672.218736] [146/156] (450s left) gem_spin_batch (legacy-resubmit)
[672.277617] Starting subtest: legacy-resubmit
[672.278712] Starting dynamic subtest: default
[672.282938] Dynamic subtest default: SUCCESS (0.005s)
[672.292468] Starting dynamic subtest: render
[672.293351] Dynamic subtest render: SUCCESS (0.001s)
[672.301582] Starting dynamic subtest: bsd
[672.302416] Dynamic subtest bsd: SUCCESS (0.002s)
[672.310522] Starting dynamic subtest: bsd1
[672.311420] Dynamic subtest bsd1: SUCCESS (0.002s)
[672.319603] Starting dynamic subtest: bsd2
[672.320667] Dynamic subtest bsd2: SUCCESS (0.001s)
[672.328797] Starting dynamic subtest: blt
[672.329712] Dynamic subtest blt: SUCCESS (0.002s)
[672.337880] Starting dynamic subtest: vebox
[672.338805] Dynamic subtest vebox: SUCCESS (0.002s)
[672.339702] Subtest legacy-resubmit: SUCCESS (0.021s)
[672.532772] [147/156] (450s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[672.624195] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[679.901834] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (7.279s)
[679.999264] [148/156] (442s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[680.107773] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[680.933768] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SUCCESS (0.826s)
[681.103040] [149/156] (441s left) kms_rotation_crc (primary-4-tiled-reflect-x-180)
[681.185877] Starting subtest: primary-4-tiled-reflect-x-180
[688.147262] Subtest primary-4-tiled-reflect-x-180: SUCCESS (6.962s)
[689.377898] [150/156] (433s left) gem_exec_params (invalid-flag)
[689.428699] Starting subtest: invalid-flag
[689.429721] Subtest invalid-flag: SUCCESS (0.000s)
[689.541390] [151/156] (433s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[689.633902] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt
[689.643538] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[689.720199] [152/156] (433s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-pri-indfb-draw-pwrite)
[689.819147] Starting subtest: fbchdr-1p-primscrn-pri-indfb-draw-pwrite
[689.820737] Subtest fbchdr-1p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[689.929086] [153/156] (433s left) gem_userptr_blits (userfault)
[689.982858] Starting subtest: userfault
[689.988650] Subtest userfault: SUCCESS (0.008s)
[690.111075] [154/156] (432s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[690.190195] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[690.191078] Starting dynamic subtest: pipe-A-eDP-1
[690.194412] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[690.203256] Starting dynamic subtest: pipe-B-eDP-1
[690.206621] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[690.215560] Starting dynamic subtest: pipe-C-eDP-1
[690.218943] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[690.227408] Starting dynamic subtest: pipe-D-eDP-1
[690.230834] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[690.232401] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[692.447826] [155/156] (430s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-spr-indfb-draw-pwrite)
[692.537937] Starting subtest: psrhdr-2p-primscrn-spr-indfb-draw-pwrite
[692.539781] Subtest psrhdr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[692.639879] [156/156] (430s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-blt)
[692.730375] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-blt
[699.654889] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-blt: SUCCESS (6.926s)
[699.786772] Closing watchdogs
results: parsing output: 0/ for test: kms_cursor_crc
results: parsing output: 1/ for test: syncobj_timeline
results: parsing output: 2/ for test: gem_exec_basic
results: parsing output: 3/ for test: kms_plane_scaling
results: parsing output: 4/ for test: kms_prop_blob
results: parsing output: 5/ for test: drm_read
results: parsing output: 6/ for test: gem_ctx_freq
results: parsing output: 7/ for test: i915_pm_rc6_residency
results: parsing output: 8/ for test: gem_softpin
results: parsing output: 9/ for test: kms_pipe_stress
results: parsing output: 10/ for test: gem_exec_reloc
results: parsing output: 11/ for test: kms_big_fb
results: parsing output: 12/ for test: kms_chamelium_edid
results: parsing output: 13/ for test: gem_partial_pwrite_pread
results: parsing output: 14/ for test: kms_psr2_sf
results: parsing output: 15/ for test: kms_setmode
results: parsing output: 16/ for test: kms_psr
results: parsing output: 17/ for test: sriov_basic
results: parsing output: 18/ for test: kms_chamelium_hpd
results: parsing output: 19/ for test: kms_psr
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: gem_workarounds
results: parsing output: 22/ for test: kms_sequence
results: parsing output: 23/ for test: kms_busy
results: parsing output: 24/ for test: sysfs_heartbeat_interval
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_psr
results: parsing output: 27/ for test: kms_cursor_crc
results: parsing output: 28/ for test: kms_pm_rpm
results: parsing output: 29/ for test: kms_frontbuffer_tracking
results: parsing output: 30/ for test: gem_eio
results: parsing output: 31/ for test: syncobj_timeline
results: parsing output: 32/ for test: kms_big_fb
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: gem_exec_balancer
results: parsing output: 36/ for test: kms_ccs
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: gem_exec_schedule
results: parsing output: 39/ for test: kms_chamelium_color
results: parsing output: 40/ for test: i915_drm_fdinfo
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: gem_exec_schedule
results: parsing output: 45/ for test: gem_exec_reloc
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: kms_invalid_mode
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: gem_madvise
results: parsing output: 51/ for test: kms_psr
results: parsing output: 52/ for test: i915_hangman
results: parsing output: 53/ for test: gem_render_copy
results: parsing output: 54/ for test: gem_exec_create
results: parsing output: 55/ for test: perf_pmu
results: parsing output: 56/ for test: syncobj_wait
results: parsing output: 57/ for test: core_getstats
results: parsing output: 58/ for test: gem_mmap_gtt
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: gem_exec_flush
results: parsing output: 61/ for test: i915_pm_rps
results: parsing output: 62/ for test: kms_lease
results: parsing output: 63/ for test: kms_flip_scaled_crc
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: syncobj_timeline
results: parsing output: 66/ for test: kms_flip
results: parsing output: 67/ for test: gen9_exec_parse
results: parsing output: 68/ for test: gem_mmap_gtt
results: parsing output: 69/ for test: syncobj_wait
results: parsing output: 70/ for test: kms_dither
results: parsing output: 71/ for test: kms_big_fb
results: parsing output: 72/ for test: gem_eio
results: parsing output: 73/ for test: kms_flip
results: parsing output: 74/ for test: kms_ccs
results: parsing output: 75/ for test: kms_big_fb
results: parsing output: 76/ for test: kms_plane_scaling
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: gem_flink_basic
results: parsing output: 79/ for test: syncobj_wait
results: parsing output: 80/ for test: gem_create
results: parsing output: 81/ for test: kms_async_flips
results: parsing output: 82/ for test: kms_rotation_crc
results: parsing output: 83/ for test: gem_exec_fence
results: parsing output: 84/ for test: gem_mmap_offset
results: parsing output: 85/ for test: gem_ctx_sseu
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: perf
results: parsing output: 88/ for test: kms_psr
results: parsing output: 89/ for test: syncobj_basic
results: parsing output: 90/ for test: kms_ccs
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_lease
results: parsing output: 93/ for test: kms_content_protection
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: gem_exec_params
results: parsing output: 97/ for test: syncobj_wait
results: parsing output: 98/ for test: gem_mmap_gtt
results: parsing output: 99/ for test: gem_eio
results: parsing output: 100/ for test: syncobj_timeline
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: gem_eio
results: parsing output: 103/ for test: kms_plane
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_vrr
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_flip
results: parsing output: 109/ for test: gen3_render_linear_blits
results: parsing output: 110/ for test: gem_busy
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_draw_crc
results: parsing output: 113/ for test: gem_ctx_shared
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: kms_big_fb
results: parsing output: 116/ for test: gem_lmem_swapping
results: parsing output: 117/ for test: kms_psr2_sf
results: parsing output: 118/ for test: syncobj_timeline
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: gem_render_copy
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: kms_setmode
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: api_intel_allocator
results: parsing output: 125/ for test: kms_frontbuffer_tracking
results: parsing output: 126/ for test: kms_big_fb
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: kms_cursor_crc
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: kms_frontbuffer_tracking
results: parsing output: 131/ for test: kms_addfb_basic
results: parsing output: 132/ for test: perf_pmu
results: parsing output: 133/ for test: kms_color
results: parsing output: 134/ for test: kms_frontbuffer_tracking
results: parsing output: 135/ for test: kms_plane
results: parsing output: 136/ for test: kms_cursor_legacy
results: parsing output: 137/ for test: kms_frontbuffer_tracking
results: parsing output: 138/ for test: gem_fenced_exec_thrash
results: parsing output: 139/ for test: gem_exec_whisper
results: parsing output: 140/ for test: gem_reg_read
results: parsing output: 141/ for test: kms_flip
results: parsing output: 142/ for test: gem_pwrite
results: parsing output: 143/ for test: gem_userptr_blits
results: parsing output: 144/ for test: kms_frontbuffer_tracking
results: parsing output: 145/ for test: gem_spin_batch
results: parsing output: 146/ for test: kms_frontbuffer_tracking
results: parsing output: 147/ for test: kms_big_fb
results: parsing output: 148/ for test: kms_rotation_crc
results: parsing output: 149/ for test: gem_exec_params
results: parsing output: 150/ for test: kms_frontbuffer_tracking
results: parsing output: 151/ for test: kms_frontbuffer_tracking
results: parsing output: 152/ for test: gem_userptr_blits
results: parsing output: 153/ for test: kms_ccs
results: parsing output: 154/ for test: kms_frontbuffer_tracking
results: parsing output: 155/ for test: kms_frontbuffer_tracking
Done.