[61.215290] Initializing watchdogs
[61.215342]   /dev/watchdog0
[61.228574] [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]
[61.232807] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[61.235038] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[61.238251] [001/133] (960s left) syncobj_timeline (invalid-single-wait-unsubmitted)
[61.332620] Starting subtest: invalid-single-wait-unsubmitted
[61.335068] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s)
[61.448894] [002/133] (960s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs)
[61.544159] Starting subtest: crc-sprite-planes-basic-4-tiled-bmg-ccs
[61.548602] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[62.663567] [003/133] (959s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-wc)
[62.777405] Starting subtest: psr-rgb101010-draw-mmap-wc
[69.758962] Subtest psr-rgb101010-draw-mmap-wc: SUCCESS (6.995s)
[69.865832] [004/133] (951s left) gem_exec_schedule (semaphore-noskip)
[69.946865] Starting subtest: semaphore-noskip
[70.360837] Subtest semaphore-noskip: SUCCESS (0.419s)
[70.691749] [005/133] (951s left) gem_vm_create (isolation)
[70.739638] Starting subtest: isolation
[70.749290] Subtest isolation: SUCCESS (0.010s)
[70.891187] [006/133] (951s left) syncobj_wait (wait-any-interrupted)
[70.940724] Starting subtest: wait-any-interrupted
[71.051324] Subtest wait-any-interrupted: SUCCESS (0.109s)
[71.132164] [007/133] (950s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted-signal
[71.176052] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted-signaled
[71.284101] Subtest etime-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.108s)
[71.356592] [008/133] (950s left) kms_psr (fbc-psr-cursor-render)
[71.453158] Starting subtest: fbc-psr-cursor-render
[71.455428] Starting dynamic subtest: eDP-1
[71.459894] Dynamic subtest eDP-1: SKIP (0.000s)
[71.464552] Subtest fbc-psr-cursor-render: SKIP (0.000s)
[71.519791] [009/133] (950s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[71.615987] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[71.619965] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[71.705143] [010/133] (950s left) perf (invalid-remove-userspace-config)
[71.828640] Starting subtest: invalid-remove-userspace-config
[71.838419] Subtest invalid-remove-userspace-config: SUCCESS (0.010s)
[71.872404] [011/133] (950s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc)
[71.962062] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc
[71.966092] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[72.063891] [012/133] (950s left) kms_psr_stress_test (flip-primary-invalidate-overlay)
[72.152136] Starting subtest: flip-primary-invalidate-overlay
[83.762818] Subtest flip-primary-invalidate-overlay: SUCCESS (11.616s)
[83.873307] [013/133] (938s left) api_intel_bb (reset-bb)
[83.921953] Starting subtest: reset-bb
[83.925745] Subtest reset-bb: SUCCESS (0.004s)
[84.042464] [014/133] (938s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing)
[84.148110] Starting subtest: plane-use-after-nonblocking-unbind-fencing
[84.149971] Starting dynamic subtest: pipe-A-eDP-1
[84.208175] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.061s)
[84.501294] Starting dynamic subtest: pipe-B-eDP-1
[85.263042] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.769s)
[85.564787] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (1.417s)
[86.419117] [015/133] (935s left) gem_ctx_persistence (legacy-engines-hostile-preempt)
[86.489192] Starting subtest: legacy-engines-hostile-preempt
[86.491675] Starting dynamic subtest: render
[86.563317] Dynamic subtest render: SUCCESS (0.073s)
[86.572981] Starting dynamic subtest: bsd1
[87.870031] Dynamic subtest bsd1: SUCCESS (1.304s)
[87.882426] Starting dynamic subtest: bsd2
[89.936781] Dynamic subtest bsd2: SUCCESS (2.065s)
[89.946866] Starting dynamic subtest: blt
[89.970320] Dynamic subtest blt: SUCCESS (0.034s)
[89.978022] Starting dynamic subtest: vebox
[91.900710] Dynamic subtest vebox: SUCCESS (1.928s)
[91.903227] Subtest legacy-engines-hostile-preempt: SUCCESS (5.411s)
[92.037878] [016/133] (930s left) kms_dsc (dsc-with-output-formats-with-bpc)
[92.132869] Starting subtest: dsc-with-output-formats-with-bpc
[92.192099] Subtest dsc-with-output-formats-with-bpc: SKIP (0.001s)
[92.226950] [017/133] (930s left) gem_bad_reloc (negative-reloc-lut)
[92.296593] Subtest negative-reloc-lut: SKIP (0.000s)
[92.354396] [018/133] (930s left) kms_addfb_basic (invalid-get-prop)
[92.412173] Starting subtest: invalid-get-prop
[92.414358] Subtest invalid-get-prop: SUCCESS (0.000s)
[92.562976] [019/133] (929s left) kms_cursor_crc (cursor-random-64x21)
[92.766017] Starting subtest: cursor-random-64x21
[92.817237] Subtest cursor-random-64x21: SKIP (0.048s)
[93.041602] [020/133] (929s left) kms_psr (pr-no-drrs)
[93.132155] Starting subtest: pr-no-drrs
[93.135681] Subtest pr-no-drrs: SKIP (0.000s)
[93.203684] [021/133] (929s left) gem_exec_fence (syncobj-timeline-wait)
[93.766042] Starting subtest: syncobj-timeline-wait
[94.956670] Subtest syncobj-timeline-wait: SUCCESS (1.191s)
[96.991651] [FACT gem_exec_fence (syncobj-timeline-wait)] new: kernel.kmod_is_loaded.vgem: true
[96.994712] [022/133] (925s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf)
[97.105316] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf
[97.107772] Starting dynamic subtest: pipe-A-eDP-1
[97.190300] Dynamic subtest pipe-A-eDP-1: SKIP (0.088s)
[97.200668] Starting dynamic subtest: pipe-B-eDP-1
[98.398630] Dynamic subtest pipe-B-eDP-1: SKIP (1.209s)
[98.403410] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (1.299s)
[99.575491] [023/133] (922s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-pwrite)
[99.681610] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-pwrite
[99.686126] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[99.775933] [024/133] (922s left) kms_chamelium_frames (vga-frame-dump)
[100.158336] Subtest vga-frame-dump: SKIP (0.000s)
[100.986237] [025/133] (921s left) gem_mmap_wc (write-read)
[101.044250] Subtest write-read: SKIP (0.000s)
[101.090690] [026/133] (921s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-downscaling)
[101.201287] Starting subtest: flip-64bpp-yftile-to-32bpp-yftile-downscaling
[101.205466] Subtest flip-64bpp-yftile-to-32bpp-yftile-downscaling: SKIP (0.000s)
[101.285567] [027/133] (921s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render)
[101.394813] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render
[101.399297] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[101.505961] [028/133] (921s left) gem_userptr_blits (access-control)
[101.593641] Starting subtest: access-control
[101.597586] Subtest access-control: SKIP (0.000s)
[101.701569] [029/133] (921s left) syncobj_timeline (wait-for-submit-snapshot)
[101.762928] Starting subtest: wait-for-submit-snapshot
[101.844441] Subtest wait-for-submit-snapshot: SUCCESS (0.082s)
[101.920989] [030/133] (920s left) kms_rmfb (close-fd)
[102.006328] Starting subtest: close-fd
[102.007961] Starting dynamic subtest: pipe-A-eDP-1
[102.114194] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.109s)
[102.124384] Starting dynamic subtest: pipe-B-eDP-1
[103.264976] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.147s)
[103.274046] Starting dynamic subtest: pipe-C-eDP-1
[104.404976] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.139s)
[104.414739] Starting dynamic subtest: pipe-D-eDP-1
[105.541929] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.137s)
[105.544332] Subtest close-fd: SUCCESS (3.537s)
[106.747979] [031/133] (916s left) gen9_exec_parse (bb-start-out)
[106.802068] Subtest bb-start-out: SKIP (0.000s)
[106.884280] [032/133] (916s left) kms_color_pipeline (plane-lut1d-ctm3x4)
[106.986425] Starting subtest: plane-lut1d-ctm3x4
[107.110241] Starting dynamic subtest: pipe-A-plane-0
[107.442032] Dynamic subtest pipe-A-plane-0: FAIL (0.155s)
[107.452564] Starting dynamic subtest: pipe-A-plane-1
[107.669257] Dynamic subtest pipe-A-plane-1: FAIL (0.175s)
[107.676918] Starting dynamic subtest: pipe-A-plane-2
[107.885642] Dynamic subtest pipe-A-plane-2: FAIL (0.166s)
[108.840611] Starting dynamic subtest: pipe-B-plane-0
[109.298174] Dynamic subtest pipe-B-plane-0: FAIL (0.196s)
[109.315129] Starting dynamic subtest: pipe-B-plane-1
[109.618248] Dynamic subtest pipe-B-plane-1: FAIL (0.200s)
[109.628328] Starting dynamic subtest: pipe-B-plane-2
[109.924525] Dynamic subtest pipe-B-plane-2: FAIL (0.155s)
[110.590492] Starting dynamic subtest: pipe-C-plane-0
[111.112214] Dynamic subtest pipe-C-plane-0: FAIL (0.151s)
[111.121026] Starting dynamic subtest: pipe-C-plane-1
[111.518032] Dynamic subtest pipe-C-plane-1: FAIL (0.167s)
[111.528954] Starting dynamic subtest: pipe-C-plane-2
[111.901649] Dynamic subtest pipe-C-plane-2: FAIL (0.602s)
[112.725017] Starting dynamic subtest: pipe-D-plane-0
[113.319611] Dynamic subtest pipe-D-plane-0: FAIL (0.140s)
[113.329590] Starting dynamic subtest: pipe-D-plane-1
[113.793484] Dynamic subtest pipe-D-plane-1: FAIL (0.619s)
[113.802579] Starting dynamic subtest: pipe-D-plane-2
[114.246870] Dynamic subtest pipe-D-plane-2: FAIL (0.556s)
[114.327060] Subtest plane-lut1d-ctm3x4: FAIL (7.344s)
[115.197831] [033/133] (907s left) syncobj_timeline (etime-single-wait-available-unsubmitted)
[115.263870] Starting subtest: etime-single-wait-available-unsubmitted
[115.370873] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.106s)
[115.444943] [034/133] (907s left) gem_eio (unwedge-stress)
[115.667854] Starting subtest: unwedge-stress
[115.670427] Starting dynamic subtest: render
[120.355971] Dynamic subtest render: SUCCESS (4.686s)
[120.370806] Starting dynamic subtest: bsd1
[138.343450] Dynamic subtest bsd1: SUCCESS (17.986s)
[138.360091] Starting dynamic subtest: bsd2
[156.409905] Dynamic subtest bsd2: SUCCESS (18.063s)
[156.424557] Starting dynamic subtest: blt
[156.428837] Dynamic subtest blt: SKIP (0.000s)
[156.437053] Starting dynamic subtest: vebox
[174.360646] Dynamic subtest vebox: SUCCESS (17.950s)
[174.362750] Subtest unwedge-stress: SUCCESS (58.690s)
[175.932275] [035/133] (847s left) kms_chamelium_audio (hdmi-audio-edid)
[176.320058] Subtest hdmi-audio-edid: SKIP (0.000s)
[177.093504] [036/133] (845s left) i915_pm_rpm (debugfs-forcewake-user)
[179.068743] Starting subtest: debugfs-forcewake-user
[190.454885] Subtest debugfs-forcewake-user: SUCCESS (11.389s)
[190.820085] [037/133] (832s left) kms_big_fb (y-tiled-16bpp-rotate-0)
[190.925377] Starting subtest: y-tiled-16bpp-rotate-0
[190.929869] Subtest y-tiled-16bpp-rotate-0: SKIP (0.000s)
[191.042864] [038/133] (832s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[191.143644] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[198.140318] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (6.997s)
[198.288839] [039/133] (824s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[198.824561] Starting subtest: syncobj-timeline-multiple-ext-nodes
[198.826696] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.004s)
[199.947099] [040/133] (823s left) gem_exec_whisper (basic-queues-forked)
[200.006280] Starting subtest: basic-queues-forked
[222.893087] Subtest basic-queues-forked: SUCCESS (22.883s)
[223.076029] [041/133] (800s left) gem_mmap_wc (close)
[223.124894] Subtest close: SKIP (0.000s)
[223.185544] [042/133] (800s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[223.295269] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[223.299549] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[223.407905] [043/133] (799s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[223.500412] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu
[230.211164] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (6.711s)
[230.348933] [044/133] (793s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-20x20)
[230.453455] Starting subtest: planes-downscale-factor-0-5-upscale-20x20
[230.455778] Starting dynamic subtest: pipe-A
[230.473482] Dynamic subtest pipe-A: SKIP (0.018s)
[230.482756] Starting dynamic subtest: pipe-B
[230.509751] Dynamic subtest pipe-B: SKIP (0.034s)
[230.518385] Starting dynamic subtest: pipe-C
[230.540173] Dynamic subtest pipe-C: SKIP (0.030s)
[230.548675] Starting dynamic subtest: pipe-D
[230.568369] Dynamic subtest pipe-D: SKIP (0.030s)
[230.572614] Subtest planes-downscale-factor-0-5-upscale-20x20: SKIP (0.113s)
[230.677192] [045/133] (792s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-cc-modifier-source-clamping)
[230.768383] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-cc-modifier-source-clamping
[230.794290] Starting dynamic subtest: pipe-A-plane-0
[231.082502] Dynamic subtest pipe-A-plane-0: SUCCESS (0.289s)
[231.091048] Starting dynamic subtest: pipe-A-plane-3
[231.315735] Dynamic subtest pipe-A-plane-3: SUCCESS (0.233s)
[232.421215] Starting dynamic subtest: pipe-B-plane-0
[232.724965] Dynamic subtest pipe-B-plane-0: SUCCESS (0.311s)
[232.739246] Starting dynamic subtest: pipe-B-plane-3
[232.969127] Dynamic subtest pipe-B-plane-3: SUCCESS (0.242s)
[233.282367] Subtest pixel-format-4-tiled-mtl-rc-ccs-cc-modifier-source-clamping: SUCCESS (2.513s)
[234.094775] [046/133] (789s left) dmabuf_sync_file (export-multiwait)
[234.141933] Starting subtest: export-multiwait
[234.143852] Subtest export-multiwait: SUCCESS (0.000s)
[234.207428] [047/133] (789s left) drm_read (fault-buffer)
[234.338015] Starting subtest: fault-buffer
[234.340441] Subtest fault-buffer: SUCCESS (0.000s)
[234.467696] [048/133] (789s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[234.561678] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip
[235.540730] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (0.978s)
[235.661258] [049/133] (787s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[235.746442] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-gtt
[235.750544] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[235.847277] [050/133] (787s left) gem_pxp (create-regular-context-2)
[235.971356] Starting subtest: create-regular-context-2
[235.973534] Subtest create-regular-context-2: SUCCESS (0.001s)
[236.086874] [051/133] (787s left) kms_plane_scaling (invalid-num-scalers)
[236.173730] Starting subtest: invalid-num-scalers
[236.175685] Starting dynamic subtest: pipe-A-eDP-1-invalid-num-scalers
[236.189603] Dynamic subtest pipe-A-eDP-1-invalid-num-scalers: SUCCESS (0.017s)
[236.198524] Starting dynamic subtest: pipe-B-eDP-1-invalid-num-scalers
[236.221070] Dynamic subtest pipe-B-eDP-1-invalid-num-scalers: SUCCESS (0.030s)
[236.229532] Starting dynamic subtest: pipe-C-eDP-1-invalid-num-scalers
[236.254245] Dynamic subtest pipe-C-eDP-1-invalid-num-scalers: SUCCESS (0.031s)
[236.262452] Starting dynamic subtest: pipe-D-eDP-1-invalid-num-scalers
[236.285845] Dynamic subtest pipe-D-eDP-1-invalid-num-scalers: SUCCESS (0.029s)
[236.287463] Subtest invalid-num-scalers: SUCCESS (0.113s)
[236.390207] [052/133] (787s left) kms_ccs (ccs-on-another-bo-y-tiled-ccs)
[236.476631] Starting subtest: ccs-on-another-bo-y-tiled-ccs
[236.478562] Starting dynamic subtest: pipe-A-eDP-1
[236.497292] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[236.507582] Starting dynamic subtest: pipe-B-eDP-1
[236.524816] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[236.534023] Starting dynamic subtest: pipe-C-eDP-1
[236.550955] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[236.560554] Starting dynamic subtest: pipe-D-eDP-1
[236.578711] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[236.582052] Subtest ccs-on-another-bo-y-tiled-ccs: SKIP (0.004s)
[238.752040] [053/133] (785s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[238.849298] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[239.517584] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.670s)
[239.679549] [054/133] (784s left) kms_pm_rpm (modeset-pc8-residency-stress)
[241.197628] Starting subtest: modeset-pc8-residency-stress
[241.202236] Subtest modeset-pc8-residency-stress: SKIP (0.000s)
[241.905329] [055/133] (781s left) kms_flip (plain-flip-ts-check)
[241.989486] Starting subtest: plain-flip-ts-check
[241.991988] Starting dynamic subtest: A-eDP1
[250.881047] Dynamic subtest A-eDP1: SUCCESS (8.891s)
[250.891767] Starting dynamic subtest: B-eDP1
[259.713961] Dynamic subtest B-eDP1: SUCCESS (8.832s)
[259.724868] Starting dynamic subtest: C-eDP1
[268.530838] Dynamic subtest C-eDP1: SUCCESS (8.815s)
[268.544877] Starting dynamic subtest: D-eDP1
[277.365884] Dynamic subtest D-eDP1: SUCCESS (8.833s)
[277.368111] Subtest plain-flip-ts-check: SUCCESS (35.380s)
[278.551921] [056/133] (745s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-downscaling)
[278.664100] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-downscaling
[278.668499] Subtest flip-32bpp-yftile-to-64bpp-yftile-downscaling: SKIP (0.000s)
[278.736692] [057/133] (745s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[278.851516] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[278.855876] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[278.962673] [058/133] (745s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180-hflip)
[279.058744] Starting subtest: linear-max-hw-stride-64bpp-rotate-180-hflip
[279.063067] Subtest linear-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[279.162615] [059/133] (744s left) kms_joiner (invalid-modeset-ultra-joiner)
[279.252599] Starting subtest: invalid-modeset-ultra-joiner
[279.256714] Subtest invalid-modeset-ultra-joiner: SKIP (0.000s)
[279.351063] [060/133] (744s left) kms_cursor_legacy (2x-long-cursor-vs-flip-legacy)
[279.471867] Starting subtest: 2x-long-cursor-vs-flip-legacy
[279.479478] Subtest 2x-long-cursor-vs-flip-legacy: SKIP (0.004s)
[279.618123] [061/133] (744s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted)
[279.671389] Starting subtest: multi-wait-available-unsubmitted-submitted
[279.673310] Subtest multi-wait-available-unsubmitted-submitted: SUCCESS (0.000s)
[279.764832] [062/133] (744s left) i915_pm_freq_api (freq-reset)
[279.834178] Starting subtest: freq-reset
[279.836222] Starting dynamic subtest: gt0
[280.027704] Dynamic subtest gt0: SUCCESS (0.193s)
[280.037921] Starting dynamic subtest: gt1
[280.201629] Dynamic subtest gt1: SUCCESS (0.168s)
[280.204244] Subtest freq-reset: SUCCESS (0.363s)
[280.290463] [063/133] (743s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs)
[280.381340] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs
[280.383276] Starting dynamic subtest: pipe-A-eDP-1
[280.520810] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.131s)
[280.533203] Starting dynamic subtest: pipe-B-eDP-1
[280.553270] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[280.563486] Starting dynamic subtest: pipe-C-eDP-1
[280.582996] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.002s)
[280.591331] Starting dynamic subtest: pipe-D-eDP-1
[280.610996] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.002s)
[280.613235] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs: SUCCESS (0.140s)
[282.808612] [064/133] (741s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[282.897381] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[290.239406] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.344s)
[290.380550] [065/133] (733s left) kms_psr (fbc-pr-sprite-mmap-gtt)
[290.473299] Starting subtest: fbc-pr-sprite-mmap-gtt
[290.477426] Subtest fbc-pr-sprite-mmap-gtt: SKIP (0.000s)
[290.543126] [066/133] (733s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-plflip-blt)
[290.647242] Starting subtest: fbcpsr-2p-scndscrn-shrfb-plflip-blt
[290.651124] Subtest fbcpsr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[290.737447] [067/133] (733s left) prime_vgem (basic-fence-blt)
[290.833159] Starting subtest: basic-fence-blt
[290.917813] Subtest basic-fence-blt: SUCCESS (0.087s)
[291.057635] [068/133] (733s left) gem_ctx_persistence (engines-cleanup)
[291.118153] Starting subtest: engines-cleanup
[291.120471] Starting dynamic subtest: rcs0
[291.191565] Dynamic subtest rcs0: SUCCESS (0.073s)
[291.202083] Starting dynamic subtest: bcs0
[291.236302] Dynamic subtest bcs0: SUCCESS (0.043s)
[291.248548] Starting dynamic subtest: vcs0
[291.281112] Dynamic subtest vcs0: SUCCESS (0.043s)
[291.290790] Starting dynamic subtest: vcs1
[291.324128] Dynamic subtest vcs1: SUCCESS (0.041s)
[291.336382] Starting dynamic subtest: vecs0
[291.381346] Dynamic subtest vecs0: SUCCESS (0.055s)
[291.391917] Starting dynamic subtest: ccs0
[291.435270] Dynamic subtest ccs0: SUCCESS (0.052s)
[291.437437] Subtest engines-cleanup: SUCCESS (0.319s)
[291.527537] [069/133] (732s left) kms_getfb (getfb2-handle-protection)
[291.623463] Starting subtest: getfb2-handle-protection
[291.654099] Subtest getfb2-handle-protection: SUCCESS (0.031s)
[291.802019] [070/133] (732s left) gem_ctx_engines (invalid-engines)
[291.864029] Starting subtest: invalid-engines
[291.872855] Subtest invalid-engines: SUCCESS (0.009s)
[292.106592] [071/133] (732s left) prime_mmap_coherency (write)
[292.166051] Starting subtest: write
[297.547407] Subtest write: SUCCESS (5.380s)
[297.696727] [072/133] (726s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-render)
[297.805400] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-render
[301.929294] Subtest fbc-1p-offscreen-pri-shrfb-draw-render: SUCCESS (4.127s)
[303.075724] [073/133] (721s left) gem_exec_whisper (basic-fds-forked)
[303.139744] Starting subtest: basic-fds-forked
[328.315759] Subtest basic-fds-forked: SUCCESS (25.172s)
[328.501748] [074/133] (696s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[328.601293] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[328.605167] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[328.696503] [075/133] (695s left) gem_mmap_gtt (close-race)
[328.741183] Subtest close-race: SKIP (0.000s)
[328.800886] [076/133] (695s left) gen9_exec_parse (unaligned-access)
[328.874364] Subtest unaligned-access: SKIP (0.000s)
[328.948388] [077/133] (695s left) i915_query (hwconfig_table)
[328.998198] Starting subtest: hwconfig_table
[329.299882] Subtest hwconfig_table: SUCCESS (0.001s)
[329.341431] [078/133] (695s left) kms_flip (2x-flip-vs-modeset)
[329.443759] Starting subtest: 2x-flip-vs-modeset
[329.455471] Subtest 2x-flip-vs-modeset: SKIP (0.011s)
[329.571102] [079/133] (695s left) kms_psr (psr-cursor-mmap-cpu)
[329.669400] Starting subtest: psr-cursor-mmap-cpu
[329.671310] Starting dynamic subtest: eDP-1
[331.443815] Dynamic subtest eDP-1: SUCCESS (1.773s)
[331.446174] Subtest psr-cursor-mmap-cpu: SUCCESS (1.774s)
[332.312046] [080/133] (692s left) kms_cursor_legacy (torture-move)
[332.421712] Starting subtest: torture-move
[332.424062] Starting dynamic subtest: pipe-A
[338.182717] Dynamic subtest pipe-A: SUCCESS (5.759s)
[338.196358] Starting dynamic subtest: pipe-B
[344.731655] Dynamic subtest pipe-B: SUCCESS (6.547s)
[344.743916] Starting dynamic subtest: pipe-C
[352.223210] Dynamic subtest pipe-C: SUCCESS (7.490s)
[352.234611] Starting dynamic subtest: pipe-D
[358.796934] Dynamic subtest pipe-D: SUCCESS (6.571s)
[358.809104] Starting dynamic subtest: all-pipes
[365.191026] Dynamic subtest all-pipes: SUCCESS (6.392s)
[365.193651] Subtest torture-move: SUCCESS (32.769s)
[365.349301] [081/133] (659s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[365.477478] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[366.170676] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.694s)
[366.333329] [082/133] (658s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-yf-tiled)
[366.396573] Starting subtest: y-tiled-mc-ccs-to-vebox-yf-tiled
[366.401240] Subtest y-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[366.580534] [083/133] (658s left) prime_vgem (basic-write)
[366.663434] Starting subtest: basic-write
[366.695417] Subtest basic-write: SKIP (0.030s)
[366.836174] [084/133] (658s left) syncobj_wait (invalid-signal-zero-handles)
[366.899469] Starting subtest: invalid-signal-zero-handles
[366.901430] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[366.986451] [085/133] (658s left) tools_test (sysfs_l3_parity)
[367.041613] Starting subtest: sysfs_l3_parity
[367.125692] Subtest sysfs_l3_parity: SKIP (0.096s)
[367.182619] [086/133] (657s left) kms_cursor_crc (cursor-onscreen-32x32)
[367.350956] Starting subtest: cursor-onscreen-32x32
[367.397553] Subtest cursor-onscreen-32x32: SKIP (0.041s)
[367.696741] [087/133] (657s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions)
[367.815154] Starting subtest: cursor-vs-flip-atomic-transitions
[397.542772] Subtest cursor-vs-flip-atomic-transitions: SUCCESS (29.725s)
[398.353996] [088/133] (626s left) kms_content_protection (dp-mst-type-1-suspend-resume)
[398.495718] Starting subtest: dp-mst-type-1-suspend-resume
[398.500387] Subtest dp-mst-type-1-suspend-resume: SKIP (0.000s)
[398.634241] [089/133] (626s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-onoff)
[398.729757] Starting subtest: fbc-2p-scndscrn-spr-indfb-onoff
[398.733846] Subtest fbc-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[398.809549] [090/133] (626s left) syncobj_wait (invalid-reset-bad-pad)
[398.875941] Starting subtest: invalid-reset-bad-pad
[398.878303] Subtest invalid-reset-bad-pad: SUCCESS (0.000s)
[399.004848] [091/133] (626s left) kms_psr (fbc-pr-dpms)
[399.100995] Starting subtest: fbc-pr-dpms
[399.105120] Subtest fbc-pr-dpms: SKIP (0.000s)
[399.184312] [092/133] (626s left) gem_exec_balancer (smoke)
[399.240195] Starting subtest: smoke
[421.793783] Subtest smoke: SUCCESS (22.551s)
[423.094790] [093/133] (602s left) gem_exec_suspend (basic-s3)
[423.164577] Starting subtest: basic-S3
[423.166829] Starting dynamic subtest: smem
[444.407150] Dynamic subtest smem: SUCCESS (7.798s)
[444.409816] Subtest basic-S3: SUCCESS (7.801s)
[444.593788] [094/133] (580s left) syncobj_timeline (wait-all-delayed-signal)
[444.668076] Starting subtest: wait-all-delayed-signal
[444.770894] Subtest wait-all-delayed-signal: SUCCESS (0.104s)
[444.846270] [095/133] (580s left) kms_pm_rpm (basic-pci-d3-state)
[446.574046] Starting subtest: basic-pci-d3-state
[448.049358] Subtest basic-pci-d3-state: SUCCESS (1.491s)
[448.137711] [096/133] (577s left) gem_madvise (dontneed-after-mmap)
[448.174373] Starting subtest: dontneed-after-mmap
[448.192353] Subtest dontneed-after-mmap: SUCCESS (0.019s)
[448.291970] [097/133] (577s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions-varying-size)
[448.406182] Starting subtest: cursorA-vs-flipA-atomic-transitions-varying-size
[459.526652] Subtest cursorA-vs-flipA-atomic-transitions-varying-size: SUCCESS (11.173s)
[460.375350] [098/133] (565s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-cpu)
[460.492297] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-cpu
[460.496253] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[460.593336] [099/133] (565s left) gem_exec_reloc (basic-write-read-noreloc)
[460.652516] Subtest basic-write-read-noreloc: SKIP (0.000s)
[460.724519] [100/133] (565s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-exceed-sf)
[460.823275] Starting subtest: fbc-pr-overlay-plane-move-continuous-exceed-sf
[460.827697] Subtest fbc-pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[460.904217] [101/133] (564s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[461.020343] Starting subtest: basic-flip-after-cursor-varying-size
[461.953404] Subtest basic-flip-after-cursor-varying-size: SUCCESS (0.936s)
[462.805299] [102/133] (563s left) gem_readwrite (beyond-eob)
[462.859563] Subtest beyond-EOB: SKIP (0.000s)
[462.918445] [103/133] (562s left) gem_mmap_offset (partial-remap)
[462.962843] Starting subtest: partial-remap
[462.964760] Starting dynamic subtest: smem0
[462.973541] Dynamic subtest smem0: SUCCESS (0.003s)
[462.975765] Subtest partial-remap: SUCCESS (0.004s)
[463.089364] [104/133] (562s left) kms_cursor_crc (cursor-sliding-512x512)
[463.370054] Starting subtest: cursor-sliding-512x512
[463.374594] Subtest cursor-sliding-512x512: SKIP (0.001s)
[463.524938] [105/133] (562s left) kms_lease (page-flip-implicit-plane)
[463.621320] Starting subtest: page-flip-implicit-plane
[463.623539] Starting dynamic subtest: pipe-A-eDP-1
[464.102660] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.481s)
[464.114094] Starting dynamic subtest: pipe-B-eDP-1
[465.241781] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.139s)
[465.253038] Starting dynamic subtest: pipe-C-eDP-1
[466.349426] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.109s)
[466.359979] Starting dynamic subtest: pipe-D-eDP-1
[467.491164] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.142s)
[467.493860] Subtest page-flip-implicit-plane: SUCCESS (3.878s)
[468.337662] [106/133] (557s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled-ccs)
[468.391182] Starting subtest: yf-tiled-ccs-to-yf-tiled-ccs
[468.395589] Subtest yf-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[468.589265] [107/133] (557s left) gem_exec_reloc (basic-gtt-wc-active)
[468.648448] Subtest basic-gtt-wc-active: SKIP (0.000s)
[468.716590] [108/133] (557s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[468.811297] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[468.815236] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[468.917888] [109/133] (557s left) kms_flip (2x-plain-flip-interruptible)
[469.011738] Starting subtest: 2x-plain-flip-interruptible
[469.024756] Subtest 2x-plain-flip-interruptible: SKIP (0.013s)
[469.099132] [110/133] (557s left) kms_plane_lowres (tiling-y)
[469.188293] Starting subtest: tiling-y
[469.192595] Subtest tiling-y: SKIP (0.000s)
[469.263700] [111/133] (556s left) api_intel_bb (add-remove-objects)
[469.318569] Starting subtest: add-remove-objects
[469.322351] Subtest add-remove-objects: SUCCESS (0.007s)
[469.442514] [112/133] (556s left) kms_rotation_crc (primary-yf-tiled-reflect-x-0)
[469.541466] Starting subtest: primary-yf-tiled-reflect-x-0
[469.611839] Subtest primary-yf-tiled-reflect-x-0: SKIP (0.071s)
[469.714349] [113/133] (556s left) gem_userptr_blits (map-fixed-invalidate)
[469.786537] Starting subtest: map-fixed-invalidate
[469.790342] Subtest map-fixed-invalidate: SKIP (0.000s)
[469.917916] [114/133] (556s left) gem_softpin (evict-snoop-interruptible)
[469.979838] Starting subtest: evict-snoop-interruptible
[469.983662] Subtest evict-snoop-interruptible: SKIP (0.000s)
[470.107439] [115/133] (556s left) kms_chamelium_edid (dp-edid-change-during-suspend)
[470.486117] Subtest dp-edid-change-during-suspend: SKIP (0.000s)
[471.331640] [116/133] (555s left) perf_pmu (busy-double-start)
[471.377898] Starting subtest: busy-double-start
[471.380096] Starting dynamic subtest: rcs0
[475.014313] Dynamic subtest rcs0: FAIL (3.571s)
[475.025834] Starting dynamic subtest: bcs0
[478.522279] Dynamic subtest bcs0: SUCCESS (3.570s)
[478.535918] Starting dynamic subtest: vcs0
[482.888977] Dynamic subtest vcs0: SUCCESS (4.364s)
[482.901235] Starting dynamic subtest: vcs1
[486.925908] Dynamic subtest vcs1: SUCCESS (4.034s)
[486.939022] Starting dynamic subtest: vecs0
[490.896588] Dynamic subtest vecs0: SUCCESS (3.968s)
[490.909388] Starting dynamic subtest: ccs0
[494.534637] Dynamic subtest ccs0: FAIL (3.568s)
[494.536648] Subtest busy-double-start: FAIL (23.087s)
[494.579835] [117/133] (531s left) kms_pipe_stress (stress-xrgb8888-4tiled)
[494.674938] Starting subtest: stress-xrgb8888-4tiled
[500.596328] Subtest stress-xrgb8888-4tiled: SUCCESS (5.922s)
[500.647720] [118/133] (525s left) gem_ctx_sseu (mmap-args)
[500.708704] Subtest mmap-args: SKIP (0.000s)
[500.785717] [119/133] (525s left) gem_exec_balancer (bonded-dual)
[500.843395] Starting subtest: bonded-dual
[500.847751] Subtest bonded-dual: SKIP (0.000s)
[501.160223] [120/133] (525s left) gem_exec_flush (basic-uc-ro-default)
[501.224659] Starting subtest: basic-uc-ro-default
[506.676865] Subtest basic-uc-ro-default: SUCCESS (5.455s)
[506.864254] [121/133] (519s left) sw_sync (alloc_fence)
[506.912564] Starting subtest: alloc_fence
[506.914835] Subtest alloc_fence: SUCCESS (0.000s)
[506.963694] [122/133] (519s left) kms_flip (2x-blocking-absolute-wf_vblank)
[507.056579] Starting subtest: 2x-blocking-absolute-wf_vblank
[507.066575] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.010s)
[507.154611] [123/133] (519s left) gem_exec_schedule (independent)
[507.218581] Starting subtest: independent
[507.220753] Starting dynamic subtest: rcs0
[508.342371] Dynamic subtest rcs0: SUCCESS (1.126s)
[508.356135] Starting dynamic subtest: vcs0
[510.400546] Dynamic subtest vcs0: SUCCESS (2.056s)
[510.415016] Starting dynamic subtest: vcs1
[512.383343] Dynamic subtest vcs1: SUCCESS (1.982s)
[512.396415] Starting dynamic subtest: vecs0
[514.364475] Dynamic subtest vecs0: SUCCESS (1.979s)
[514.378331] Starting dynamic subtest: ccs0
[516.405631] Dynamic subtest ccs0: SUCCESS (2.039s)
[516.408310] Subtest independent: SUCCESS (9.193s)
[516.705337] [124/133] (510s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-blt)
[516.817475] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-blt
[520.540738] Subtest fbc-1p-primscrn-cur-indfb-draw-blt: SUCCESS (3.728s)
[521.747376] [125/133] (505s left) gem_request_retire (retire-vma-not-inactive)
[521.805115] Starting subtest: retire-vma-not-inactive
[521.864315] Subtest retire-vma-not-inactive: SUCCESS (0.056s)
[521.983664] [126/133] (504s left) kms_sequence (get-busy)
[522.083324] Starting subtest: get-busy
[522.085501] Starting dynamic subtest: pipe-A-eDP-1
[524.022253] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.939s)
[524.033351] Starting dynamic subtest: pipe-B-eDP-1
[526.625587] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.605s)
[526.636904] Starting dynamic subtest: pipe-C-eDP-1
[529.250242] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.622s)
[529.261509] Starting dynamic subtest: pipe-D-eDP-1
[531.790973] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.541s)
[531.793379] Subtest get-busy: SUCCESS (9.712s)
[532.592036] [127/133] (494s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc)
[532.686303] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc
[532.688658] Starting dynamic subtest: pipe-A-eDP-1
[532.712153] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[532.724853] Starting dynamic subtest: pipe-B-eDP-1
[532.746312] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[532.755601] Starting dynamic subtest: pipe-C-eDP-1
[532.776946] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[532.786661] Starting dynamic subtest: pipe-D-eDP-1
[532.808318] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[532.812669] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[534.950447] [128/133] (491s left) perf_pmu (busy-no-semaphores)
[534.994329] Starting subtest: busy-no-semaphores
[534.996599] Starting dynamic subtest: rcs0
[535.553535] Dynamic subtest rcs0: SUCCESS (0.558s)
[535.572033] Starting dynamic subtest: bcs0
[536.104332] Dynamic subtest bcs0: SUCCESS (0.547s)
[536.117980] Starting dynamic subtest: vcs0
[536.655403] Dynamic subtest vcs0: SUCCESS (0.548s)
[536.668441] Starting dynamic subtest: vcs1
[537.910988] Dynamic subtest vcs1: SUCCESS (1.253s)
[537.924622] Starting dynamic subtest: vecs0
[539.895625] Dynamic subtest vecs0: SUCCESS (1.980s)
[539.908738] Starting dynamic subtest: ccs0
[541.884400] Dynamic subtest ccs0: SUCCESS (1.984s)
[541.887394] Subtest busy-no-semaphores: SUCCESS (6.889s)
[542.004374] [129/133] (484s left) gem_spin_batch (legacy-resubmit)
[542.067976] Starting subtest: legacy-resubmit
[542.070819] Starting dynamic subtest: default
[542.078744] Dynamic subtest default: SUCCESS (0.011s)
[542.091704] Starting dynamic subtest: render
[542.094132] Dynamic subtest render: SUCCESS (0.001s)
[542.104318] Starting dynamic subtest: bsd
[542.106176] Dynamic subtest bsd: SUCCESS (0.004s)
[542.115644] Starting dynamic subtest: bsd1
[542.117532] Dynamic subtest bsd1: SUCCESS (0.001s)
[542.127118] Starting dynamic subtest: bsd2
[542.129183] Dynamic subtest bsd2: SUCCESS (0.005s)
[542.147040] Starting dynamic subtest: blt
[542.148967] Dynamic subtest blt: SUCCESS (0.003s)
[542.158561] Starting dynamic subtest: vebox
[542.160425] Dynamic subtest vebox: SUCCESS (0.004s)
[542.162337] Subtest legacy-resubmit: SUCCESS (0.034s)
[542.345911] [130/133] (484s left) gem_flink_race (flink_close)
[542.387662] Starting subtest: flink_close
[547.475319] Subtest flink_close: SUCCESS (5.086s)
[547.555248] [131/133] (479s left) kms_async_flips (async-flip-with-page-flip-events-tiled-atomic)
[547.657879] Starting subtest: async-flip-with-page-flip-events-tiled-atomic
[548.029754] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs
[550.826400] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: SUCCESS (2.795s)
[550.838594] Starting dynamic subtest: pipe-A-eDP-1-4
[553.002571] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.174s)
[553.020262] Starting dynamic subtest: pipe-A-eDP-1-4
[555.012333] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.008s)
[555.025888] Starting dynamic subtest: pipe-A-eDP-1-x
[557.202803] Dynamic subtest pipe-A-eDP-1-x: SUCCESS (2.189s)
[557.575846] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs
[560.355704] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: SUCCESS (2.786s)
[560.368012] Starting dynamic subtest: pipe-B-eDP-1-4
[562.529940] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.173s)
[562.542526] Starting dynamic subtest: pipe-B-eDP-1-4
[564.540618] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.010s)
[564.551070] Starting dynamic subtest: pipe-B-eDP-1-x
[566.730896] Dynamic subtest pipe-B-eDP-1-x: SUCCESS (2.187s)
[567.107484] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs
[569.890233] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.791s)
[569.903770] Starting dynamic subtest: pipe-C-eDP-1-4
[572.065395] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.172s)
[572.078165] Starting dynamic subtest: pipe-C-eDP-1-4
[574.075817] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.008s)
[574.088968] Starting dynamic subtest: pipe-C-eDP-1-x
[576.254084] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.177s)
[576.622695] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs
[579.417548] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.803s)
[579.430044] Starting dynamic subtest: pipe-D-eDP-1-4
[581.590899] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.173s)
[581.606915] Starting dynamic subtest: pipe-D-eDP-1-4
[583.601750] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.009s)
[583.612175] Starting dynamic subtest: pipe-D-eDP-1-x
[585.780555] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.177s)
[585.783072] Subtest async-flip-with-page-flip-events-tiled-atomic: SUCCESS (38.120s)
[587.002868] [132/133] (440s left) kms_vblank (wait-idle)
[587.106022] Starting subtest: wait-idle
[587.108306] Starting dynamic subtest: pipe-A-eDP-1
[588.861024] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.755s)
[588.876978] Starting dynamic subtest: pipe-D-eDP-1
[591.342223] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.476s)
[591.344085] Subtest wait-idle: SUCCESS (4.236s)
[592.168474] [133/133] (434s left) kms_atomic (plane-immutable-zpos)
[592.256077] Starting subtest: plane-immutable-zpos
[592.258308] Starting dynamic subtest: pipe-A-eDP-1
[592.899769] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.646s)
[592.902067] Subtest plane-immutable-zpos: SUCCESS (0.648s)
[593.704068] Closing watchdogs
results: parsing output: 0/ for test: syncobj_timeline
results: parsing output: 1/ for test: kms_ccs
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: gem_exec_schedule
results: parsing output: 4/ for test: gem_vm_create
results: parsing output: 5/ for test: syncobj_wait
results: parsing output: 6/ for test: syncobj_timeline
results: parsing output: 7/ for test: kms_psr
results: parsing output: 8/ for test: kms_big_fb
results: parsing output: 9/ for test: perf
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_psr_stress_test
results: parsing output: 12/ for test: api_intel_bb
results: parsing output: 13/ for test: kms_atomic_transition
results: parsing output: 14/ for test: gem_ctx_persistence
results: parsing output: 15/ for test: kms_dsc
results: parsing output: 16/ for test: gem_bad_reloc
results: parsing output: 17/ for test: kms_addfb_basic
results: parsing output: 18/ for test: kms_cursor_crc
results: parsing output: 19/ for test: kms_psr
results: parsing output: 20/ for test: gem_exec_fence
results: parsing output: 21/ for test: kms_psr2_sf
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: kms_chamelium_frames
results: parsing output: 24/ for test: gem_mmap_wc
results: parsing output: 25/ for test: kms_flip_scaled_crc
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: gem_userptr_blits
results: parsing output: 28/ for test: syncobj_timeline
results: parsing output: 29/ for test: kms_rmfb
results: parsing output: 30/ for test: gen9_exec_parse
results: parsing output: 31/ for test: kms_color_pipeline
results: parsing output: 32/ for test: syncobj_timeline
results: parsing output: 33/ for test: gem_eio
results: parsing output: 34/ for test: kms_chamelium_audio
results: parsing output: 35/ for test: i915_pm_rpm
results: parsing output: 36/ for test: kms_big_fb
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: gem_exec_fence
results: parsing output: 39/ for test: gem_exec_whisper
results: parsing output: 40/ for test: gem_mmap_wc
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_plane_scaling
results: parsing output: 44/ for test: kms_plane
results: parsing output: 45/ for test: dmabuf_sync_file
results: parsing output: 46/ for test: drm_read
results: parsing output: 47/ for test: kms_big_fb
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: gem_pxp
results: parsing output: 50/ for test: kms_plane_scaling
results: parsing output: 51/ for test: kms_ccs
results: parsing output: 52/ for test: kms_big_fb
results: parsing output: 53/ for test: kms_pm_rpm
results: parsing output: 54/ for test: kms_flip
results: parsing output: 55/ for test: kms_flip_scaled_crc
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_big_fb
results: parsing output: 58/ for test: kms_joiner
results: parsing output: 59/ for test: kms_cursor_legacy
results: parsing output: 60/ for test: syncobj_timeline
results: parsing output: 61/ for test: i915_pm_freq_api
results: parsing output: 62/ for test: kms_ccs
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_psr
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: prime_vgem
results: parsing output: 67/ for test: gem_ctx_persistence
results: parsing output: 68/ for test: kms_getfb
results: parsing output: 69/ for test: gem_ctx_engines
results: parsing output: 70/ for test: prime_mmap_coherency
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: gem_exec_whisper
results: parsing output: 73/ for test: kms_big_fb
results: parsing output: 74/ for test: gem_mmap_gtt
results: parsing output: 75/ for test: gen9_exec_parse
results: parsing output: 76/ for test: i915_query
results: parsing output: 77/ for test: kms_flip
results: parsing output: 78/ for test: kms_psr
results: parsing output: 79/ for test: kms_cursor_legacy
results: parsing output: 80/ for test: kms_big_fb
results: parsing output: 81/ for test: gem_render_copy
results: parsing output: 82/ for test: prime_vgem
results: parsing output: 83/ for test: syncobj_wait
results: parsing output: 84/ for test: tools_test
results: parsing output: 85/ for test: kms_cursor_crc
results: parsing output: 86/ for test: kms_cursor_legacy
results: parsing output: 87/ for test: kms_content_protection
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: syncobj_wait
results: parsing output: 90/ for test: kms_psr
results: parsing output: 91/ for test: gem_exec_balancer
results: parsing output: 92/ for test: gem_exec_suspend
results: parsing output: 93/ for test: syncobj_timeline
results: parsing output: 94/ for test: kms_pm_rpm
results: parsing output: 95/ for test: gem_madvise
results: parsing output: 96/ for test: kms_cursor_legacy
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: gem_exec_reloc
results: parsing output: 99/ for test: kms_psr2_sf
results: parsing output: 100/ for test: kms_cursor_legacy
results: parsing output: 101/ for test: gem_readwrite
results: parsing output: 102/ for test: gem_mmap_offset
results: parsing output: 103/ for test: kms_cursor_crc
results: parsing output: 104/ for test: kms_lease
results: parsing output: 105/ for test: gem_render_copy
results: parsing output: 106/ for test: gem_exec_reloc
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_flip
results: parsing output: 109/ for test: kms_plane_lowres
results: parsing output: 110/ for test: api_intel_bb
results: parsing output: 111/ for test: kms_rotation_crc
results: parsing output: 112/ for test: gem_userptr_blits
results: parsing output: 113/ for test: gem_softpin
results: parsing output: 114/ for test: kms_chamelium_edid
results: parsing output: 115/ for test: perf_pmu
results: parsing output: 116/ for test: kms_pipe_stress
results: parsing output: 117/ for test: gem_ctx_sseu
results: parsing output: 118/ for test: gem_exec_balancer
results: parsing output: 119/ for test: gem_exec_flush
results: parsing output: 120/ for test: sw_sync
results: parsing output: 121/ for test: kms_flip
results: parsing output: 122/ for test: gem_exec_schedule
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: gem_request_retire
results: parsing output: 125/ for test: kms_sequence
results: parsing output: 126/ for test: kms_ccs
results: parsing output: 127/ for test: perf_pmu
results: parsing output: 128/ for test: gem_spin_batch
results: parsing output: 129/ for test: gem_flink_race
results: parsing output: 130/ for test: kms_async_flips
results: parsing output: 131/ for test: kms_vblank
results: parsing output: 132/ for test: kms_atomic
Done.