[59.203037] Initializing watchdogs
[59.203084]   /dev/watchdog0
[59.217371] [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.221905] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.224179] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.227644] [001/133] (960s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[59.357803] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[59.362266] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[59.463086] [002/133] (960s left) vgem_basic (second-client)
[59.522271] Starting subtest: second-client
[59.544412] Subtest second-client: SUCCESS (0.022s)
[59.598302] [FACT vgem_basic (second-client)] new: kernel.kmod_is_loaded.vgem: true
[59.601317] [003/133] (960s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[59.699229] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[59.703275] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[59.802124] [004/133] (960s left) gem_madvise (dontneed-before-exec)
[59.841168] Starting subtest: dontneed-before-exec
[59.867781] Subtest dontneed-before-exec: SKIP (0.023s)
[59.923217] [005/133] (959s left) kms_async_flips (async-flip-suspend-resume)
[60.015151] Starting subtest: async-flip-suspend-resume
[60.395858] Starting dynamic subtest: pipe-A-eDP-1
[78.637174] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.472s)
[79.018273] Starting dynamic subtest: pipe-B-eDP-1
[97.663049] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.295s)
[98.051015] Starting dynamic subtest: pipe-C-eDP-1
[116.652471] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.281s)
[117.023548] Starting dynamic subtest: pipe-D-eDP-1
[135.624801] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.266s)
[135.627183] Subtest async-flip-suspend-resume: SUCCESS (14.816s)
[145.836403] [006/133] (883s left) perf_pmu (most-busy-idle-check-all)
[145.891989] Starting subtest: most-busy-idle-check-all
[145.894461] Starting dynamic subtest: rcs0
[147.711120] Dynamic subtest rcs0: SUCCESS (1.816s)
[147.743121] Starting dynamic subtest: bcs0
[149.695824] Dynamic subtest bcs0: SUCCESS (1.983s)
[149.707590] Starting dynamic subtest: vcs0
[151.679151] Dynamic subtest vcs0: SUCCESS (1.982s)
[151.690371] Starting dynamic subtest: vcs1
[153.663812] Dynamic subtest vcs1: SUCCESS (1.983s)
[153.674614] Starting dynamic subtest: vecs0
[155.711369] Dynamic subtest vecs0: SUCCESS (2.046s)
[155.722577] Starting dynamic subtest: ccs0
[157.697800] Dynamic subtest ccs0: SUCCESS (1.985s)
[157.700888] Subtest most-busy-idle-check-all: SUCCESS (11.800s)
[157.792793] [007/133] (871s left) syncobj_timeline (multi-wait-all-available-submitted-signaled)
[157.850168] Starting subtest: multi-wait-all-available-submitted-signaled
[157.852567] Subtest multi-wait-all-available-submitted-signaled: SUCCESS (0.001s)
[157.955479] [008/133] (871s left) kms_chamelium_hpd (hdmi-hpd)
[158.334887] Subtest hdmi-hpd: SKIP (0.000s)
[159.135308] [009/133] (869s left) perf_pmu (busy-double-start)
[159.176573] Starting subtest: busy-double-start
[159.178819] Starting dynamic subtest: rcs0
[162.821239] Dynamic subtest rcs0: FAIL (3.592s)
[162.830733] Starting dynamic subtest: bcs0
[166.339029] Dynamic subtest bcs0: SUCCESS (3.570s)
[166.348947] Starting dynamic subtest: vcs0
[170.197993] Dynamic subtest vcs0: SUCCESS (3.858s)
[170.208180] Starting dynamic subtest: vcs1
[174.210036] Dynamic subtest vcs1: SUCCESS (4.011s)
[174.220297] Starting dynamic subtest: vecs0
[178.189937] Dynamic subtest vecs0: SUCCESS (3.979s)
[178.200520] Starting dynamic subtest: ccs0
[181.826102] Dynamic subtest ccs0: FAIL (3.565s)
[181.828028] Subtest busy-double-start: FAIL (22.580s)
[181.872280] [010/133] (847s left) gem_ctx_persistence (many-contexts)
[181.937138] Starting subtest: many-contexts
[219.626944] Subtest many-contexts: SUCCESS (37.688s)
[219.724193] [011/133] (809s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-blt)
[219.841727] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-blt
[226.666528] Subtest psr-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (6.827s)
[226.816763] [012/133] (802s left) gem_exec_schedule (out-order)
[226.881963] Starting subtest: out-order
[226.883985] Starting dynamic subtest: rcs0
[226.980195] Dynamic subtest rcs0: SUCCESS (0.105s)
[226.991973] Starting dynamic subtest: vcs0
[227.076052] Dynamic subtest vcs0: SUCCESS (0.095s)
[227.087456] Starting dynamic subtest: vcs1
[227.157232] Dynamic subtest vcs1: SUCCESS (0.081s)
[227.168198] Starting dynamic subtest: vecs0
[227.232253] Dynamic subtest vecs0: SUCCESS (0.075s)
[227.243200] Starting dynamic subtest: ccs0
[227.315543] Dynamic subtest ccs0: SUCCESS (0.083s)
[227.317949] Subtest out-order: SUCCESS (0.440s)
[228.754660] [013/133] (800s left) gem_mmap_gtt (medium-copy)
[228.804934] Subtest medium-copy: SKIP (0.000s)
[228.862539] [014/133] (800s left) gem_mmap_offset (close-race)
[228.923232] Starting subtest: close-race
[249.036301] Subtest close-race: SUCCESS (20.112s)
[249.175690] [015/133] (780s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-rc-ccs-cc)
[249.268981] Starting subtest: crc-primary-suspend-y-tiled-gen12-rc-ccs-cc
[249.271106] Starting dynamic subtest: pipe-A-eDP-1
[249.280142] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[249.291136] Starting dynamic subtest: pipe-B-eDP-1
[249.299783] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[249.308374] Starting dynamic subtest: pipe-C-eDP-1
[249.316489] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[249.324398] Starting dynamic subtest: pipe-D-eDP-1
[249.332409] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[249.336325] Subtest crc-primary-suspend-y-tiled-gen12-rc-ccs-cc: SKIP (0.003s)
[251.527518] [016/133] (777s left) kms_psr (fbc-psr2-dpms)
[251.620085] Starting subtest: fbc-psr2-dpms
[251.622926] Starting dynamic subtest: eDP-1
[251.627711] Dynamic subtest eDP-1: SKIP (0.000s)
[251.632499] Subtest fbc-psr2-dpms: SKIP (0.000s)
[251.692118] [017/133] (777s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-render)
[251.794432] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-render
[256.262254] Subtest fbc-1p-primscrn-pri-indfb-draw-render: SUCCESS (4.473s)
[257.431936] [018/133] (772s left) gem_vm_create (isolation)
[257.492969] Starting subtest: isolation
[257.501653] Subtest isolation: SUCCESS (0.009s)
[257.618205] [019/133] (771s left) kms_hdr (static-toggle-dpms)
[257.712307] Starting subtest: static-toggle-dpms
[257.718911] Subtest static-toggle-dpms: SKIP (0.000s)
[257.781930] [020/133] (771s left) gem_exec_balancer (sequential)
[257.852555] Starting subtest: sequential
[260.963265] Subtest sequential: SUCCESS (3.110s)
[261.284289] [021/133] (768s left) kms_chamelium_audio (hdmi-audio-edid)
[261.682159] Subtest hdmi-audio-edid: SKIP (0.000s)
[262.538726] [022/133] (767s left) kms_pm_rpm (legacy-planes)
[264.900906] Starting subtest: legacy-planes
[264.903800] Starting dynamic subtest: plane-64
[273.194731] Dynamic subtest plane-64: SUCCESS (8.297s)
[273.205886] Starting dynamic subtest: plane-94
[281.504034] Dynamic subtest plane-94: SUCCESS (8.308s)
[281.515368] Starting dynamic subtest: plane-124
[289.874984] Dynamic subtest plane-124: SUCCESS (8.369s)
[289.885371] Starting dynamic subtest: plane-134
[298.149234] Dynamic subtest plane-134: SUCCESS (8.272s)
[298.152369] Subtest legacy-planes: SUCCESS (33.252s)
[298.549813] [023/133] (731s left) kms_prop_blob (blob-prop-lifetime)
[298.599996] Starting subtest: blob-prop-lifetime
[298.602172] Subtest blob-prop-lifetime: SUCCESS (0.001s)
[298.693727] [024/133] (731s left) gem_ctx_param (invalid-set-ringsize)
[298.741898] Starting subtest: invalid-set-ringsize
[298.744093] Subtest invalid-set-ringsize: SUCCESS (0.000s)
[298.820267] [025/133] (730s left) kms_big_fb (y-tiled-32bpp-rotate-0)
[298.921847] Starting subtest: y-tiled-32bpp-rotate-0
[298.926193] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s)
[299.013583] [026/133] (730s left) gem_reg_read (bad-register)
[299.075344] Starting subtest: bad-register
[299.077214] Subtest bad-register: SUCCESS (0.000s)
[299.169621] [027/133] (730s left) kms_addfb_basic (bad-pitch-63)
[299.220139] Starting subtest: bad-pitch-63
[299.222327] Subtest bad-pitch-63: SUCCESS (0.000s)
[299.350496] [028/133] (730s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-signa
[299.414769] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-signaled
[299.523221] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-signaled: SUCCESS (0.107s)
[299.605590] [029/133] (730s left) i915_pm_freq_api (freq-reset-multiple)
[299.663293] Starting subtest: freq-reset-multiple
[299.665721] Starting dynamic subtest: gt0
[309.464682] Dynamic subtest gt0: SUCCESS (9.799s)
[309.473802] Starting dynamic subtest: gt1
[317.909044] Dynamic subtest gt1: SUCCESS (8.443s)
[317.911762] Subtest freq-reset-multiple: SUCCESS (18.244s)
[318.007758] [030/133] (711s left) kms_addfb_basic (unused-handle)
[318.075417] Starting subtest: unused-handle
[318.077771] Subtest unused-handle: SUCCESS (0.000s)
[318.199031] [031/133] (711s left) i915_pm_rpm (gem-mmap-type)
[319.822670] Starting subtest: gem-mmap-type
[319.825361] Starting dynamic subtest: wb-smem0
[323.868885] Dynamic subtest wb-smem0: SUCCESS (4.050s)
[323.878712] Starting dynamic subtest: wc-smem0
[327.033301] Dynamic subtest wc-smem0: SUCCESS (3.163s)
[327.042849] Starting dynamic subtest: uc-smem0
[330.191200] Dynamic subtest uc-smem0: SUCCESS (3.157s)
[330.193441] Subtest gem-mmap-type: SUCCESS (10.372s)
[330.277438] [032/133] (699s left) gem_mmap_gtt (fault-concurrent-x)
[330.336540] Subtest fault-concurrent-X: SKIP (0.000s)
[330.394264] [033/133] (699s left) gem_exec_reloc (basic-cpu-gtt-noreloc)
[330.451462] Subtest basic-cpu-gtt-noreloc: SKIP (0.000s)
[330.518240] [034/133] (699s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-blt)
[330.605034] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-blt
[334.343400] Subtest fbc-1p-primscrn-cur-indfb-draw-blt: SUCCESS (3.742s)
[335.587720] [035/133] (694s left) kms_dp_link_training (non-uhbr-mst)
[335.688053] Starting subtest: non-uhbr-mst
[335.696986] Subtest non-uhbr-mst: SKIP (0.000s)
[335.759259] [036/133] (694s left) sw_sync (sync_multi_consumer_producer)
[335.800088] Starting subtest: sync_multi_consumer_producer
[336.072768] Subtest sync_multi_consumer_producer: SUCCESS (0.271s)
[336.146593] [037/133] (694s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-sf)
[336.249024] Starting subtest: psr2-cursor-plane-move-continuous-exceed-sf
[336.251301] Starting dynamic subtest: pipe-A-eDP-1
[346.937101] Dynamic subtest pipe-A-eDP-1: SUCCESS (10.688s)
[346.947584] Starting dynamic subtest: pipe-B-eDP-1
[358.338717] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.401s)
[358.340997] Subtest psr2-cursor-plane-move-continuous-exceed-sf: SUCCESS (22.092s)
[359.187487] [038/133] (671s left) kms_lease (implicit-plane-lease)
[359.279039] Starting subtest: implicit-plane-lease
[359.281351] Subtest implicit-plane-lease: SUCCESS (0.002s)
[359.391434] [039/133] (670s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-wc)
[359.485732] Starting subtest: fbc-rgb565-draw-mmap-wc
[363.579968] Subtest fbc-rgb565-draw-mmap-wc: SUCCESS (4.097s)
[364.789358] [040/133] (665s left) kms_psr (fbc-psr-dpms)
[364.885500] Starting subtest: fbc-psr-dpms
[364.887723] Starting dynamic subtest: eDP-1
[364.891863] Dynamic subtest eDP-1: SKIP (0.000s)
[364.895985] Subtest fbc-psr-dpms: SKIP (0.001s)
[364.965058] [041/133] (665s left) gen9_exec_parse (bb-oversize)
[365.020782] Subtest bb-oversize: SKIP (0.000s)
[365.095661] [042/133] (665s left) kms_scaling_modes (scaling-mode-none)
[365.180526] Starting subtest: scaling-mode-none
[365.182480] Starting dynamic subtest: pipe-A-eDP-1
[365.274687] Dynamic subtest pipe-A-eDP-1: SKIP (0.094s)
[365.286106] Starting dynamic subtest: pipe-B-eDP-1
[365.309412] Dynamic subtest pipe-B-eDP-1: SKIP (0.032s)
[365.318506] Starting dynamic subtest: pipe-C-eDP-1
[365.342961] Dynamic subtest pipe-C-eDP-1: SKIP (0.033s)
[365.352158] Starting dynamic subtest: pipe-D-eDP-1
[365.377022] Dynamic subtest pipe-D-eDP-1: SKIP (0.033s)
[365.381493] Subtest scaling-mode-none: SKIP (0.197s)
[365.506207] [043/133] (665s left) i915_selftest (live)
[368.856117] Starting subtest: live
[368.858530] Starting dynamic subtest: sanitycheck
[373.138360] Dynamic subtest sanitycheck: SUCCESS (4.281s)
[373.147900] Starting dynamic subtest: uncore
[377.408093] Dynamic subtest uncore: SUCCESS (4.269s)
[377.418134] Starting dynamic subtest: workarounds
[395.674520] Dynamic subtest workarounds: FAIL (18.024s)
[395.682958] Starting dynamic subtest: gt_engines
[400.014272] Dynamic subtest gt_engines: SUCCESS (4.578s)
[400.024142] Starting dynamic subtest: gt_timelines
[417.988668] Dynamic subtest gt_timelines: SUCCESS (17.972s)
[417.998626] Starting dynamic subtest: gt_contexts
[422.282339] Dynamic subtest gt_contexts: SUCCESS (4.291s)
[422.292569] Starting dynamic subtest: gt_lrc
[428.406548] Dynamic subtest gt_lrc: SUCCESS (6.122s)
[428.416086] Starting dynamic subtest: gt_mocs
[431.339045] Dynamic subtest gt_mocs: SUCCESS (2.930s)
[431.348736] Starting dynamic subtest: gt_pm
[438.202825] Dynamic subtest gt_pm: SUCCESS (6.862s)
[438.214668] Starting dynamic subtest: gt_heartbeat
[442.525135] Dynamic subtest gt_heartbeat: SUCCESS (4.320s)
[442.534596] Starting dynamic subtest: gt_tlb
[451.823341] Dynamic subtest gt_tlb: SUCCESS (9.297s)
[451.832965] Starting dynamic subtest: requests
[463.483370] Dynamic subtest requests: SUCCESS (11.658s)
[463.492909] Starting dynamic subtest: migrate
[469.183920] Dynamic subtest migrate: SUCCESS (5.699s)
[469.193400] Starting dynamic subtest: active
[473.529191] Dynamic subtest active: SUCCESS (4.343s)
[473.541544] Starting dynamic subtest: objects
[478.182560] Dynamic subtest objects: SUCCESS (4.650s)
[478.192200] Starting dynamic subtest: mman
[483.031066] Dynamic subtest mman: SUCCESS (4.846s)
[483.040992] Starting dynamic subtest: dmabuf
[487.323001] Dynamic subtest dmabuf: SUCCESS (4.292s)
[487.331788] Starting dynamic subtest: vma
[491.660277] Dynamic subtest vma: SUCCESS (4.335s)
[491.669366] Starting dynamic subtest: coherency
[497.115888] Dynamic subtest coherency: SUCCESS (5.452s)
[497.125840] Starting dynamic subtest: gtt
[507.109078] Dynamic subtest gtt: SUCCESS (9.991s)
[507.119365] Starting dynamic subtest: gem
[515.391538] Dynamic subtest gem: SUCCESS (8.280s)
[515.400332] Starting dynamic subtest: evict
[520.860828] Dynamic subtest evict: SUCCESS (5.467s)
[520.870376] Starting dynamic subtest: hugepages
[529.518554] Dynamic subtest hugepages: SUCCESS (8.656s)
[529.528515] Starting dynamic subtest: gem_contexts
[556.966204] Dynamic subtest gem_contexts: SUCCESS (27.444s)
[556.975591] Starting dynamic subtest: client
[561.337473] Dynamic subtest client: SUCCESS (4.371s)
[561.345455] Starting dynamic subtest: gem_migrate
[565.656917] Dynamic subtest gem_migrate: SUCCESS (4.316s)
[565.666568] Starting dynamic subtest: reset
[569.960927] Dynamic subtest reset: SUCCESS (4.303s)
[569.975568] Starting dynamic subtest: memory_region
[574.280123] Dynamic subtest memory_region: SUCCESS (4.318s)
[574.289070] Starting dynamic subtest: hangcheck
[587.502995] Dynamic subtest hangcheck: SUCCESS (13.219s)
[587.511275] Starting dynamic subtest: execlists
[591.839676] Dynamic subtest execlists: SUCCESS (4.334s)
[591.850013] Starting dynamic subtest: ring_submission
[596.122138] Dynamic subtest ring_submission: SUCCESS (4.280s)
[596.131834] Starting dynamic subtest: perf
[600.443098] Dynamic subtest perf: SUCCESS (4.321s)
[600.452658] Starting dynamic subtest: slpc
[614.572702] Dynamic subtest slpc: SUCCESS (14.127s)
[614.582525] Starting dynamic subtest: guc
[618.414386] Dynamic subtest guc: SUCCESS (3.840s)
[618.427526] Starting dynamic subtest: guc_multi_lrc
[622.792287] Dynamic subtest guc_multi_lrc: SUCCESS (4.375s)
[622.801685] Starting dynamic subtest: guc_hang
[627.566365] Dynamic subtest guc_hang: SUCCESS (4.772s)
[627.575962] Starting dynamic subtest: late_gt_pm
[631.922895] Dynamic subtest late_gt_pm: SUCCESS (4.355s)
[631.925267] Subtest live: FAIL (263.057s)
[631.954986] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[631.955710] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[631.959164] [044/133] (398s left) syncobj_wait (invalid-reset-bad-pad)
[633.484206] Starting subtest: invalid-reset-bad-pad
[633.486610] Subtest invalid-reset-bad-pad: SUCCESS (0.000s)
[633.537463] [FACT syncobj_wait (invalid-reset-bad-pad)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[633.538751] [FACT syncobj_wait (invalid-reset-bad-pad)] new: kernel.kmod_is_loaded.i915: true
[633.543098] [045/133] (397s left) api_intel_bb (lot-of-buffers)
[633.606400] Starting subtest: lot-of-buffers
[634.708122] Subtest lot-of-buffers: SUCCESS (1.102s)
[634.932792] [046/133] (395s left) kms_big_fb (4-tiled-64bpp-rotate-270)
[635.045178] Starting subtest: 4-tiled-64bpp-rotate-270
[635.078268] Subtest 4-tiled-64bpp-rotate-270: SKIP (0.032s)
[635.180068] [047/133] (395s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[635.273947] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip
[635.278403] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[635.367943] [048/133] (395s left) kms_content_protection (uevent-hdcp14)
[635.507154] Starting subtest: uevent-hdcp14
[635.511542] Subtest uevent-hdcp14: SKIP (0.000s)
[635.637904] [049/133] (395s left) kms_psr (fbc-psr-suspend)
[635.734627] Starting subtest: fbc-psr-suspend
[635.736915] Starting dynamic subtest: eDP-1
[635.741026] Dynamic subtest eDP-1: SKIP (0.000s)
[635.745139] Subtest fbc-psr-suspend: SKIP (0.001s)
[635.821141] [050/133] (395s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-signaled)
[635.877773] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[635.879601] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[635.984789] [051/133] (394s left) dmabuf_sync_file (export-wait-after-attach)
[636.035916] Starting subtest: export-wait-after-attach
[636.037881] Subtest export-wait-after-attach: SUCCESS (0.001s)
[636.092324] [052/133] (394s left) kms_big_fb (x-tiled-addfb-size-overflow)
[636.182392] Starting subtest: x-tiled-addfb-size-overflow
[636.184304] Subtest x-tiled-addfb-size-overflow: SUCCESS (0.000s)
[636.275359] [053/133] (394s left) syncobj_timeline (etime-single-wait-for-submit-unsubmitted)
[636.333416] Starting subtest: etime-single-wait-for-submit-unsubmitted
[636.435876] Subtest etime-single-wait-for-submit-unsubmitted: SUCCESS (0.101s)
[636.511331] [054/133] (394s left) kms_atomic (plane-primary-overlay-mutable-zpos)
[636.601659] Starting subtest: plane-primary-overlay-mutable-zpos
[640.104487] Subtest plane-primary-overlay-mutable-zpos: SKIP (3.499s)
[641.288854] [055/133] (389s left) vgem_basic (dmabuf-fence)
[641.328026] Starting subtest: dmabuf-fence
[641.330269] Subtest dmabuf-fence: SUCCESS (0.001s)
[641.383672] [056/133] (389s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-blt)
[641.481551] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-blt
[641.485614] Subtest fbc-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[641.574738] [057/133] (389s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-blt)
[641.688445] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-blt
[641.692634] Subtest fbc-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[641.779459] [058/133] (389s left) gem_exec_schedule (u-submit-golden-slice)
[641.848600] Starting subtest: u-submit-golden-slice
[641.850558] Starting dynamic subtest: rcs0
[641.879165] Dynamic subtest rcs0: SUCCESS (0.035s)
[641.890958] Starting dynamic subtest: bcs0
[641.912646] Dynamic subtest bcs0: SUCCESS (0.033s)
[641.923216] Starting dynamic subtest: vcs0
[641.940282] Dynamic subtest vcs0: SUCCESS (0.027s)
[641.949289] Starting dynamic subtest: vcs1
[641.966272] Dynamic subtest vcs1: SUCCESS (0.025s)
[641.974842] Starting dynamic subtest: vecs0
[641.994412] Dynamic subtest vecs0: SUCCESS (0.027s)
[642.004764] Starting dynamic subtest: ccs0
[642.024380] Dynamic subtest ccs0: SUCCESS (0.029s)
[642.026694] Subtest u-submit-golden-slice: SUCCESS (0.182s)
[643.791572] [059/133] (387s left) gem_userptr_blits (coherency-sync)
[643.860965] Starting subtest: coherency-sync
[644.226452] Subtest coherency-sync: SKIP (0.332s)
[644.336011] [060/133] (386s left) kms_flip (dpms-vs-vblank-race)
[644.488350] Starting subtest: dpms-vs-vblank-race
[644.490510] Starting dynamic subtest: A-eDP1
[649.489368] Dynamic subtest A-eDP1: SUCCESS (5.000s)
[649.498909] Starting dynamic subtest: B-eDP1
[654.099909] Dynamic subtest B-eDP1: SUCCESS (4.610s)
[654.110416] Starting dynamic subtest: C-eDP1
[658.733398] Dynamic subtest C-eDP1: SUCCESS (4.631s)
[658.742646] Starting dynamic subtest: D-eDP1
[663.362940] Dynamic subtest D-eDP1: SUCCESS (4.629s)
[663.368567] Subtest dpms-vs-vblank-race: SUCCESS (18.881s)
[664.250622] [061/133] (367s left) kms_rotation_crc (primary-yf-tiled-reflect-x-270)
[664.354418] Starting subtest: primary-yf-tiled-reflect-x-270
[664.358983] Subtest primary-yf-tiled-reflect-x-270: SKIP (0.001s)
[664.433622] [062/133] (366s left) kms_plane_scaling (planes-downscale-factor-0-75-unity-scaling)
[664.532970] Starting subtest: planes-downscale-factor-0-75-unity-scaling
[664.535383] Starting dynamic subtest: pipe-A
[664.595376] Dynamic subtest pipe-A: SUCCESS (0.065s)
[664.606528] Starting dynamic subtest: pipe-B
[665.780063] Dynamic subtest pipe-B: SUCCESS (1.183s)
[665.791030] Starting dynamic subtest: pipe-C
[666.897453] Dynamic subtest pipe-C: SUCCESS (1.116s)
[666.906842] Starting dynamic subtest: pipe-D
[668.019805] Dynamic subtest pipe-D: SUCCESS (1.121s)
[668.022186] Subtest planes-downscale-factor-0-75-unity-scaling: SUCCESS (3.490s)
[669.192013] [063/133] (362s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[669.287430] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[669.291757] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s)
[669.362874] [064/133] (362s left) gem_render_copy (yf-tiled-to-vebox-x-tiled)
[669.418067] Starting subtest: yf-tiled-to-vebox-x-tiled
[669.422583] Subtest yf-tiled-to-vebox-x-tiled: SKIP (0.000s)
[669.601858] [065/133] (361s left) sysfs_heartbeat_interval (nopreempt)
[669.669868] Starting subtest: nopreempt
[669.672227] Starting dynamic subtest: vecs0
[679.675210] Dynamic subtest vecs0: SUCCESS (10.002s)
[679.687268] Starting dynamic subtest: ccs0
[683.695799] Dynamic subtest ccs0: SUCCESS (4.020s)
[683.706700] Starting dynamic subtest: vcs0
[693.693388] Dynamic subtest vcs0: SUCCESS (9.994s)
[693.705295] Starting dynamic subtest: bcs0
[697.634002] Dynamic subtest bcs0: SUCCESS (3.941s)
[697.646126] Starting dynamic subtest: rcs0
[701.676153] Dynamic subtest rcs0: SUCCESS (4.038s)
[701.688565] Starting dynamic subtest: vcs1
[711.678512] Dynamic subtest vcs1: SUCCESS (10.003s)
[711.681194] Subtest nopreempt: SUCCESS (42.009s)
[711.769913] [066/133] (319s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-render)
[711.868110] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-render
[718.854714] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-render: SUCCESS (6.989s)
[718.991957] [067/133] (312s left) kms_color (ctm-blue-to-red)
[719.092534] Starting subtest: ctm-blue-to-red
[719.094687] Starting dynamic subtest: pipe-A-eDP-1
[719.792257] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.698s)
[719.802259] Starting dynamic subtest: pipe-B-eDP-1
[721.239057] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.446s)
[721.248158] Starting dynamic subtest: pipe-C-eDP-1
[722.620870] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.383s)
[722.630996] Starting dynamic subtest: pipe-D-eDP-1
[723.951715] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.329s)
[723.953641] Subtest ctm-blue-to-red: SUCCESS (4.859s)
[724.753530] [068/133] (306s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs-cc)
[724.855732] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs-cc
[724.858069] Starting dynamic subtest: pipe-A-eDP-1
[724.878810] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[724.890198] Starting dynamic subtest: pipe-B-eDP-1
[724.909974] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[724.918653] Starting dynamic subtest: pipe-C-eDP-1
[724.938457] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[724.947139] Starting dynamic subtest: pipe-D-eDP-1
[724.966716] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[724.968606] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.008s)
[727.125256] [069/133] (304s left) gem_create (create-ext-set-pat)
[727.301208] Starting subtest: create-ext-set-pat
[727.303793] Subtest create-ext-set-pat: SUCCESS (0.001s)
[727.386772] [070/133] (304s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-onoff)
[727.484871] Starting subtest: psr-2p-scndscrn-spr-indfb-onoff
[727.489432] Subtest psr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[727.579503] [071/133] (304s left) kms_ccs (crc-primary-basic-4-tiled-dg2-mc-ccs)
[727.673811] Starting subtest: crc-primary-basic-4-tiled-dg2-mc-ccs
[727.676149] Starting dynamic subtest: pipe-A-eDP-1
[727.698957] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[727.711942] Starting dynamic subtest: pipe-B-eDP-1
[727.733427] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[727.742157] Starting dynamic subtest: pipe-C-eDP-1
[727.764238] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[727.772817] Starting dynamic subtest: pipe-D-eDP-1
[727.794997] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[727.799426] Subtest crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.006s)
[729.973753] [072/133] (301s left) kms_atomic_transition (plane-all-modeset-transition-fencing)
[730.064619] Starting subtest: plane-all-modeset-transition-fencing
[730.069065] Subtest plane-all-modeset-transition-fencing: SKIP (0.000s)
[730.150908] [073/133] (301s left) gem_ctx_bad_destroy (double-destroy)
[730.203138] Starting subtest: double-destroy
[730.205433] Subtest double-destroy: SUCCESS (0.000s)
[730.282915] [074/133] (301s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-upscaling)
[730.378336] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-upscaling
[730.382762] Subtest flip-32bpp-yftile-to-64bpp-yftile-upscaling: SKIP (0.000s)
[730.472130] [075/133] (301s left) prime_vgem (basic-fence-flip)
[730.556637] Starting subtest: basic-fence-flip
[730.869494] Subtest basic-fence-flip: SUCCESS (0.313s)
[730.990812] [076/133] (300s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-plflip-blt)
[731.083975] Starting subtest: fbcpsr-2p-primscrn-indfb-plflip-blt
[731.088467] Subtest fbcpsr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[731.219939] [077/133] (300s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[731.320865] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[731.324983] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[731.425039] [078/133] (300s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[731.528440] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt
[731.532880] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[731.630744] [079/133] (300s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[731.721766] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-wc
[738.759261] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (7.040s)
[738.864464] [080/133] (293s left) kms_rotation_crc (sprite-rotation-90)
[738.952203] Starting subtest: sprite-rotation-90
[738.956407] Subtest sprite-rotation-90: SKIP (0.001s)
[739.029279] [081/133] (293s left) kms_plane (plane-position-hole)
[739.128326] Starting subtest: plane-position-hole
[739.663980] Starting dynamic subtest: pipe-A-plane-1
[741.022140] Dynamic subtest pipe-A-plane-1: SUCCESS (1.357s)
[741.032572] Starting dynamic subtest: pipe-A-plane-2
[742.341376] Dynamic subtest pipe-A-plane-2: SUCCESS (1.319s)
[742.351676] Starting dynamic subtest: pipe-A-plane-3
[743.699680] Dynamic subtest pipe-A-plane-3: SUCCESS (1.360s)
[743.709937] Starting dynamic subtest: pipe-A-plane-4
[744.996441] Dynamic subtest pipe-A-plane-4: SUCCESS (1.294s)
[745.005960] Starting dynamic subtest: pipe-A-plane-5
[745.023779] Dynamic subtest pipe-A-plane-5: SUCCESS (0.026s)
[746.245284] Starting dynamic subtest: pipe-B-plane-1
[747.575534] Dynamic subtest pipe-B-plane-1: SUCCESS (1.337s)
[747.585116] Starting dynamic subtest: pipe-B-plane-2
[748.901034] Dynamic subtest pipe-B-plane-2: SUCCESS (1.324s)
[748.911880] Starting dynamic subtest: pipe-B-plane-3
[750.239753] Dynamic subtest pipe-B-plane-3: SUCCESS (1.339s)
[750.251063] Starting dynamic subtest: pipe-B-plane-4
[751.597505] Dynamic subtest pipe-B-plane-4: SUCCESS (1.355s)
[751.607785] Starting dynamic subtest: pipe-B-plane-5
[751.622798] Dynamic subtest pipe-B-plane-5: SUCCESS (0.024s)
[751.625092] Subtest plane-position-hole: SUCCESS (12.494s)
[752.444946] [082/133] (279s left) gem_softpin (safe-alignment)
[752.516161] Starting subtest: safe-alignment
[752.543975] Subtest safe-alignment: SUCCESS (0.028s)
[753.703368] [083/133] (278s left) kms_psr (psr2-primary-mmap-cpu)
[753.801627] Starting subtest: psr2-primary-mmap-cpu
[753.803898] Starting dynamic subtest: eDP-1
[755.539081] Dynamic subtest eDP-1: SUCCESS (1.738s)
[755.541397] Subtest psr2-primary-mmap-cpu: SUCCESS (1.739s)
[756.412832] [084/133] (275s left) kms_vrr (flip-basic-fastset)
[756.507003] Starting subtest: flip-basic-fastset
[756.513045] Subtest flip-basic-fastset: SKIP (0.000s)
[756.581732] [085/133] (275s left) kms_pm_dc (dc6-dpms)
[757.685928] Starting subtest: dc6-dpms
[759.787671] Subtest dc6-dpms: SUCCESS (2.102s)
[759.876738] [086/133] (272s left) kms_cursor_legacy (2x-flip-vs-cursor-legacy)
[759.994679] Starting subtest: 2x-flip-vs-cursor-legacy
[759.999370] Subtest 2x-flip-vs-cursor-legacy: SKIP (0.002s)
[760.138930] [087/133] (272s left) fbdev (pan)
[760.179710] Starting subtest: pan
[760.210551] Subtest pan: SUCCESS (0.031s)
[760.281415] [088/133] (272s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[760.385466] Starting subtest: fbcpsr-indfb-scaledprimary
[766.160710] Subtest fbcpsr-indfb-scaledprimary: SUCCESS (5.778s)
[766.287626] [089/133] (266s left) gem_huc_copy (huc-copy)
[766.357076] Starting subtest: huc-copy
[766.362217] Subtest huc-copy: SUCCESS (0.007s)
[766.507130] [090/133] (266s left) gem_exec_reloc (basic-wc-gtt-active)
[766.573805] Subtest basic-wc-gtt-active: SKIP (0.000s)
[766.645575] [091/133] (265s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted)
[766.703045] Starting subtest: multi-wait-all-for-submit-unsubmitted
[766.811597] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.108s)
[766.899288] [092/133] (265s left) kms_ccs (crc-primary-suspend-y-tiled-ccs)
[766.993865] Starting subtest: crc-primary-suspend-y-tiled-ccs
[766.996288] Starting dynamic subtest: pipe-A-eDP-1
[767.005705] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[767.022492] Starting dynamic subtest: pipe-B-eDP-1
[767.031890] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[767.042813] Starting dynamic subtest: pipe-C-eDP-1
[767.051385] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[767.060555] Starting dynamic subtest: pipe-D-eDP-1
[767.068971] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[767.073112] Subtest crc-primary-suspend-y-tiled-ccs: SKIP (0.005s)
[769.263209] [093/133] (263s left) kms_cursor_crc (cursor-tearing-framebuffer-change)
[769.375147] Starting subtest: cursor-tearing-framebuffer-change
[769.377423] Starting dynamic subtest: pipe-A-eDP-1
[769.957878] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.578s)
[769.968258] Starting dynamic subtest: pipe-D-eDP-1
[771.166883] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.210s)
[771.169256] Subtest cursor-tearing-framebuffer-change: SUCCESS (1.791s)
[772.033929] [094/133] (260s left) kms_cursor_crc (cursor-rapid-movement-32x32)
[772.174192] Starting subtest: cursor-rapid-movement-32x32
[772.224306] Subtest cursor-rapid-movement-32x32: SKIP (0.045s)
[772.529474] [095/133] (260s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-msflip-blt)
[772.627613] Starting subtest: psr-2p-primscrn-indfb-msflip-blt
[772.631912] Subtest psr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[772.718043] [096/133] (260s left) api_intel_allocator (standalone)
[772.772132] Starting subtest: standalone
[772.785576] Subtest standalone: SUCCESS (0.015s)
[772.900691] [097/133] (260s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite)
[773.005355] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite
[781.719233] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.713s)
[781.873594] [098/133] (251s left) kms_fb_coherency (memset-crc)
[781.991578] Starting subtest: memset-crc
[781.993528] Starting dynamic subtest: mmap-offset-wc
[782.388730] Dynamic subtest mmap-offset-wc: SUCCESS (0.398s)
[782.692460] Starting dynamic subtest: mmap-offset-uc
[788.801971] Dynamic subtest mmap-offset-uc: SUCCESS (6.119s)
[789.082677] Subtest memset-crc: SUCCESS (7.091s)
[789.915826] [099/133] (243s left) perf (disabled-read-error)
[790.088351] Starting subtest: disabled-read-error
[790.102193] Subtest disabled-read-error: SUCCESS (0.015s)
[790.153445] [100/133] (242s left) kms_frontbuffer_tracking (fbcpsr-slowdraw)
[790.243349] Starting subtest: fbcpsr-slowdraw
[815.450966] Subtest fbcpsr-slowdraw: SUCCESS (25.211s)
[815.575877] [101/133] (217s left) syncobj_timeline (wait-all-delayed-signal)
[815.632391] Starting subtest: wait-all-delayed-signal
[815.735302] Subtest wait-all-delayed-signal: SUCCESS (0.103s)
[815.826373] [102/133] (217s left) kms_plane_multiple (tiling-yf)
[815.912399] Starting subtest: tiling-yf
[815.916573] Subtest tiling-yf: SKIP (0.000s)
[815.983842] [103/133] (217s left) kms_ccs (bad-pixel-format-4-tiled-dg2-mc-ccs)
[816.085074] Starting subtest: bad-pixel-format-4-tiled-dg2-mc-ccs
[816.087358] Starting dynamic subtest: pipe-A-eDP-1
[816.109934] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[816.131054] Starting dynamic subtest: pipe-B-eDP-1
[816.153761] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[816.176284] Starting dynamic subtest: pipe-C-eDP-1
[816.197535] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[816.210609] Starting dynamic subtest: pipe-D-eDP-1
[816.232043] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[816.236022] Subtest bad-pixel-format-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[818.403662] [104/133] (214s left) kms_sequence (queue-busy)
[818.493356] Starting subtest: queue-busy
[818.495519] Starting dynamic subtest: pipe-A-eDP-1
[820.437634] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.945s)
[820.448916] Starting dynamic subtest: pipe-B-eDP-1
[823.021076] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.580s)
[823.031999] Starting dynamic subtest: pipe-C-eDP-1
[825.622210] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.601s)
[825.632243] Starting dynamic subtest: pipe-D-eDP-1
[828.163100] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.538s)
[828.165298] Subtest queue-busy: SUCCESS (9.670s)
[829.045217] [105/133] (204s left) gem_mmap_gtt (big-copy-xy)
[829.110277] Subtest big-copy-XY: SKIP (0.000s)
[829.179922] [106/133] (204s left) prime_vgem (shrink)
[829.253210] Starting subtest: shrink
[829.269571] Subtest shrink: SUCCESS (0.013s)
[829.367411] [107/133] (204s left) gem_eio (create)
[829.590077] Starting subtest: create
[829.912152] Subtest create: SUCCESS (0.323s)
[830.038428] [108/133] (203s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing)
[830.126824] Starting subtest: plane-use-after-nonblocking-unbind-fencing
[830.128781] Starting dynamic subtest: pipe-A-eDP-1
[830.188285] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.063s)
[830.496225] Starting dynamic subtest: pipe-B-eDP-1
[831.260252] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.775s)
[831.561336] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (1.433s)
[832.423637] [109/133] (201s left) kms_fbcon_fbt (psr)
[832.477040] Starting subtest: psr
[839.782941] Subtest psr: SUCCESS (7.301s)
[839.863267] [110/133] (193s left) gem_close_race (basic-threads)
[839.928439] Starting subtest: basic-threads
[841.341134] Subtest basic-threads: SUCCESS (1.412s)
[841.533287] [111/133] (192s left) gem_exec_gttfill (engines)
[841.600112] Starting subtest: engines
[841.602240] Starting dynamic subtest: rcs0
[864.629964] Dynamic subtest rcs0: SUCCESS (23.028s)
[864.643356] Starting dynamic subtest: bcs0
[888.003069] Dynamic subtest bcs0: SUCCESS (23.371s)
[888.013930] Starting dynamic subtest: vcs0
[911.375796] Dynamic subtest vcs0: SUCCESS (23.369s)
[911.388096] Starting dynamic subtest: vcs1
[934.758266] Dynamic subtest vcs1: SUCCESS (23.382s)
[934.770957] Starting dynamic subtest: vecs0
[958.171476] Dynamic subtest vecs0: SUCCESS (23.410s)
[958.181728] Starting dynamic subtest: ccs0
[981.518556] Dynamic subtest ccs0: SUCCESS (23.344s)
[981.521061] Subtest engines: SUCCESS (139.916s)
[981.710649] [112/133] ( 51s left) gem_partial_pwrite_pread (writes-after-reads)
[981.808924] Subtest writes-after-reads: SKIP (0.000s)
[981.882818] [113/133] ( 51s left) kms_rotation_crc (sprite-rotation-180)
[981.977078] Starting subtest: sprite-rotation-180
[988.842018] Subtest sprite-rotation-180: SUCCESS (6.866s)
[990.034254] [114/133] ( 43s left) i915_drm_fdinfo (most-busy-check-all)
[990.080691] Starting subtest: most-busy-check-all
[990.083008] Starting dynamic subtest: rcs0
[990.087494] Dynamic subtest rcs0: SKIP (0.004s)
[990.098370] Starting dynamic subtest: bcs0
[990.102605] Dynamic subtest bcs0: SKIP (0.000s)
[990.112261] Starting dynamic subtest: vcs0
[990.116849] Dynamic subtest vcs0: SKIP (0.000s)
[990.126308] Starting dynamic subtest: vcs1
[990.130596] Dynamic subtest vcs1: SKIP (0.000s)
[990.140059] Starting dynamic subtest: vecs0
[990.144481] Dynamic subtest vecs0: SKIP (0.000s)
[990.153650] Starting dynamic subtest: ccs0
[990.157972] Dynamic subtest ccs0: SKIP (0.000s)
[990.162464] Subtest most-busy-check-all: SKIP (0.009s)
[990.204429] [115/133] ( 43s left) gem_exec_params (dr4-dirt)
[990.268256] Starting subtest: DR4-dirt
[990.270415] Subtest DR4-dirt: SUCCESS (0.000s)
[990.373042] [116/133] ( 43s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier)
[990.463548] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier
[990.467817] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier: SKIP (0.000s)
[990.551772] [117/133] ( 43s left) gem_exec_flush (basic-wb-ro-default)
[990.619308] Starting subtest: basic-wb-ro-default
[996.079828] Subtest basic-wb-ro-default: SUCCESS (5.463s)
[996.263750] [118/133] ( 37s left) gem_exec_flush (basic-wb-pro-default)
[996.324076] Starting subtest: basic-wb-pro-default
[1001.794433] Subtest basic-wb-pro-default: SUCCESS (5.471s)
[1001.984745] [119/133] ( 31s left) kms_cursor_crc (cursor-alpha-transparent)
[1002.075122] Starting subtest: cursor-alpha-transparent
[1002.077309] Starting dynamic subtest: pipe-A-eDP-1
[1002.741768] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.667s)
[1002.753692] Starting dynamic subtest: pipe-D-eDP-1
[1004.038988] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.296s)
[1004.041387] Subtest cursor-alpha-transparent: SUCCESS (1.966s)
[1004.912755] [120/133] ( 29s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-pwrite)
[1005.004895] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-pwrite
[1010.398121] Subtest fbc-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (5.396s)
[1011.533914] [121/133] ( 22s left) kms_chamelium_edid (dp-edid-change-during-suspend)
[1011.907129] Subtest dp-edid-change-during-suspend: SKIP (0.000s)
[1012.732737] [122/133] ( 21s left) kms_big_fb (x-tiled-64bpp-rotate-180)
[1012.841557] Starting subtest: x-tiled-64bpp-rotate-180
[1014.533424] Subtest x-tiled-64bpp-rotate-180: SUCCESS (1.691s)
[1014.725147] [123/133] ( 19s left) gem_exec_params (rel-constants-invalid-rel-gen5)
[1014.783277] Starting subtest: rel-constants-invalid-rel-gen5
[1014.786170] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s)
[1014.890243] [124/133] ( 19s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-fully-sf)
[1014.994581] Starting subtest: psr2-overlay-plane-move-continuous-exceed-fully-sf
[1014.996503] Starting dynamic subtest: pipe-A-eDP-1
[1031.471046] Dynamic subtest pipe-A-eDP-1: SUCCESS (16.478s)
[1031.481551] Starting dynamic subtest: pipe-B-eDP-1
[1048.630776] Dynamic subtest pipe-B-eDP-1: SUCCESS (17.158s)
[1048.633127] Subtest psr2-overlay-plane-move-continuous-exceed-fully-sf: SUCCESS (33.639s)
[1049.413782] Overall timeout time exceeded, stopping.
[1049.431947] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: vgem_basic
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: gem_madvise
results: parsing output: 4/ for test: kms_async_flips
results: parsing output: 5/ for test: perf_pmu
results: parsing output: 6/ for test: syncobj_timeline
results: parsing output: 7/ for test: kms_chamelium_hpd
results: parsing output: 8/ for test: perf_pmu
results: parsing output: 9/ for test: gem_ctx_persistence
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: gem_exec_schedule
results: parsing output: 12/ for test: gem_mmap_gtt
results: parsing output: 13/ for test: gem_mmap_offset
results: parsing output: 14/ for test: kms_ccs
results: parsing output: 15/ for test: kms_psr
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: gem_vm_create
results: parsing output: 18/ for test: kms_hdr
results: parsing output: 19/ for test: gem_exec_balancer
results: parsing output: 20/ for test: kms_chamelium_audio
results: parsing output: 21/ for test: kms_pm_rpm
results: parsing output: 22/ for test: kms_prop_blob
results: parsing output: 23/ for test: gem_ctx_param
results: parsing output: 24/ for test: kms_big_fb
results: parsing output: 25/ for test: gem_reg_read
results: parsing output: 26/ for test: kms_addfb_basic
results: parsing output: 27/ for test: syncobj_timeline
results: parsing output: 28/ for test: i915_pm_freq_api
results: parsing output: 29/ for test: kms_addfb_basic
results: parsing output: 30/ for test: i915_pm_rpm
results: parsing output: 31/ for test: gem_mmap_gtt
results: parsing output: 32/ for test: gem_exec_reloc
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: kms_dp_link_training
results: parsing output: 35/ for test: sw_sync
results: parsing output: 36/ for test: kms_psr2_sf
results: parsing output: 37/ for test: kms_lease
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: kms_psr
results: parsing output: 40/ for test: gen9_exec_parse
results: parsing output: 41/ for test: kms_scaling_modes
results: parsing output: 42/ for test: i915_selftest
results: parsing output: 43/ for test: syncobj_wait
results: parsing output: 44/ for test: api_intel_bb
results: parsing output: 45/ for test: kms_big_fb
results: parsing output: 46/ for test: kms_big_fb
results: parsing output: 47/ for test: kms_content_protection
results: parsing output: 48/ for test: kms_psr
results: parsing output: 49/ for test: syncobj_wait
results: parsing output: 50/ for test: dmabuf_sync_file
results: parsing output: 51/ for test: kms_big_fb
results: parsing output: 52/ for test: syncobj_timeline
results: parsing output: 53/ for test: kms_atomic
results: parsing output: 54/ for test: vgem_basic
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: gem_exec_schedule
results: parsing output: 58/ for test: gem_userptr_blits
results: parsing output: 59/ for test: kms_flip
results: parsing output: 60/ for test: kms_rotation_crc
results: parsing output: 61/ for test: kms_plane_scaling
results: parsing output: 62/ for test: kms_flip_scaled_crc
results: parsing output: 63/ for test: gem_render_copy
results: parsing output: 64/ for test: sysfs_heartbeat_interval
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_color
results: parsing output: 67/ for test: kms_ccs
results: parsing output: 68/ for test: gem_create
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: kms_ccs
results: parsing output: 71/ for test: kms_atomic_transition
results: parsing output: 72/ for test: gem_ctx_bad_destroy
results: parsing output: 73/ for test: kms_flip_scaled_crc
results: parsing output: 74/ for test: prime_vgem
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_rotation_crc
results: parsing output: 80/ for test: kms_plane
results: parsing output: 81/ for test: gem_softpin
results: parsing output: 82/ for test: kms_psr
results: parsing output: 83/ for test: kms_vrr
results: parsing output: 84/ for test: kms_pm_dc
results: parsing output: 85/ for test: kms_cursor_legacy
results: parsing output: 86/ for test: fbdev
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: gem_huc_copy
results: parsing output: 89/ for test: gem_exec_reloc
results: parsing output: 90/ for test: syncobj_wait
results: parsing output: 91/ for test: kms_ccs
results: parsing output: 92/ for test: kms_cursor_crc
results: parsing output: 93/ for test: kms_cursor_crc
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: api_intel_allocator
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_fb_coherency
results: parsing output: 98/ for test: perf
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: syncobj_timeline
results: parsing output: 101/ for test: kms_plane_multiple
results: parsing output: 102/ for test: kms_ccs
results: parsing output: 103/ for test: kms_sequence
results: parsing output: 104/ for test: gem_mmap_gtt
results: parsing output: 105/ for test: prime_vgem
results: parsing output: 106/ for test: gem_eio
results: parsing output: 107/ for test: kms_atomic_transition
results: parsing output: 108/ for test: kms_fbcon_fbt
results: parsing output: 109/ for test: gem_close_race
results: parsing output: 110/ for test: gem_exec_gttfill
results: parsing output: 111/ for test: gem_partial_pwrite_pread
results: parsing output: 112/ for test: kms_rotation_crc
results: parsing output: 113/ for test: i915_drm_fdinfo
results: parsing output: 114/ for test: gem_exec_params
results: parsing output: 115/ for test: kms_plane
results: parsing output: 116/ for test: gem_exec_flush
results: parsing output: 117/ for test: gem_exec_flush
results: parsing output: 118/ for test: kms_cursor_crc
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: kms_chamelium_edid
results: parsing output: 121/ for test: kms_big_fb
results: parsing output: 122/ for test: gem_exec_params
results: parsing output: 123/ for test: kms_psr2_sf
results: parsing output: 124/ for test: kms_pipe_crc_basic
results: no output, setting notrun
results: parsing output: 125/ for test: gem_exec_balancer
results: no output, setting notrun
results: parsing output: 126/ for test: kms_big_fb
results: no output, setting notrun
results: parsing output: 127/ for test: syncobj_timeline
results: no output, setting notrun
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: no output, setting notrun
results: parsing output: 129/ for test: gem_pxp
results: no output, setting notrun
results: parsing output: 130/ for test: gem_exec_schedule
results: no output, setting notrun
results: parsing output: 131/ for test: gem_exec_fence
results: no output, setting notrun
results: parsing output: 132/ for test: gem_mmap_wc
results: no output, setting notrun
Done.