[58.169585] Initializing watchdogs
[58.169704]   /dev/watchdog0
[58.185645] [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]
[58.190136] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.192311] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.195596] [001/133] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-move)
[58.328525] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-move
[58.332977] Subtest fbcpsr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[58.430090] [002/133] (960s left) i915_pm_rpm (debugfs-forcewake-user)
[60.479402] Starting subtest: debugfs-forcewake-user
[71.870505] Subtest debugfs-forcewake-user: SUCCESS (11.491s)
[72.250486] [003/133] (946s left) kms_vblank (query-idle-hang)
[72.374756] Starting subtest: query-idle-hang
[72.377073] Starting dynamic subtest: pipe-A-eDP-1
[99.089301] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.733s)
[99.101748] Starting dynamic subtest: pipe-D-eDP-1
[124.049909] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.954s)
[124.051830] Subtest query-idle-hang: SUCCESS (51.690s)
[124.875760] [004/133] (893s left) gem_render_copy (linear-to-vebox-y-tiled)
[124.940667] Starting subtest: linear-to-vebox-y-tiled
[124.945347] Subtest linear-to-vebox-y-tiled: SKIP (0.000s)
[125.122609] [005/133] (893s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs)
[125.221089] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs
[125.223518] Starting dynamic subtest: pipe-A-eDP-1
[125.282587] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[125.292148] Starting dynamic subtest: pipe-B-eDP-1
[125.351380] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[125.363772] Starting dynamic subtest: pipe-C-eDP-1
[125.420150] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[125.429060] Starting dynamic subtest: pipe-D-eDP-1
[125.485139] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[125.489394] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.008s)
[127.543122] [006/133] (891s left) kms_plane (pixel-format-4-tiled-dg2-mc-ccs-modifier)
[127.634219] Starting subtest: pixel-format-4-tiled-dg2-mc-ccs-modifier
[127.638828] Subtest pixel-format-4-tiled-dg2-mc-ccs-modifier: SKIP (0.000s)
[127.709795] [007/133] (891s left) kms_pm_dc (dc5-retention-flops)
[128.813653] Starting subtest: dc5-retention-flops
[128.818713] Subtest dc5-retention-flops: SKIP (0.000s)
[128.890277] [008/133] (890s left) kms_sequence (get-busy)
[128.986211] Starting subtest: get-busy
[128.988858] Starting dynamic subtest: pipe-A-eDP-1
[130.907798] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.922s)
[130.917583] Starting dynamic subtest: pipe-B-eDP-1
[133.536590] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.628s)
[133.544960] Starting dynamic subtest: pipe-C-eDP-1
[136.146623] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.610s)
[136.156136] Starting dynamic subtest: pipe-D-eDP-1
[138.684825] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.536s)
[138.687140] Subtest get-busy: SUCCESS (9.699s)
[139.481777] [009/133] (879s left) kms_flip (flip-vs-fences-interruptible)
[139.578560] Starting subtest: flip-vs-fences-interruptible
[139.582600] Subtest flip-vs-fences-interruptible: SKIP (0.000s)
[139.679294] [010/133] (879s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-downscaling)
[139.776018] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-downscaling
[139.780423] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-downscaling: SKIP (0.000s)
[139.846331] [011/133] (879s left) vgem_basic (second-client)
[139.911057] Starting subtest: second-client
[139.933286] Subtest second-client: SUCCESS (0.022s)
[139.986982] [FACT vgem_basic (second-client)] new: kernel.kmod_is_loaded.vgem: true
[139.990786] [012/133] (879s left) syncobj_timeline (wait-zero-handles)
[140.043874] Starting subtest: wait-zero-handles
[140.046081] Subtest wait-zero-handles: SUCCESS (0.000s)
[140.161988] [013/133] (879s left) kms_busy (extended-pageflip-modeset-hang-oldfb)
[140.264487] Starting subtest: extended-pageflip-modeset-hang-oldfb
[140.266565] Starting dynamic subtest: pipe-A
[148.166618] Dynamic subtest pipe-A: SUCCESS (7.902s)
[148.176118] Starting dynamic subtest: pipe-D
[156.793895] Dynamic subtest pipe-D: SUCCESS (8.622s)
[156.796262] Subtest extended-pageflip-modeset-hang-oldfb: SUCCESS (16.528s)
[157.631326] [014/133] (861s left) gem_softpin (overlap)
[157.694598] Starting subtest: overlap
[158.610070] Subtest overlap: SUCCESS (0.914s)
[158.716105] [015/133] (860s left) prime_self_import (basic-with_two_bos)
[158.749354] Starting subtest: basic-with_two_bos
[158.776148] Subtest basic-with_two_bos: SUCCESS (0.026s)
[158.882595] [016/133] (860s left) gem_spin_batch (engines)
[158.939872] Starting subtest: engines
[158.941914] Starting dynamic subtest: rcs0
[162.177439] Dynamic subtest rcs0: SUCCESS (3.235s)
[162.188266] Starting dynamic subtest: bcs0
[165.412866] Dynamic subtest bcs0: SUCCESS (3.234s)
[165.423528] Starting dynamic subtest: vcs0
[168.649145] Dynamic subtest vcs0: SUCCESS (3.235s)
[168.659386] Starting dynamic subtest: vcs1
[171.885733] Dynamic subtest vcs1: SUCCESS (3.235s)
[171.896080] Starting dynamic subtest: vecs0
[175.122959] Dynamic subtest vecs0: SUCCESS (3.235s)
[175.133041] Starting dynamic subtest: ccs0
[178.360372] Dynamic subtest ccs0: SUCCESS (3.236s)
[178.362887] Subtest engines: SUCCESS (19.418s)
[178.602746] [017/133] (840s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc)
[178.708874] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc
[185.525848] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (6.823s)
[185.667985] [018/133] (833s left) gem_readwrite (read-bad-handle)
[185.721590] Subtest read-bad-handle: SKIP (0.000s)
[185.772547] [019/133] (833s left) i915_drm_fdinfo (most-busy-idle-check-all)
[185.811132] Starting subtest: most-busy-idle-check-all
[185.813627] Starting dynamic subtest: rcs0
[185.818125] Dynamic subtest rcs0: SKIP (0.005s)
[185.827902] Starting dynamic subtest: bcs0
[185.832090] Dynamic subtest bcs0: SKIP (0.000s)
[185.840617] Starting dynamic subtest: vcs0
[185.845101] Dynamic subtest vcs0: SKIP (0.001s)
[185.853653] Starting dynamic subtest: vcs1
[185.857710] Dynamic subtest vcs1: SKIP (0.000s)
[185.865408] Starting dynamic subtest: vecs0
[185.869267] Dynamic subtest vecs0: SKIP (0.000s)
[185.876763] Starting dynamic subtest: ccs0
[185.880776] Dynamic subtest ccs0: SKIP (0.002s)
[185.884729] Subtest most-busy-idle-check-all: SKIP (0.012s)
[185.920648] [020/133] (833s left) syncobj_wait (single-wait-all-signaled)
[185.971933] Starting subtest: single-wait-all-signaled
[185.974386] Subtest single-wait-all-signaled: SUCCESS (0.000s)
[186.068377] [021/133] (833s left) kms_flip (2x-nonexisting-fb)
[186.157279] Starting subtest: 2x-nonexisting-fb
[186.166459] Subtest 2x-nonexisting-fb: SKIP (0.011s)
[186.251330] [022/133] (833s left) kms_big_fb (linear-16bpp-rotate-180)
[186.351072] Starting subtest: linear-16bpp-rotate-180
[187.719603] Subtest linear-16bpp-rotate-180: SUCCESS (1.369s)
[187.864623] [023/133] (831s left) gem_userptr_blits (sync-unmap-cycles)
[187.930224] Starting subtest: sync-unmap-cycles
[193.313070] Subtest sync-unmap-cycles: SUCCESS (5.381s)
[193.438927] [024/133] (826s left) gem_ctx_param (vm)
[193.483494] Starting subtest: vm
[193.569304] Subtest vm: SUCCESS (0.085s)
[193.687316] [025/133] (825s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling)
[193.787421] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling
[193.789458] Starting dynamic subtest: pipe-A-default-mode
[196.496904] Dynamic subtest pipe-A-default-mode: SUCCESS (2.707s)
[196.499235] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SUCCESS (2.708s)
[197.368582] [026/133] (822s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[197.471820] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[204.822834] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.354s)
[204.946445] [027/133] (814s left) kms_ccs (bad-pixel-format-y-tiled-gen12-mc-ccs)
[205.049828] Starting subtest: bad-pixel-format-y-tiled-gen12-mc-ccs
[205.052086] Starting dynamic subtest: pipe-A-eDP-1
[205.074522] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[205.085589] Starting dynamic subtest: pipe-B-eDP-1
[205.106723] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[205.115747] Starting dynamic subtest: pipe-C-eDP-1
[205.137625] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[205.146314] Starting dynamic subtest: pipe-D-eDP-1
[205.168261] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[205.172697] Subtest bad-pixel-format-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[207.353454] [028/133] (812s left) kms_plane (pixel-format-4-tiled-modifier)
[207.450989] Starting subtest: pixel-format-4-tiled-modifier
[207.477831] Starting dynamic subtest: pipe-A-plane-0
[208.099712] Dynamic subtest pipe-A-plane-0: SUCCESS (0.622s)
[208.109073] Starting dynamic subtest: pipe-A-plane-3
[208.510727] Dynamic subtest pipe-A-plane-3: SUCCESS (0.410s)
[208.519828] Starting dynamic subtest: pipe-A-plane-5
[208.523501] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[209.647889] Starting dynamic subtest: pipe-B-plane-0
[210.284274] Dynamic subtest pipe-B-plane-0: SUCCESS (0.644s)
[210.293124] Starting dynamic subtest: pipe-B-plane-3
[210.705748] Dynamic subtest pipe-B-plane-3: SUCCESS (0.422s)
[210.719262] Starting dynamic subtest: pipe-B-plane-5
[210.722943] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[211.019308] Subtest pixel-format-4-tiled-modifier: SUCCESS (3.569s)
[211.822812] [029/133] (808s left) kms_content_protection (legacy)
[211.973172] Starting subtest: legacy
[211.977647] Subtest legacy: SKIP (0.000s)
[212.104731] [030/133] (807s left) syncobj_timeline (invalid-query-one-illegal-handle)
[212.155625] Starting subtest: invalid-query-one-illegal-handle
[212.157754] Subtest invalid-query-one-illegal-handle: SUCCESS (0.000s)
[212.271860] [031/133] (807s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-wc)
[212.362803] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-wc
[212.367235] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[212.464977] [032/133] (807s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-pgflip-blt)
[212.564343] Starting subtest: fbcpsr-1p-primscrn-shrfb-pgflip-blt
[219.905432] Subtest fbcpsr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.343s)
[220.065102] [033/133] (799s left) kms_plane_scaling (invalid-num-scalers)
[220.162094] Starting subtest: invalid-num-scalers
[220.164309] Starting dynamic subtest: pipe-A-eDP-1-invalid-num-scalers
[220.182488] Dynamic subtest pipe-A-eDP-1-invalid-num-scalers: SUCCESS (0.021s)
[220.191603] Starting dynamic subtest: pipe-B-eDP-1-invalid-num-scalers
[220.220066] Dynamic subtest pipe-B-eDP-1-invalid-num-scalers: SUCCESS (0.035s)
[220.229070] Starting dynamic subtest: pipe-C-eDP-1-invalid-num-scalers
[220.256086] Dynamic subtest pipe-C-eDP-1-invalid-num-scalers: SUCCESS (0.035s)
[220.264856] Starting dynamic subtest: pipe-D-eDP-1-invalid-num-scalers
[220.294139] Dynamic subtest pipe-D-eDP-1-invalid-num-scalers: SUCCESS (0.036s)
[220.296438] Subtest invalid-num-scalers: SUCCESS (0.133s)
[220.405805] [034/133] (799s left) kms_addfb_basic (basic-x-tiled-legacy)
[220.457136] Starting subtest: basic-x-tiled-legacy
[220.461659] Subtest basic-x-tiled-legacy: SKIP (0.000s)
[220.607897] [035/133] (799s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[220.674712] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[220.679202] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[220.856634] [036/133] (799s left) kms_async_flips (invalid-async-flip-atomic)
[220.950861] Starting subtest: invalid-async-flip-atomic
[221.337809] Starting dynamic subtest: pipe-A-eDP-1
[222.180725] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.843s)
[222.540278] Starting dynamic subtest: pipe-B-eDP-1
[223.325329] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.792s)
[223.691241] Starting dynamic subtest: pipe-C-eDP-1
[224.536821] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.853s)
[224.900831] Starting dynamic subtest: pipe-D-eDP-1
[225.663515] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.772s)
[225.665874] Subtest invalid-async-flip-atomic: SUCCESS (4.715s)
[226.821941] [037/133] (793s left) prime_vgem (basic-read)
[226.889682] Starting subtest: basic-read
[226.913650] Subtest basic-read: SKIP (0.022s)
[227.023452] [038/133] (793s left) kms_psr (psr2-dpms)
[227.111558] Starting subtest: psr2-dpms
[227.113735] Starting dynamic subtest: eDP-1
[229.944593] Dynamic subtest eDP-1: SUCCESS (2.835s)
[229.946895] Subtest psr2-dpms: SUCCESS (2.836s)
[230.809945] [039/133] (789s left) syncobj_timeline (signal)
[230.868538] Starting subtest: signal
[230.870804] Subtest signal: SUCCESS (0.000s)
[230.969818] [040/133] (789s left) gem_vm_create (execbuf)
[231.025363] Starting subtest: execbuf
[231.032764] Subtest execbuf: SUCCESS (0.007s)
[231.155346] [041/133] (789s left) gem_exec_balancer (noheartbeat)
[231.428755] Starting subtest: noheartbeat
[231.433064] Subtest noheartbeat: SKIP (0.000s)
[231.550538] [042/133] (788s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc)
[231.642251] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc
[231.644570] Starting dynamic subtest: pipe-A-eDP-1
[231.665459] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[231.676110] Starting dynamic subtest: pipe-B-eDP-1
[231.696315] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[231.705379] Starting dynamic subtest: pipe-C-eDP-1
[231.725985] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[231.735135] Starting dynamic subtest: pipe-D-eDP-1
[231.754773] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[231.756996] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.008s)
[233.882522] [043/133] (786s left) perf (polling-parameterized)
[233.992501] Starting subtest: polling-parameterized
[254.013896] Subtest polling-parameterized: SUCCESS (20.019s)
[254.065286] [044/133] (766s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[254.174838] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu
[258.188642] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (4.017s)
[259.386558] [045/133] (761s left) kms_rotation_crc (sprite-rotation-270)
[259.485282] Starting subtest: sprite-rotation-270
[259.489145] Subtest sprite-rotation-270: SKIP (0.001s)
[259.558611] [046/133] (760s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc)
[259.655802] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc
[266.401545] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (6.747s)
[266.543438] [047/133] (754s left) gem_exec_reloc (basic-write-gtt)
[266.608982] Subtest basic-write-gtt: SKIP (0.000s)
[266.685615] [048/133] (753s left) gem_close_race (multigpu-basic-process)
[266.751447] Starting subtest: multigpu-basic-process
[266.755600] Subtest multigpu-basic-process: SKIP (0.000s)
[266.981375] [049/133] (753s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0)
[267.091304] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0
[268.103430] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.012s)
[268.249671] [050/133] (752s left) kms_chamelium_color (gamma)
[268.339097] Subtest gamma: SKIP (0.000s)
[268.384464] [051/133] (752s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-move)
[268.479060] Starting subtest: psr-1p-primscrn-cur-indfb-move
[275.920280] Subtest psr-1p-primscrn-cur-indfb-move: SUCCESS (7.442s)
[276.075074] [052/133] (744s left) kms_feature_discovery (display-1x)
[276.179086] Starting subtest: display-1x
[276.181295] Subtest display-1x: SUCCESS (0.000s)
[276.252513] [053/133] (744s left) perf_pmu (init-wait)
[276.291905] Starting subtest: init-wait
[276.294194] Starting dynamic subtest: rcs0
[276.296481] Dynamic subtest rcs0: SUCCESS (0.002s)
[276.305630] Starting dynamic subtest: bcs0
[276.307530] Dynamic subtest bcs0: SUCCESS (0.000s)
[276.315907] Starting dynamic subtest: vcs0
[276.317838] Dynamic subtest vcs0: SUCCESS (0.001s)
[276.326596] Starting dynamic subtest: vcs1
[276.328803] Dynamic subtest vcs1: SUCCESS (0.001s)
[276.337314] Starting dynamic subtest: vecs0
[276.339501] Dynamic subtest vecs0: SUCCESS (0.001s)
[276.348076] Starting dynamic subtest: ccs0
[276.350232] Dynamic subtest ccs0: SUCCESS (0.000s)
[276.352439] Subtest init-wait: SUCCESS (0.009s)
[276.418204] [054/133] (744s left) gem_mmap_gtt (basic-small-bo-tiledy)
[276.480016] Subtest basic-small-bo-tiledY: SKIP (0.000s)
[276.545401] [055/133] (744s left) gem_userptr_blits (coherency-sync)
[276.615050] Starting subtest: coherency-sync
[277.068983] Subtest coherency-sync: SKIP (0.416s)
[277.172612] [056/133] (743s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite)
[277.310632] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite
[277.315059] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[277.413093] [057/133] (743s left) kms_atomic_transition (plane-all-transition-fencing)
[277.505417] Starting subtest: plane-all-transition-fencing
[277.507189] Starting dynamic subtest: pipe-A-eDP-1
[280.012096] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.508s)
[280.320300] Starting dynamic subtest: pipe-B-eDP-1
[283.570746] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.258s)
[283.888431] Subtest plane-all-transition-fencing: SUCCESS (6.383s)
[284.691578] [058/133] (736s left) gem_userptr_blits (map-fixed-invalidate-overlap)
[284.764100] Starting subtest: map-fixed-invalidate-overlap
[284.768249] Subtest map-fixed-invalidate-overlap: SKIP (0.000s)
[284.903409] [059/133] (736s left) i915_selftest (live)
[288.291457] Starting subtest: live
[288.294444] Starting dynamic subtest: sanitycheck
[292.673773] Dynamic subtest sanitycheck: SUCCESS (4.381s)
[292.682151] Starting dynamic subtest: uncore
[295.400663] Dynamic subtest uncore: SUCCESS (2.723s)
[295.410567] Starting dynamic subtest: workarounds
[313.419500] Dynamic subtest workarounds: FAIL (17.841s)
[313.427940] Starting dynamic subtest: gt_engines
[317.831880] Dynamic subtest gt_engines: SUCCESS (4.587s)
[317.841954] Starting dynamic subtest: gt_timelines
[334.094964] Dynamic subtest gt_timelines: SUCCESS (16.261s)
[334.104797] Starting dynamic subtest: gt_contexts
[338.468982] Dynamic subtest gt_contexts: SUCCESS (4.372s)
[338.478250] Starting dynamic subtest: gt_lrc
[344.673332] Dynamic subtest gt_lrc: SUCCESS (6.202s)
[344.682648] Starting dynamic subtest: gt_mocs
[347.678339] Dynamic subtest gt_mocs: SUCCESS (3.003s)
[347.690821] Starting dynamic subtest: gt_pm
[354.516936] Dynamic subtest gt_pm: SUCCESS (6.836s)
[354.525417] Starting dynamic subtest: gt_heartbeat
[358.976677] Dynamic subtest gt_heartbeat: SUCCESS (4.457s)
[358.986547] Starting dynamic subtest: gt_tlb
[368.969593] Dynamic subtest gt_tlb: SUCCESS (9.991s)
[368.979011] Starting dynamic subtest: requests
[382.458327] Dynamic subtest requests: SUCCESS (13.488s)
[382.468550] Starting dynamic subtest: migrate
[390.233690] Dynamic subtest migrate: SUCCESS (7.773s)
[390.245615] Starting dynamic subtest: active
[394.590218] Dynamic subtest active: SUCCESS (4.354s)
[394.600093] Starting dynamic subtest: objects
[397.938694] Dynamic subtest objects: SUCCESS (3.347s)
[397.948061] Starting dynamic subtest: mman
[402.735213] Dynamic subtest mman: SUCCESS (4.794s)
[402.744668] Starting dynamic subtest: dmabuf
[407.122984] Dynamic subtest dmabuf: SUCCESS (4.385s)
[407.132805] Starting dynamic subtest: vma
[411.464367] Dynamic subtest vma: SUCCESS (4.339s)
[411.474231] Starting dynamic subtest: coherency
[414.981963] Dynamic subtest coherency: SUCCESS (3.515s)
[414.992677] Starting dynamic subtest: gtt
[425.287293] Dynamic subtest gtt: SUCCESS (10.303s)
[425.296994] Starting dynamic subtest: gem
[433.043036] Dynamic subtest gem: SUCCESS (7.754s)
[433.052817] Starting dynamic subtest: evict
[438.488590] Dynamic subtest evict: SUCCESS (5.444s)
[438.501281] Starting dynamic subtest: hugepages
[449.928797] Dynamic subtest hugepages: SUCCESS (11.438s)
[449.938782] Starting dynamic subtest: gem_contexts
[477.847339] Dynamic subtest gem_contexts: SUCCESS (27.916s)
[477.856646] Starting dynamic subtest: client
[480.655620] Dynamic subtest client: SUCCESS (2.807s)
[480.665785] Starting dynamic subtest: gem_migrate
[485.020783] Dynamic subtest gem_migrate: SUCCESS (4.364s)
[485.030990] Starting dynamic subtest: reset
[487.818310] Dynamic subtest reset: SUCCESS (2.796s)
[487.828632] Starting dynamic subtest: memory_region
[490.510536] Dynamic subtest memory_region: SUCCESS (2.691s)
[490.519939] Starting dynamic subtest: hangcheck
[504.092627] Dynamic subtest hangcheck: SUCCESS (13.580s)
[504.102588] Starting dynamic subtest: execlists
[508.461694] Dynamic subtest execlists: SUCCESS (4.367s)
[508.471666] Starting dynamic subtest: ring_submission
[512.898349] Dynamic subtest ring_submission: SUCCESS (4.435s)
[512.908315] Starting dynamic subtest: perf
[517.272681] Dynamic subtest perf: SUCCESS (4.371s)
[517.281991] Starting dynamic subtest: slpc
[531.773533] Dynamic subtest slpc: SUCCESS (14.499s)
[531.781734] Starting dynamic subtest: guc
[535.720540] Dynamic subtest guc: SUCCESS (3.944s)
[535.731025] Starting dynamic subtest: guc_multi_lrc
[540.114028] Dynamic subtest guc_multi_lrc: SUCCESS (4.392s)
[540.123614] Starting dynamic subtest: guc_hang
[545.061688] Dynamic subtest guc_hang: SUCCESS (4.946s)
[545.072163] Starting dynamic subtest: late_gt_pm
[547.815045] Dynamic subtest late_gt_pm: SUCCESS (2.752s)
[547.818056] Subtest live: FAIL (259.513s)
[547.846803] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[547.847568] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[547.850865] [060/133] (473s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[549.432563] Starting subtest: basic-flip-before-cursor-legacy
[551.203799] Subtest basic-flip-before-cursor-legacy: SUCCESS (1.766s)
[551.581732] [FACT kms_cursor_legacy (basic-flip-before-cursor-legacy)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[551.583071] [FACT kms_cursor_legacy (basic-flip-before-cursor-legacy)] new: kernel.kmod_is_loaded.i915: true
[551.587050] [061/133] (469s left) gem_shrink (reclaim)
[551.656993] Starting subtest: reclaim
[554.130747] Subtest reclaim: SUCCESS (2.475s)
[554.285782] [062/133] (466s left) gem_exec_schedule (promotion)
[554.365079] Starting subtest: promotion
[554.367087] Starting dynamic subtest: rcs0
[554.559045] Dynamic subtest rcs0: SUCCESS (0.197s)
[554.568604] Starting dynamic subtest: vcs0
[554.713065] Dynamic subtest vcs0: SUCCESS (0.153s)
[554.725316] Starting dynamic subtest: vcs1
[554.838514] Dynamic subtest vcs1: SUCCESS (0.124s)
[554.848123] Starting dynamic subtest: vecs0
[554.970754] Dynamic subtest vecs0: SUCCESS (0.132s)
[554.984155] Starting dynamic subtest: ccs0
[555.108170] Dynamic subtest ccs0: SUCCESS (0.136s)
[555.110286] Subtest promotion: SUCCESS (0.748s)
[556.406935] [063/133] (464s left) gem_exec_store (pages)
[556.486188] Starting subtest: pages
[556.488103] Starting dynamic subtest: rcs0
[556.577804] Dynamic subtest rcs0: SUCCESS (0.094s)
[556.590057] Starting dynamic subtest: bcs0
[556.653982] Dynamic subtest bcs0: SUCCESS (0.075s)
[556.665893] Starting dynamic subtest: vcs0
[556.748771] Dynamic subtest vcs0: SUCCESS (0.094s)
[556.760327] Starting dynamic subtest: vcs1
[556.819425] Dynamic subtest vcs1: SUCCESS (0.069s)
[556.830712] Starting dynamic subtest: vecs0
[556.884501] Dynamic subtest vecs0: SUCCESS (0.064s)
[556.897041] Starting dynamic subtest: ccs0
[556.950662] Dynamic subtest ccs0: SUCCESS (0.066s)
[556.953034] Subtest pages: SUCCESS (0.468s)
[557.132501] [064/133] (464s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-onoff)
[557.229543] Starting subtest: fbc-2p-primscrn-cur-indfb-onoff
[557.233686] Subtest fbc-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[557.324922] [065/133] (464s left) gem_lmem_swapping (parallel-random-verify)
[557.370939] Subtest parallel-random-verify: SKIP (0.000s)
[557.420199] [066/133] (463s left) kms_plane_scaling (planes-downscale-factor-0-75-unity-scaling)
[557.530982] Starting subtest: planes-downscale-factor-0-75-unity-scaling
[557.533377] Starting dynamic subtest: pipe-A
[557.595217] Dynamic subtest pipe-A: SUCCESS (0.067s)
[557.606890] Starting dynamic subtest: pipe-B
[558.766417] Dynamic subtest pipe-B: SUCCESS (1.170s)
[558.775969] Starting dynamic subtest: pipe-C
[559.886591] Dynamic subtest pipe-C: SUCCESS (1.119s)
[559.899512] Starting dynamic subtest: pipe-D
[561.014132] Dynamic subtest pipe-D: SUCCESS (1.127s)
[561.016546] Subtest planes-downscale-factor-0-75-unity-scaling: SUCCESS (3.486s)
[562.312016] [067/133] (459s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[562.569342] Starting subtest: cursor-rapid-movement-256x256
[562.574982] Starting dynamic subtest: pipe-A-eDP-1
[563.139769] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.567s)
[563.172239] Starting dynamic subtest: pipe-D-eDP-1
[565.375461] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.208s)
[565.378175] Subtest cursor-rapid-movement-256x256: SUCCESS (2.806s)
[565.867872] [068/133] (455s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[565.969561] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[565.974021] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[566.084338] [069/133] (455s left) kms_getfb (getfb-repeated-different-handles)
[566.176031] Starting subtest: getfb-repeated-different-handles
[566.178257] Subtest getfb-repeated-different-handles: SUCCESS (0.000s)
[566.276924] [070/133] (455s left) kms_pm_rpm (system-suspend-idle)
[568.411860] Starting subtest: system-suspend-idle
[588.688714] Subtest system-suspend-idle: SUCCESS (4.713s)
[589.049310] [071/133] (432s left) gem_mmap_gtt (big-copy)
[589.125860] Subtest big-copy: SKIP (0.000s)
[589.186570] [072/133] (432s left) kms_color (ctm-0-75)
[589.292899] Starting subtest: ctm-0-75
[589.295109] Starting dynamic subtest: pipe-A-eDP-1
[594.225041] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.044s)
[594.235709] Starting dynamic subtest: pipe-B-eDP-1
[600.946824] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.793s)
[600.956996] Starting dynamic subtest: pipe-C-eDP-1
[606.956458] Dynamic subtest pipe-C-eDP-1: SUCCESS (6.036s)
[606.968177] Starting dynamic subtest: pipe-D-eDP-1
[612.265421] Dynamic subtest pipe-D-eDP-1: SUCCESS (5.322s)
[612.267349] Subtest ctm-0-75: SUCCESS (23.200s)
[613.091706] [073/133] (408s left) kms_chamelium_hpd (common-hpd-after-suspend)
[613.496140] Subtest common-hpd-after-suspend: SKIP (0.000s)
[614.294887] [074/133] (407s left) kms_psr2_sf (pr-overlay-plane-update-continuous-sf)
[614.389345] Starting subtest: pr-overlay-plane-update-continuous-sf
[614.393391] Subtest pr-overlay-plane-update-continuous-sf: SKIP (0.000s)
[614.457740] [075/133] (407s left) i915_fb_tiling (basic-x-tiling)
[614.512432] Subtest basic-x-tiling: SKIP (0.000s)
[614.583721] [076/133] (407s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-plflip-blt)
[614.680485] Starting subtest: fbc-2p-scndscrn-shrfb-plflip-blt
[614.684756] Subtest fbc-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[614.766606] [077/133] (407s left) perf (gen12-mi-rpc)
[614.914711] Starting subtest: gen12-mi-rpc
[614.917030] Starting dynamic subtest: rcs0
[614.934876] Dynamic subtest rcs0: SUCCESS (0.019s)
[614.937117] Subtest gen12-mi-rpc: SUCCESS (0.020s)
[614.978479] [078/133] (406s left) kms_lease (lease-invalid-plane)
[615.096072] Starting subtest: lease-invalid-plane
[615.098198] Starting dynamic subtest: pipe-A-eDP-1
[615.100453] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[615.110363] Starting dynamic subtest: pipe-B-eDP-1
[615.112533] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[615.122537] Starting dynamic subtest: pipe-C-eDP-1
[615.124787] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[615.134181] Starting dynamic subtest: pipe-D-eDP-1
[615.136289] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[615.138418] Subtest lease-invalid-plane: SUCCESS (0.004s)
[615.176249] [079/133] (406s left) gem_exec_reloc (basic-gtt-cpu-active)
[615.234025] Subtest basic-gtt-cpu-active: SKIP (0.000s)
[615.290340] [080/133] (406s left) gem_userptr_blits (stress-mm-invalidate-close-overlap)
[615.339467] Starting subtest: stress-mm-invalidate-close-overlap
[617.487787] Subtest stress-mm-invalidate-close-overlap: SUCCESS (2.148s)
[617.627197] [081/133] (404s left) gem_mmap_gtt (basic-read)
[617.686290] Subtest basic-read: SKIP (0.000s)
[617.753920] [082/133] (404s left) kms_cursor_crc (cursor-offscreen-32x32)
[617.900545] Starting subtest: cursor-offscreen-32x32
[617.950535] Subtest cursor-offscreen-32x32: SKIP (0.044s)
[618.224475] [083/133] (403s left) kms_psr2_su (frontbuffer-xrgb8888)
[618.284176] Subtest frontbuffer-XRGB8888: SKIP (0.000s)
[618.359809] [084/133] (403s left) gem_mmap_gtt (cpuset-medium-copy)
[618.424431] Subtest cpuset-medium-copy: SKIP (0.000s)
[618.485725] [085/133] (403s left) prime_mmap (test_correct)
[618.538318] Starting subtest: test_correct
[618.540033] Starting dynamic subtest: test_correct-smem
[618.570494] Dynamic subtest test_correct-smem: SUCCESS (0.033s)
[618.572548] Subtest test_correct: SUCCESS (0.034s)
[618.662168] [086/133] (403s left) kms_joiner (basic-force-big-joiner)
[618.753216] Starting subtest: basic-force-big-joiner
[618.756858] Subtest basic-force-big-joiner: SKIP (0.000s)
[618.821332] [087/133] (403s left) kms_cursor_edge_walk (256x256-top-edge)
[618.920356] Starting subtest: 256x256-top-edge
[618.922255] Starting dynamic subtest: pipe-A-eDP-1
[622.368256] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.445s)
[622.379689] Starting dynamic subtest: pipe-D-eDP-1
[625.507319] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.137s)
[625.509632] Subtest 256x256-top-edge: SUCCESS (6.584s)
[626.329483] [088/133] (395s left) kms_flip (2x-absolute-wf_vblank)
[626.425430] Starting subtest: 2x-absolute-wf_vblank
[626.435263] Subtest 2x-absolute-wf_vblank: SKIP (0.012s)
[626.530134] [089/133] (395s left) gem_exec_capture (capture-recoverable)
[626.594036] Starting subtest: capture-recoverable
[626.599310] Subtest capture-recoverable: SUCCESS (0.003s)
[626.725600] [090/133] (395s left) kms_psr (fbc-psr-primary-mmap-cpu)
[626.827826] Starting subtest: fbc-psr-primary-mmap-cpu
[626.830006] Starting dynamic subtest: eDP-1
[626.833955] Dynamic subtest eDP-1: SKIP (0.000s)
[626.837949] Subtest fbc-psr-primary-mmap-cpu: SKIP (0.001s)
[626.901438] [091/133] (395s left) gem_ctx_persistence (heartbeat-stop)
[626.964318] Starting subtest: heartbeat-stop
[626.969055] Subtest heartbeat-stop: SKIP (0.000s)
[627.071179] [092/133] (395s left) gem_softpin (evict-snoop)
[627.131708] Starting subtest: evict-snoop
[627.136223] Subtest evict-snoop: SKIP (0.000s)
[627.241305] [093/133] (395s left) dmabuf_sync_file (export-wait-after-attach)
[627.281231] Starting subtest: export-wait-after-attach
[627.283027] Subtest export-wait-after-attach: SUCCESS (0.001s)
[627.340095] [094/133] (395s left) kms_big_fb (y-tiled-addfb-size-overflow)
[627.433433] Starting subtest: y-tiled-addfb-size-overflow
[627.437316] Subtest y-tiled-addfb-size-overflow: SKIP (0.000s)
[627.537718] [095/133] (395s left) syncobj_timeline (etime-multi-wait-for-submit-available-unsubmitted)
[627.584802] Starting subtest: etime-multi-wait-for-submit-available-unsubmitted
[627.688726] Subtest etime-multi-wait-for-submit-available-unsubmitted: SUCCESS (0.103s)
[627.765283] [096/133] (394s left) api_intel_bb (intel-bb-blit-x)
[627.827495] Starting subtest: intel-bb-blit-x
[631.510842] Subtest intel-bb-blit-x: SUCCESS (3.682s)
[631.643630] [097/133] (391s left) kms_addfb_basic (too-wide)
[631.744928] Starting subtest: too-wide
[631.746715] Subtest too-wide: SUCCESS (0.000s)
[631.854887] [098/133] (390s left) kms_psr (psr-primary-mmap-cpu)
[631.941874] Starting subtest: psr-primary-mmap-cpu
[631.944145] Starting dynamic subtest: eDP-1
[633.722545] Dynamic subtest eDP-1: SUCCESS (1.779s)
[633.724859] Subtest psr-primary-mmap-cpu: SUCCESS (1.781s)
[634.587060] [099/133] (388s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions-varying-size)
[634.707561] Starting subtest: short-flip-after-cursor-atomic-transitions-varying-size
[635.677162] Subtest short-flip-after-cursor-atomic-transitions-varying-size: SUCCESS (0.969s)
[636.521466] [100/133] (386s left) gem_exec_fence (syncobj-wait)
[636.972186] Starting subtest: syncobj-wait
[637.951950] Subtest syncobj-wait: SUCCESS (0.978s)
[638.282873] [101/133] (384s left) kms_pipe_crc_basic (nonblocking-crc)
[638.381157] Starting subtest: nonblocking-crc
[638.383050] Starting dynamic subtest: pipe-A-eDP-1
[639.121948] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.742s)
[639.132956] Starting dynamic subtest: pipe-B-eDP-1
[640.573346] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.450s)
[640.583975] Starting dynamic subtest: pipe-C-eDP-1
[641.921589] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.346s)
[641.934099] Starting dynamic subtest: pipe-D-eDP-1
[643.254879] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.331s)
[643.257021] Subtest nonblocking-crc: SUCCESS (4.874s)
[644.044729] [102/133] (378s left) gem_exec_reloc (basic-write-cpu-noreloc)
[644.098507] Subtest basic-write-cpu-noreloc: SKIP (0.000s)
[644.169217] [103/133] (378s left) gem_exec_fence (syncobj-timeline-chain-engines)
[644.696482] Starting subtest: syncobj-timeline-chain-engines
[644.802870] Subtest syncobj-timeline-chain-engines: SUCCESS (0.107s)
[646.032230] [104/133] (376s left) kms_psr (pr-primary-mmap-cpu)
[646.120046] Starting subtest: pr-primary-mmap-cpu
[646.124493] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[646.196789] [105/133] (376s left) kms_cursor_legacy (2x-long-flip-vs-cursor-legacy)
[646.322354] Starting subtest: 2x-long-flip-vs-cursor-legacy
[646.326695] Subtest 2x-long-flip-vs-cursor-legacy: SKIP (0.001s)
[646.471999] [106/133] (376s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[646.572964] Starting subtest: fbc-psr2-cursor-plane-update-sf
[646.575462] Starting dynamic subtest: pipe-A-eDP-1
[646.648668] Dynamic subtest pipe-A-eDP-1: SKIP (0.078s)
[646.661687] Starting dynamic subtest: pipe-B-eDP-1
[647.815963] Dynamic subtest pipe-B-eDP-1: SKIP (1.166s)
[647.820520] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (1.247s)
[649.028171] [107/133] (374s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-msflip-blt)
[649.121644] Starting subtest: fbcpsr-2p-scndscrn-indfb-msflip-blt
[649.125752] Subtest fbcpsr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[649.223533] [108/133] (373s left) kms_rotation_crc (primary-y-tiled-reflect-x-270)
[649.312021] Starting subtest: primary-y-tiled-reflect-x-270
[649.316498] Subtest primary-y-tiled-reflect-x-270: SKIP (0.001s)
[649.386024] [109/133] (373s left) gem_pxp (dmabuf-shared-protected-dst-is-context-refcounted)
[649.506205] Starting subtest: dmabuf-shared-protected-dst-is-context-refcounted
[649.640192] Subtest dmabuf-shared-protected-dst-is-context-refcounted: SUCCESS (0.136s)
[649.767429] [110/133] (373s left) kms_psr (fbc-pr-sprite-mmap-gtt)
[649.860005] Starting subtest: fbc-pr-sprite-mmap-gtt
[649.864463] Subtest fbc-pr-sprite-mmap-gtt: SKIP (0.000s)
[649.935380] [111/133] (373s left) gem_mmap_gtt (basic)
[649.995689] Subtest basic: SKIP (0.000s)
[650.055362] [112/133] (373s left) syncobj_eventfd (binary-wait-signaled)
[650.109619] Starting subtest: binary-wait-signaled
[650.111487] Subtest binary-wait-signaled: SUCCESS (0.000s)
[650.225178] [113/133] (373s left) kms_force_connector_basic (prune-stale-modes)
[650.295984] Starting subtest: prune-stale-modes
[650.739096] Subtest prune-stale-modes: SUCCESS (0.445s)
[650.877189] [114/133] (372s left) sw_sync (alloc_timeline)
[650.913437] Starting subtest: alloc_timeline
[650.915383] Subtest alloc_timeline: SUCCESS (0.000s)
[650.966978] [115/133] (372s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc)
[651.056004] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc
[651.057938] Starting dynamic subtest: pipe-A-eDP-1
[651.076257] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[651.087379] Starting dynamic subtest: pipe-B-eDP-1
[651.105244] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[651.114577] Starting dynamic subtest: pipe-C-eDP-1
[651.131579] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[651.140694] Starting dynamic subtest: pipe-D-eDP-1
[651.158465] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[651.162017] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SKIP (0.007s)
[653.344568] [116/133] (370s left) gem_mmap_offset (mmap-unmap)
[653.415431] Starting subtest: mmap-unmap
[653.417392] Starting dynamic subtest: smem0
[677.778610] Dynamic subtest smem0: SUCCESS (24.368s)
[677.781612] Subtest mmap-unmap: SUCCESS (24.369s)
[677.902807] [117/133] (345s left) kms_dp_linktrain_fallback (dsc-fallback)
[678.004731] Starting subtest: dsc-fallback
[678.011094] Subtest dsc-fallback: SKIP (0.000s)
[678.090771] [118/133] (345s left) gem_ccs (ctrl-surf-copy-new-ctx)
[678.150520] Starting subtest: ctrl-surf-copy-new-ctx
[678.155135] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s)
[678.268624] [119/133] (345s left) gem_eio (in-flight-contexts-immediate)
[678.506944] Starting subtest: in-flight-contexts-immediate
[689.990232] Subtest in-flight-contexts-immediate: SUCCESS (11.477s)
[690.171411] [120/133] (333s left) kms_cdclk (mode-transition-all-outputs)
[690.274222] Starting subtest: mode-transition-all-outputs
[690.566699] Subtest mode-transition-all-outputs: SKIP (0.291s)
[691.431467] [121/133] (332s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-blt)
[691.528234] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-blt
[698.677879] Subtest psr-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (7.149s)
[698.834534] [122/133] (324s left) gem_ctx_shared (q-smoketest)
[698.902013] Starting subtest: Q-smoketest
[698.903881] Starting dynamic subtest: rcs0
[704.461370] Dynamic subtest rcs0: SUCCESS (5.510s)
[704.474957] Starting dynamic subtest: bcs0
[709.970441] Dynamic subtest bcs0: SUCCESS (5.506s)
[709.984118] Starting dynamic subtest: vcs0
[715.449015] Dynamic subtest vcs0: SUCCESS (5.479s)
[715.460108] Starting dynamic subtest: vcs1
[720.932813] Dynamic subtest vcs1: SUCCESS (5.484s)
[720.945998] Starting dynamic subtest: vecs0
[726.424354] Dynamic subtest vecs0: SUCCESS (5.483s)
[726.436979] Starting dynamic subtest: ccs0
[731.941245] Dynamic subtest ccs0: SUCCESS (5.517s)
[731.943325] Subtest Q-smoketest: SUCCESS (32.986s)
[732.097949] [123/133] (291s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-blt)
[732.205609] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-blt
[732.209991] Subtest psr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[732.318666] [124/133] (291s left) gem_exec_schedule (preempt-other-chain)
[732.388067] Starting subtest: preempt-other-chain
[732.390059] Starting dynamic subtest: rcs0
[732.464655] Dynamic subtest rcs0: SUCCESS (0.084s)
[732.479056] Starting dynamic subtest: bcs0
[732.546180] Dynamic subtest bcs0: SUCCESS (0.080s)
[732.562734] Starting dynamic subtest: vcs0
[732.625852] Dynamic subtest vcs0: SUCCESS (0.079s)
[732.643180] Starting dynamic subtest: vcs1
[732.716641] Dynamic subtest vcs1: SUCCESS (0.091s)
[732.728377] Starting dynamic subtest: vecs0
[732.800628] Dynamic subtest vecs0: SUCCESS (0.082s)
[732.816137] Starting dynamic subtest: ccs0
[732.884553] Dynamic subtest ccs0: SUCCESS (0.083s)
[732.887528] Subtest preempt-other-chain: SUCCESS (0.504s)
[734.006396] [125/133] (289s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted)
[734.071719] Starting subtest: multi-wait-all-for-submit-unsubmitted
[734.176967] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.104s)
[734.256327] [126/133] (289s left) syncobj_timeline (multi-wait-all-for-submit-signaled)
[734.308545] Starting subtest: multi-wait-all-for-submit-signaled
[734.310882] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.001s)
[734.421519] [127/133] (289s left) gen9_exec_parse (batch-without-end)
[734.493003] Subtest batch-without-end: SKIP (0.000s)
[734.557493] [128/133] (289s left) perf (buffer-fill)
[734.650722] Starting subtest: buffer-fill
[734.653108] Starting dynamic subtest: 0-rcs0
[736.963602] Dynamic subtest 0-rcs0: SUCCESS (2.310s)
[736.977278] Starting dynamic subtest: 1-vcs0
[741.406414] Dynamic subtest 1-vcs0: SUCCESS (4.443s)
[741.408619] Subtest buffer-fill: SUCCESS (6.756s)
[741.460432] [129/133] (282s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[741.550364] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[742.219351] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.670s)
[742.394085] [130/133] (281s left) api_intel_bb (crc32)
[742.449946] Starting subtest: crc32
[742.451943] Starting dynamic subtest: rcs0-smem0
[742.721618] Dynamic subtest rcs0-smem0: SUCCESS (0.271s)
[742.733358] Starting dynamic subtest: bcs0-smem0
[743.026430] Dynamic subtest bcs0-smem0: SUCCESS (0.304s)
[743.039357] Starting dynamic subtest: vcs0-smem0
[743.399442] Dynamic subtest vcs0-smem0: SUCCESS (0.369s)
[743.412704] Starting dynamic subtest: vcs1-smem0
[743.769809] Dynamic subtest vcs1-smem0: SUCCESS (0.367s)
[743.782115] Starting dynamic subtest: vecs0-smem0
[744.108310] Dynamic subtest vecs0-smem0: SUCCESS (0.336s)
[744.120973] Starting dynamic subtest: ccs0-smem0
[744.453216] Dynamic subtest ccs0-smem0: SUCCESS (0.342s)
[744.455853] Subtest crc32: SUCCESS (2.006s)
[744.577861] [131/133] (279s left) tools_test (sysfs_l3_parity)
[744.633802] Starting subtest: sysfs_l3_parity
[744.711370] Subtest sysfs_l3_parity: SKIP (0.092s)
[744.766026] [132/133] (279s left) kms_big_fb (x-tiled-32bpp-rotate-90)
[744.872259] Starting subtest: x-tiled-32bpp-rotate-90
[744.892945] Subtest x-tiled-32bpp-rotate-90: SKIP (0.020s)
[745.019474] [133/133] (279s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt)
[745.114296] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt
[745.118627] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[745.213546] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: i915_pm_rpm
results: parsing output: 2/ for test: kms_vblank
results: parsing output: 3/ for test: gem_render_copy
results: parsing output: 4/ for test: kms_ccs
results: parsing output: 5/ for test: kms_plane
results: parsing output: 6/ for test: kms_pm_dc
results: parsing output: 7/ for test: kms_sequence
results: parsing output: 8/ for test: kms_flip
results: parsing output: 9/ for test: kms_flip_scaled_crc
results: parsing output: 10/ for test: vgem_basic
results: parsing output: 11/ for test: syncobj_timeline
results: parsing output: 12/ for test: kms_busy
results: parsing output: 13/ for test: gem_softpin
results: parsing output: 14/ for test: prime_self_import
results: parsing output: 15/ for test: gem_spin_batch
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: gem_readwrite
results: parsing output: 18/ for test: i915_drm_fdinfo
results: parsing output: 19/ for test: syncobj_wait
results: parsing output: 20/ for test: kms_flip
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: gem_userptr_blits
results: parsing output: 23/ for test: gem_ctx_param
results: parsing output: 24/ for test: kms_flip_scaled_crc
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_ccs
results: parsing output: 27/ for test: kms_plane
results: parsing output: 28/ for test: kms_content_protection
results: parsing output: 29/ for test: syncobj_timeline
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: kms_plane_scaling
results: parsing output: 33/ for test: kms_addfb_basic
results: parsing output: 34/ for test: gem_render_copy
results: parsing output: 35/ for test: kms_async_flips
results: parsing output: 36/ for test: prime_vgem
results: parsing output: 37/ for test: kms_psr
results: parsing output: 38/ for test: syncobj_timeline
results: parsing output: 39/ for test: gem_vm_create
results: parsing output: 40/ for test: gem_exec_balancer
results: parsing output: 41/ for test: kms_ccs
results: parsing output: 42/ for test: perf
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: kms_rotation_crc
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: gem_exec_reloc
results: parsing output: 47/ for test: gem_close_race
results: parsing output: 48/ for test: kms_big_fb
results: parsing output: 49/ for test: kms_chamelium_color
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: kms_feature_discovery
results: parsing output: 52/ for test: perf_pmu
results: parsing output: 53/ for test: gem_mmap_gtt
results: parsing output: 54/ for test: gem_userptr_blits
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: kms_atomic_transition
results: parsing output: 57/ for test: gem_userptr_blits
results: parsing output: 58/ for test: i915_selftest
results: parsing output: 59/ for test: kms_cursor_legacy
results: parsing output: 60/ for test: gem_shrink
results: parsing output: 61/ for test: gem_exec_schedule
results: parsing output: 62/ for test: gem_exec_store
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: gem_lmem_swapping
results: parsing output: 65/ for test: kms_plane_scaling
results: parsing output: 66/ for test: kms_cursor_crc
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: kms_getfb
results: parsing output: 69/ for test: kms_pm_rpm
results: parsing output: 70/ for test: gem_mmap_gtt
results: parsing output: 71/ for test: kms_color
results: parsing output: 72/ for test: kms_chamelium_hpd
results: parsing output: 73/ for test: kms_psr2_sf
results: parsing output: 74/ for test: i915_fb_tiling
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: perf
results: parsing output: 77/ for test: kms_lease
results: parsing output: 78/ for test: gem_exec_reloc
results: parsing output: 79/ for test: gem_userptr_blits
results: parsing output: 80/ for test: gem_mmap_gtt
results: parsing output: 81/ for test: kms_cursor_crc
results: parsing output: 82/ for test: kms_psr2_su
results: parsing output: 83/ for test: gem_mmap_gtt
results: parsing output: 84/ for test: prime_mmap
results: parsing output: 85/ for test: kms_joiner
results: parsing output: 86/ for test: kms_cursor_edge_walk
results: parsing output: 87/ for test: kms_flip
results: parsing output: 88/ for test: gem_exec_capture
results: parsing output: 89/ for test: kms_psr
results: parsing output: 90/ for test: gem_ctx_persistence
results: parsing output: 91/ for test: gem_softpin
results: parsing output: 92/ for test: dmabuf_sync_file
results: parsing output: 93/ for test: kms_big_fb
results: parsing output: 94/ for test: syncobj_timeline
results: parsing output: 95/ for test: api_intel_bb
results: parsing output: 96/ for test: kms_addfb_basic
results: parsing output: 97/ for test: kms_psr
results: parsing output: 98/ for test: kms_cursor_legacy
results: parsing output: 99/ for test: gem_exec_fence
results: parsing output: 100/ for test: kms_pipe_crc_basic
results: parsing output: 101/ for test: gem_exec_reloc
results: parsing output: 102/ for test: gem_exec_fence
results: parsing output: 103/ for test: kms_psr
results: parsing output: 104/ for test: kms_cursor_legacy
results: parsing output: 105/ for test: kms_psr2_sf
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_rotation_crc
results: parsing output: 108/ for test: gem_pxp
results: parsing output: 109/ for test: kms_psr
results: parsing output: 110/ for test: gem_mmap_gtt
results: parsing output: 111/ for test: syncobj_eventfd
results: parsing output: 112/ for test: kms_force_connector_basic
results: parsing output: 113/ for test: sw_sync
results: parsing output: 114/ for test: kms_ccs
results: parsing output: 115/ for test: gem_mmap_offset
results: parsing output: 116/ for test: kms_dp_linktrain_fallback
results: parsing output: 117/ for test: gem_ccs
results: parsing output: 118/ for test: gem_eio
results: parsing output: 119/ for test: kms_cdclk
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: gem_ctx_shared
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: gem_exec_schedule
results: parsing output: 124/ for test: syncobj_wait
results: parsing output: 125/ for test: syncobj_timeline
results: parsing output: 126/ for test: gen9_exec_parse
results: parsing output: 127/ for test: perf
results: parsing output: 128/ for test: kms_big_fb
results: parsing output: 129/ for test: api_intel_bb
results: parsing output: 130/ for test: tools_test
results: parsing output: 131/ for test: kms_big_fb
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.