[60.901046] Initializing watchdogs
[60.901094]   /dev/watchdog0
[60.916315] [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]
[60.920801] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[60.922892] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.924827] [001/133] (960s left) kms_sequence (get-idle)
[61.023211] Starting subtest: get-idle
[61.024175] Starting dynamic subtest: pipe-A-eDP-1
[62.864405] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.834s)
[62.870463] Starting dynamic subtest: pipe-B-eDP-1
[65.366709] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.496s)
[65.373226] Starting dynamic subtest: pipe-C-eDP-1
[67.883139] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.511s)
[67.888762] Starting dynamic subtest: pipe-D-eDP-1
[70.322773] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.436s)
[70.323701] Subtest get-idle: SUCCESS (9.281s)
[71.126376] [002/133] (950s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc)
[71.220334] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc
[71.222112] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[71.322431] [003/133] (950s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[71.426168] Starting subtest: fbc-psr2-cursor-plane-update-sf
[71.427149] Starting dynamic subtest: pipe-A-eDP-1
[71.515968] Dynamic subtest pipe-A-eDP-1: SKIP (0.089s)
[71.524516] Starting dynamic subtest: pipe-B-eDP-1
[72.595506] Dynamic subtest pipe-B-eDP-1: SKIP (1.078s)
[72.597390] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (1.169s)
[73.786307] [004/133] (947s left) perf (gen12-unprivileged-single-ctx-counters)
[73.922319] Starting subtest: gen12-unprivileged-single-ctx-counters
[73.923089] Starting dynamic subtest: rcs0
[74.000359] Dynamic subtest rcs0: SUCCESS (0.078s)
[74.001302] Subtest gen12-unprivileged-single-ctx-counters: SUCCESS (0.079s)
[74.044508] [005/133] (947s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-blt)
[74.160822] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-blt
[81.086434] Subtest psr-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (6.922s)
[81.219623] [006/133] (940s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-cc-modifier)
[81.319071] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-cc-modifier
[81.346215] Starting dynamic subtest: pipe-A-plane-0
[81.635664] Dynamic subtest pipe-A-plane-0: SUCCESS (0.289s)
[81.643106] Starting dynamic subtest: pipe-A-plane-3
[81.868723] Dynamic subtest pipe-A-plane-3: SUCCESS (0.233s)
[81.875021] Starting dynamic subtest: pipe-A-plane-5
[81.876784] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[83.006937] Starting dynamic subtest: pipe-B-plane-0
[83.300184] Dynamic subtest pipe-B-plane-0: SUCCESS (0.300s)
[83.308818] Starting dynamic subtest: pipe-B-plane-3
[83.544817] Dynamic subtest pipe-B-plane-3: SUCCESS (0.244s)
[83.552146] Starting dynamic subtest: pipe-B-plane-5
[83.553815] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[83.859152] Subtest pixel-format-4-tiled-mtl-rc-ccs-cc-modifier: SUCCESS (2.539s)
[84.683601] [007/133] (936s left) kms_psr (fbc-psr2-primary-mmap-gtt)
[84.776353] Starting subtest: fbc-psr2-primary-mmap-gtt
[84.777349] Starting dynamic subtest: eDP-1
[84.779457] Dynamic subtest eDP-1: SKIP (0.000s)
[84.781211] Subtest fbc-psr2-primary-mmap-gtt: SKIP (0.000s)
[84.843943] [008/133] (936s left) gem_render_copy (y-tiled-ccs-to-y-tiled)
[84.896991] Starting subtest: y-tiled-ccs-to-y-tiled
[84.899412] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s)
[85.086841] [009/133] (936s left) api_intel_allocator (two-level-inception-interruptible)
[85.134980] Starting subtest: two-level-inception-interruptible
[90.586865] Subtest two-level-inception-interruptible: SUCCESS (5.406s)
[90.664586] [010/133] (931s left) kms_flip (plain-flip-interruptible)
[90.769924] Starting subtest: plain-flip-interruptible
[90.771095] Starting dynamic subtest: A-eDP1
[92.491965] Dynamic subtest A-eDP1: SUCCESS (1.720s)
[92.499661] Starting dynamic subtest: B-eDP1
[94.124170] Dynamic subtest B-eDP1: SUCCESS (1.630s)
[94.132505] Starting dynamic subtest: C-eDP1
[95.750207] Dynamic subtest C-eDP1: SUCCESS (1.625s)
[95.758565] Starting dynamic subtest: D-eDP1
[97.372314] Dynamic subtest D-eDP1: SUCCESS (1.621s)
[97.375328] Subtest plain-flip-interruptible: SUCCESS (6.603s)
[98.552194] [011/133] (923s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs)
[98.636322] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs
[98.638047] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[99.772643] [012/133] (922s left) kms_flip (2x-flip-vs-fences)
[99.871539] Starting subtest: 2x-flip-vs-fences
[99.873478] Subtest 2x-flip-vs-fences: SKIP (0.000s)
[99.956531] [013/133] (921s left) kms_chamelium_hpd (vga-hpd-after-suspend)
[100.322895] Subtest vga-hpd-after-suspend: SKIP (0.000s)
[101.167745] [014/133] (920s left) gem_mmap_gtt (basic-small-copy-xy)
[101.220204] Subtest basic-small-copy-XY: SKIP (0.000s)
[101.264418] [015/133] (920s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-gtt)
[101.345849] Starting subtest: psr-rgb101010-draw-mmap-gtt
[101.347453] Subtest psr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[101.428697] [016/133] (920s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-signa
[101.475999] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-signaled
[101.578566] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-signaled: SUCCESS (0.102s)
[101.645823] [017/133] (920s left) gem_exec_schedule (submit-golden-slice)
[101.706720] Starting subtest: submit-golden-slice
[101.707957] Starting dynamic subtest: rcs0
[101.743641] Dynamic subtest rcs0: SUCCESS (0.037s)
[101.752793] Starting dynamic subtest: bcs0
[101.778601] Dynamic subtest bcs0: SUCCESS (0.035s)
[101.785669] Starting dynamic subtest: vcs0
[101.809467] Dynamic subtest vcs0: SUCCESS (0.031s)
[101.816256] Starting dynamic subtest: vcs1
[101.844945] Dynamic subtest vcs1: SUCCESS (0.035s)
[101.853767] Starting dynamic subtest: vecs0
[101.877371] Dynamic subtest vecs0: SUCCESS (0.032s)
[101.884736] Starting dynamic subtest: ccs0
[101.909056] Dynamic subtest ccs0: SUCCESS (0.031s)
[101.909975] Subtest submit-golden-slice: SUCCESS (0.203s)
[103.011277] [018/133] (918s left) kms_psr (psr-cursor-mmap-cpu)
[103.105890] Starting subtest: psr-cursor-mmap-cpu
[103.106697] Starting dynamic subtest: eDP-1
[104.790364] Dynamic subtest eDP-1: SUCCESS (1.683s)
[104.791334] Subtest psr-cursor-mmap-cpu: SUCCESS (1.684s)
[105.652163] [019/133] (916s left) kms_big_fb (x-tiled-32bpp-rotate-270)
[105.754250] Starting subtest: x-tiled-32bpp-rotate-270
[105.774272] Subtest x-tiled-32bpp-rotate-270: SKIP (0.020s)
[105.880242] [020/133] (916s left) kms_flip (flip-vs-blocking-wf-vblank)
[105.967124] Starting subtest: flip-vs-blocking-wf-vblank
[105.968024] Starting dynamic subtest: A-eDP1
[114.914102] Dynamic subtest A-eDP1: SUCCESS (8.946s)
[114.921508] Starting dynamic subtest: B-eDP1
[123.846558] Dynamic subtest B-eDP1: SUCCESS (8.929s)
[123.854029] Starting dynamic subtest: C-eDP1
[132.804781] Dynamic subtest C-eDP1: SUCCESS (8.920s)
[132.810985] Starting dynamic subtest: D-eDP1
[141.741861] Dynamic subtest D-eDP1: SUCCESS (8.936s)
[141.742753] Subtest flip-vs-blocking-wf-vblank: SUCCESS (35.741s)
[142.923964] [021/133] (879s left) gem_mmap_gtt (isolation)
[142.978404] Subtest isolation: SKIP (0.000s)
[143.034156] [022/133] (879s left) kms_atomic_transition (plane-all-modeset-transition-internal-panels)
[143.125993] Starting subtest: plane-all-modeset-transition-internal-panels
[143.126857] Starting dynamic subtest: pipe-A-eDP-1
[144.480866] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.345s)
[144.755235] Starting dynamic subtest: pipe-B-eDP-1
[145.797312] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.040s)
[146.055652] Subtest plane-all-modeset-transition-internal-panels: SUCCESS (2.929s)
[146.893505] [023/133] (875s left) syncobj_timeline (single-wait-for-submit-available-submitted)
[146.949186] Starting subtest: single-wait-for-submit-available-submitted
[146.950235] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.000s)
[147.039573] [024/133] (875s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen)
[147.135123] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen
[147.136853] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[147.219359] [025/133] (874s left) vgem_basic (setversion)
[147.291487] Starting subtest: setversion
[147.293195] Subtest setversion: SUCCESS (0.000s)
[147.344349] [FACT vgem_basic (setversion)] new: kernel.kmod_is_loaded.vgem: true
[147.346327] [026/133] (874s left) syncobj_timeline (invalid-query-illegal-handle)
[147.404065] Starting subtest: invalid-query-illegal-handle
[147.405072] Subtest invalid-query-illegal-handle: SUCCESS (0.000s)
[147.498349] [027/133] (874s left) gem_ctx_persistence (engines-persistence)
[147.549526] Starting subtest: engines-persistence
[147.558395] Starting dynamic subtest: rcs0
[148.374505] Dynamic subtest rcs0: SUCCESS (0.824s)
[148.385367] Starting dynamic subtest: bcs0
[149.134321] Dynamic subtest bcs0: SUCCESS (0.759s)
[149.143220] Starting dynamic subtest: vcs0
[149.900530] Dynamic subtest vcs0: SUCCESS (0.765s)
[149.909542] Starting dynamic subtest: vcs1
[150.675622] Dynamic subtest vcs1: SUCCESS (0.774s)
[150.687219] Starting dynamic subtest: vecs0
[151.451659] Dynamic subtest vecs0: SUCCESS (0.775s)
[151.460411] Starting dynamic subtest: ccs0
[152.191213] Dynamic subtest ccs0: SUCCESS (0.737s)
[152.192404] Subtest engines-persistence: SUCCESS (4.641s)
[152.308099] [028/133] (869s left) gem_request_retire (retire-vma-not-inactive)
[152.364653] Starting subtest: retire-vma-not-inactive
[152.424572] Subtest retire-vma-not-inactive: SUCCESS (0.059s)
[152.554416] [029/133] (869s left) kms_cursor_crc (cursor-onscreen-128x128)
[152.762267] Starting subtest: cursor-onscreen-128x128
[152.765896] Starting dynamic subtest: pipe-A-eDP-1
[154.852645] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.086s)
[154.880631] Starting dynamic subtest: pipe-D-eDP-1
[157.676425] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.801s)
[157.677562] Subtest cursor-onscreen-128x128: SUCCESS (4.913s)
[158.462901] [030/133] (863s left) kms_color (invalid-ctm-matrix-sizes)
[158.550069] Starting subtest: invalid-ctm-matrix-sizes
[158.550922] Starting dynamic subtest: pipe-A
[158.551793] Dynamic subtest pipe-A: SUCCESS (0.002s)
[158.558205] Starting dynamic subtest: pipe-B
[158.559059] Dynamic subtest pipe-B: SUCCESS (0.003s)
[158.565259] Starting dynamic subtest: pipe-C
[158.566080] Dynamic subtest pipe-C: SUCCESS (0.003s)
[158.572044] Starting dynamic subtest: pipe-D
[158.572879] Dynamic subtest pipe-D: SUCCESS (0.004s)
[158.573776] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.014s)
[158.640455] [031/133] (863s left) kms_pipe_crc_basic (bad-source)
[158.723162] Starting subtest: bad-source
[158.724079] Subtest bad-source: SUCCESS (0.000s)
[158.795945] [032/133] (863s left) kms_dirtyfb (psr-dirtyfb-ioctl)
[158.874393] Starting subtest: psr-dirtyfb-ioctl
[158.875359] Starting dynamic subtest: A-eDP-1
[162.771943] Dynamic subtest A-eDP-1: SUCCESS (3.897s)
[162.772833] Subtest psr-dirtyfb-ioctl: SUCCESS (3.898s)
[163.562216] [033/133] (858s left) kms_rotation_crc (primary-y-tiled-reflect-x-90)
[163.648262] Starting subtest: primary-y-tiled-reflect-x-90
[163.649998] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s)
[163.712558] [034/133] (858s left) gem_exec_reloc (basic-gtt-active)
[163.767894] Subtest basic-gtt-active: SKIP (0.000s)
[163.830763] [035/133] (858s left) kms_rotation_crc (bad-tiling)
[163.907928] Starting subtest: bad-tiling
[163.909614] Subtest bad-tiling: SKIP (0.001s)
[163.974537] [036/133] (858s left) kms_async_flips (invalid-async-flip)
[164.060349] Starting subtest: invalid-async-flip
[164.445924] Starting dynamic subtest: pipe-A-eDP-1
[165.300714] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.855s)
[165.672297] Starting dynamic subtest: pipe-B-eDP-1
[166.444909] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.778s)
[166.811212] Starting dynamic subtest: pipe-C-eDP-1
[167.573752] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.773s)
[167.925509] Starting dynamic subtest: pipe-D-eDP-1
[168.700619] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.781s)
[168.702702] Subtest invalid-async-flip: SUCCESS (4.642s)
[169.845213] [037/133] (852s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[169.935510] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[169.937359] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[170.035567] [038/133] (852s left) gem_mmap_gtt (basic-small-bo-tiledx)
[170.091519] Subtest basic-small-bo-tiledX: SKIP (0.000s)
[170.156909] [039/133] (852s left) gem_mmap_wc (coherency)
[170.216518] Subtest coherency: SKIP (0.000s)
[170.276865] [040/133] (852s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-downscaling)
[170.366737] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-downscaling
[170.368938] Subtest flip-64bpp-ytile-to-32bpp-ytile-downscaling: SKIP (0.000s)
[170.460682] [041/133] (852s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[170.558402] Starting subtest: plane-upscale-20x20-with-rotation
[170.559344] Starting dynamic subtest: pipe-A
[170.784218] Dynamic subtest pipe-A: SUCCESS (0.227s)
[170.791997] Starting dynamic subtest: pipe-B
[172.039100] Dynamic subtest pipe-B: SUCCESS (1.254s)
[172.046393] Starting dynamic subtest: pipe-C
[173.370679] Dynamic subtest pipe-C: SUCCESS (1.331s)
[173.378133] Starting dynamic subtest: pipe-D
[174.699935] Dynamic subtest pipe-D: SUCCESS (1.327s)
[174.701460] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.143s)
[175.892355] [042/133] (846s left) kms_content_protection (atomic-dpms)
[176.032024] Starting subtest: atomic-dpms
[176.033918] Subtest atomic-dpms: SKIP (0.000s)
[176.144285] [043/133] (846s left) gem_basic (multigpu-create-close)
[176.195886] Starting subtest: multigpu-create-close
[176.198549] Subtest multigpu-create-close: SKIP (0.000s)
[176.278821] [044/133] (846s left) gem_exec_flush (basic-wb-ro-before-default)
[176.325398] Starting subtest: basic-wb-ro-before-default
[181.785337] Subtest basic-wb-ro-before-default: SUCCESS (5.460s)
[181.965759] [045/133] (840s left) kms_atomic_interruptible (universal-setplane-cursor)
[182.053966] Starting subtest: universal-setplane-cursor
[182.054819] Starting dynamic subtest: pipe-A-eDP-1
[189.494257] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.439s)
[189.495091] Subtest universal-setplane-cursor: SUCCESS (7.441s)
[190.332122] [046/133] (832s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs)
[190.414377] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs
[190.415216] Starting dynamic subtest: pipe-A-eDP-1
[190.554678] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.135s)
[190.562182] Starting dynamic subtest: pipe-B-eDP-1
[190.569742] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[190.576112] Starting dynamic subtest: pipe-C-eDP-1
[190.583513] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.002s)
[190.589631] Starting dynamic subtest: pipe-D-eDP-1
[190.596578] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.002s)
[190.597374] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs: SUCCESS (0.145s)
[192.818383] [047/133] (830s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-render)
[192.913656] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-render
[197.402130] Subtest fbc-1p-primscrn-pri-indfb-draw-render: SUCCESS (4.489s)
[198.582033] [048/133] (824s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-rc-ccs)
[198.678398] Starting subtest: crc-primary-suspend-y-tiled-gen12-rc-ccs
[198.679241] Starting dynamic subtest: pipe-A-eDP-1
[198.682512] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[198.688616] Starting dynamic subtest: pipe-B-eDP-1
[198.691955] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[198.698479] Starting dynamic subtest: pipe-C-eDP-1
[198.702187] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[198.708021] Starting dynamic subtest: pipe-D-eDP-1
[198.711517] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[198.713241] Subtest crc-primary-suspend-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[200.934157] [049/133] (822s left) kms_big_fb (yf-tiled-8bpp-rotate-90)
[201.032404] Starting subtest: yf-tiled-8bpp-rotate-90
[201.033949] Subtest yf-tiled-8bpp-rotate-90: SKIP (0.000s)
[201.116961] [050/133] (821s left) i915_drm_fdinfo (virtual-busy)
[201.152763] Starting subtest: virtual-busy
[201.154596] Subtest virtual-busy: SKIP (0.000s)
[201.218299] [051/133] (821s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[201.274595] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[201.378198] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.102s)
[201.450267] [052/133] (821s left) gem_pxp (protected-raw-src-copy-not-readible)
[201.578828] Starting subtest: protected-raw-src-copy-not-readible
[201.639379] Subtest protected-raw-src-copy-not-readible: SUCCESS (0.061s)
[201.758118] [053/133] (821s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[202.315426] Starting subtest: syncobj-timeline-multiple-ext-nodes
[202.317040] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.003s)
[204.024435] [054/133] (819s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[204.078279] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[204.079805] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[204.276711] [055/133] (818s left) gem_tiled_pread_pwrite
[204.407177] [056/133] (818s left) gem_exec_whisper (basic-queues-priority-all)
[204.462281] Starting subtest: basic-queues-priority-all
[226.198723] Subtest basic-queues-priority-all: SUCCESS (21.725s)
[226.365011] [057/133] (796s left) gem_render_copy_redux (flink)
[226.430088] Starting subtest: flink
[227.533877] Subtest flink: SUCCESS (1.103s)
[227.682273] [058/133] (795s left) kms_cursor_crc (cursor-random-64x64)
[227.871125] Starting subtest: cursor-random-64x64
[227.873116] Starting dynamic subtest: pipe-A-eDP-1
[231.204186] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.331s)
[231.233653] Starting dynamic subtest: pipe-D-eDP-1
[235.242341] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.015s)
[235.243202] Subtest cursor-random-64x64: SUCCESS (7.372s)
[236.110062] [059/133] (787s left) gem_ctx_persistence (legacy-engines-mixed-process)
[236.159065] Starting subtest: legacy-engines-mixed-process
[236.159972] Starting dynamic subtest: render
[237.851156] Dynamic subtest render: SUCCESS (1.691s)
[237.861160] Starting dynamic subtest: bsd1
[239.898579] Dynamic subtest bsd1: SUCCESS (2.045s)
[239.909258] Starting dynamic subtest: bsd2
[241.902369] Dynamic subtest bsd2: SUCCESS (2.001s)
[241.913385] Starting dynamic subtest: blt
[243.858883] Dynamic subtest blt: SUCCESS (1.954s)
[243.867439] Starting dynamic subtest: vebox
[245.936537] Dynamic subtest vebox: SUCCESS (2.076s)
[245.939466] Subtest legacy-engines-mixed-process: SUCCESS (9.778s)
[246.025116] [060/133] (777s left) syncobj_wait (invalid-signal-zero-handles)
[246.072297] Starting subtest: invalid-signal-zero-handles
[246.073180] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[246.192555] [061/133] (777s left) vgem_basic (sysfs)
[246.235953] Starting subtest: sysfs
[246.236877] Subtest sysfs: SUCCESS (0.000s)
[246.325517] [062/133] (777s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-render)
[246.428407] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-render
[253.219506] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-render: SUCCESS (6.790s)
[253.363255] [063/133] (770s left) gem_workarounds (suspend-resume-fd)
[253.423095] Starting subtest: suspend-resume-fd
[269.806210] Subtest suspend-resume-fd: SUCCESS (2.452s)
[276.958175] [064/133] (753s left) gen9_exec_parse (bb-start-out)
[277.014621] Subtest bb-start-out: SKIP (0.000s)
[277.069871] [065/133] (753s left) kms_psr2_sf (psr2-plane-move-sf-dmg-area)
[277.176162] Starting subtest: psr2-plane-move-sf-dmg-area
[277.177058] Starting dynamic subtest: pipe-A-eDP-1
[281.730473] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.477s)
[281.740299] Starting dynamic subtest: pipe-B-eDP-1
[287.093570] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.312s)
[287.094519] Subtest psr2-plane-move-sf-dmg-area: SUCCESS (9.792s)
[287.962554] [066/133] (742s left) kms_psr (fbc-psr-sprite-render)
[288.070979] Starting subtest: fbc-psr-sprite-render
[288.071877] Starting dynamic subtest: eDP-1
[288.073510] Dynamic subtest eDP-1: SKIP (0.000s)
[288.075137] Subtest fbc-psr-sprite-render: SKIP (0.001s)
[288.144875] [067/133] (742s left) kms_cursor_legacy (cursorb-vs-flipb-toggle)
[288.258825] Starting subtest: cursorB-vs-flipB-toggle
[288.261010] Subtest cursorB-vs-flipB-toggle: SKIP (0.001s)
[288.414643] [068/133] (742s left) gem_ctx_shared (q-in-order)
[288.467537] Starting subtest: Q-in-order
[288.468523] Starting dynamic subtest: rcs0
[288.578189] Dynamic subtest rcs0: SUCCESS (0.110s)
[288.589572] Starting dynamic subtest: vcs0
[288.684560] Dynamic subtest vcs0: SUCCESS (0.104s)
[288.697931] Starting dynamic subtest: vcs1
[288.789211] Dynamic subtest vcs1: SUCCESS (0.102s)
[288.805661] Starting dynamic subtest: vecs0
[288.868405] Dynamic subtest vecs0: SUCCESS (0.077s)
[288.883981] Starting dynamic subtest: ccs0
[288.948828] Dynamic subtest ccs0: SUCCESS (0.080s)
[288.949990] Subtest Q-in-order: SUCCESS (0.480s)
[289.944357] [069/133] (740s left) gem_media_fill (media-fill)
[290.001564] Subtest media-fill: SKIP (0.000s)
[290.116462] [070/133] (740s left) api_intel_bb (render-ccs)
[290.176318] Starting subtest: render-ccs
[290.549862] Subtest render-ccs: SUCCESS (0.363s)
[290.661634] [071/133] (740s left) gem_userptr_blits (unsync-unmap-after-close)
[290.719089] Subtest unsync-unmap-after-close: SKIP (0.000s)
[290.832891] [072/133] (739s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[290.922366] Starting subtest: addfb25-y-tiled-small-legacy
[290.924197] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s)
[291.011550] [073/133] (739s left) kms_pm_rpm (modeset-non-lpsp)
[293.052377] Starting subtest: modeset-non-lpsp
[294.221113] Subtest modeset-non-lpsp: SKIP (1.164s)
[294.587959] [074/133] (736s left) kms_frontbuffer_tracking (fbcpsr-tiling-4)
[294.686827] Starting subtest: fbcpsr-tiling-4
[301.822012] Subtest fbcpsr-tiling-4: SUCCESS (7.122s)
[301.956109] [075/133] (728s left) gem_spin_batch (spin-each)
[302.020801] Starting subtest: spin-each
[305.381130] Subtest spin-each: SUCCESS (3.357s)
[305.870455] [076/133] (725s left) kms_invalid_mode (bad-htotal)
[305.967440] Starting subtest: bad-htotal
[305.968344] Starting dynamic subtest: pipe-A-eDP-1
[306.255686] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.287s)
[306.265791] Starting dynamic subtest: pipe-B-eDP-1
[306.266769] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[306.274846] Starting dynamic subtest: pipe-C-eDP-1
[306.275783] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[306.283511] Starting dynamic subtest: pipe-D-eDP-1
[306.284546] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[306.285543] Subtest bad-htotal: SUCCESS (0.294s)
[307.040842] [077/133] (723s left) gem_unfence_active_buffers
[307.178863] [078/133] (723s left) kms_ccs (missing-ccs-buffer-y-tiled-gen12-mc-ccs)
[307.270974] Starting subtest: missing-ccs-buffer-y-tiled-gen12-mc-ccs
[307.271905] Starting dynamic subtest: pipe-A-eDP-1
[307.280339] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[307.288909] Starting dynamic subtest: pipe-B-eDP-1
[307.297221] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[307.305540] Starting dynamic subtest: pipe-C-eDP-1
[307.313832] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[307.321905] Starting dynamic subtest: pipe-D-eDP-1
[307.330109] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[307.331813] Subtest missing-ccs-buffer-y-tiled-gen12-mc-ccs: SKIP (0.005s)
[309.519227] [079/133] (721s left) kms_plane_alpha_blend (alpha-7efc)
[309.596863] Starting subtest: alpha-7efc
[309.898100] Starting dynamic subtest: pipe-A-eDP-1
[310.540201] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.642s)
[310.569250] Starting dynamic subtest: pipe-D-eDP-1
[311.849778] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.286s)
[311.850817] Subtest alpha-7efc: SUCCESS (2.251s)
[312.689846] [080/133] (718s left) gem_vm_create (isolation)
[312.736397] Starting subtest: isolation
[312.744726] Subtest isolation: SUCCESS (0.009s)
[312.870586] [081/133] (718s left) kms_chamelium_frames (hdmi-aspect-ratio)
[313.243781] Subtest hdmi-aspect-ratio: SKIP (0.000s)
[314.099895] [082/133] (717s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[314.157654] Subtest no-spare-fences-interruptible: SKIP (0.000s)
[314.222279] [083/133] (717s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-pgflip-blt)
[314.311157] Starting subtest: psr-1p-primscrn-indfb-pgflip-blt
[321.644814] Subtest psr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.331s)
[321.763091] [084/133] (709s left) kms_vblank (ts-continuation-idle)
[321.848847] Starting subtest: ts-continuation-idle
[321.849690] Starting dynamic subtest: pipe-A-eDP-1
[322.252890] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.403s)
[322.268090] Starting dynamic subtest: pipe-D-eDP-1
[323.335778] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.079s)
[323.336672] Subtest ts-continuation-idle: SUCCESS (1.486s)
[324.196043] [085/133] (707s left) gem_exec_reloc (basic-range)
[324.249621] Subtest basic-range: SKIP (0.000s)
[324.311817] [086/133] (707s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[324.395283] Starting subtest: fbc-rgb565-draw-mmap-gtt
[324.397254] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[324.493299] [087/133] (706s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-pwrite)
[324.584254] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-pwrite
[332.400812] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (7.813s)
[332.538473] [088/133] (698s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-pwrite)
[332.619018] Starting subtest: fbcpsr-rgb101010-draw-pwrite
[339.678874] Subtest fbcpsr-rgb101010-draw-pwrite: SUCCESS (7.057s)
[339.800732] [089/133] (691s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff)
[339.912985] Starting subtest: psr-2p-primscrn-spr-indfb-onoff
[339.914637] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[340.012734] [090/133] (691s left) gem_exec_balancer (parallel)
[340.272409] Starting subtest: parallel
[341.256785] Subtest parallel: SUCCESS (0.984s)
[341.873960] [091/133] (689s left) gem_ctx_param (invalid-size-get)
[341.924392] Starting subtest: invalid-size-get
[341.925467] Subtest invalid-size-get: SUCCESS (0.001s)
[342.037256] [092/133] (689s left) sysfs_timeslice_duration (timeout)
[342.094471] Starting subtest: timeout
[342.095459] Starting dynamic subtest: vecs0
[351.812687] Dynamic subtest vecs0: SUCCESS (9.705s)
[351.823522] Starting dynamic subtest: ccs0
[353.025872] Dynamic subtest ccs0: SUCCESS (1.220s)
[353.037102] Starting dynamic subtest: vcs0
[362.827937] Dynamic subtest vcs0: SUCCESS (9.786s)
[362.838317] Starting dynamic subtest: bcs0
[363.377551] Dynamic subtest bcs0: SUCCESS (0.556s)
[363.388059] Starting dynamic subtest: rcs0
[364.599300] Dynamic subtest rcs0: SUCCESS (1.221s)
[364.611090] Starting dynamic subtest: vcs1
[373.824941] Dynamic subtest vcs1: SUCCESS (9.216s)
[373.825898] Subtest timeout: SUCCESS (31.714s)
[373.887176] [093/133] (657s left) syncobj_wait (multi-wait-all-submitted-signaled)
[373.939773] Starting subtest: multi-wait-all-submitted-signaled
[374.045644] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.104s)
[374.118423] [094/133] (657s left) gem_exec_parallel (userptr)
[374.175997] Starting subtest: userptr
[374.176983] Starting dynamic subtest: rcs0
[375.730829] Dynamic subtest rcs0: SUCCESS (1.554s)
[375.741532] Starting dynamic subtest: bcs0
[377.224032] Dynamic subtest bcs0: SUCCESS (1.492s)
[377.236833] Starting dynamic subtest: vcs0
[378.840673] Dynamic subtest vcs0: SUCCESS (1.606s)
[378.849131] Starting dynamic subtest: vcs1
[380.874180] Dynamic subtest vcs1: SUCCESS (2.032s)
[380.885537] Starting dynamic subtest: vecs0
[382.793924] Dynamic subtest vecs0: SUCCESS (1.917s)
[382.807824] Starting dynamic subtest: ccs0
[384.271572] Dynamic subtest ccs0: SUCCESS (1.485s)
[384.273310] Subtest userptr: SUCCESS (10.099s)
[384.468321] [095/133] (647s left) kms_cdclk (mode-transition)
[384.561650] Starting subtest: mode-transition
[384.562510] Starting dynamic subtest: pipe-A-eDP-1
[384.848975] Dynamic subtest pipe-A-eDP-1: SKIP (0.286s)
[384.857239] Starting dynamic subtest: pipe-B-eDP-1
[384.859014] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[384.867242] Starting dynamic subtest: pipe-C-eDP-1
[384.868977] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[384.877094] Starting dynamic subtest: pipe-D-eDP-1
[384.878771] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[384.880443] Subtest mode-transition: SKIP (0.293s)
[385.699279] [096/133] (645s left) kms_psr (psr-dpms)
[385.787997] Starting subtest: psr-dpms
[385.788889] Starting dynamic subtest: eDP-1
[388.754275] Dynamic subtest eDP-1: SUCCESS (2.966s)
[388.755140] Subtest psr-dpms: SUCCESS (2.967s)
[389.628472] [097/133] (642s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-sf)
[389.710987] Starting subtest: fbc-pr-cursor-plane-move-continuous-sf
[389.712719] Subtest fbc-pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[389.778016] [098/133] (641s left) gem_exec_schedule (wide)
[389.955727] Starting subtest: wide
[389.956801] Starting dynamic subtest: rcs0
[400.285756] Dynamic subtest rcs0: SUCCESS (10.291s)
[400.297121] Starting dynamic subtest: vcs0
[411.993661] Dynamic subtest vcs0: SUCCESS (11.742s)
[412.002507] Starting dynamic subtest: vcs1
[422.691284] Dynamic subtest vcs1: SUCCESS (10.693s)
[422.712974] Starting dynamic subtest: vecs0
[432.424114] Dynamic subtest vecs0: SUCCESS (9.730s)
[432.436963] Starting dynamic subtest: ccs0
[447.252671] Dynamic subtest ccs0: SUCCESS (14.785s)
[447.254261] Subtest wide: SUCCESS (57.248s)
[449.369533] [099/133] (582s left) kms_big_fb (4-tiled-8bpp-rotate-180)
[449.466952] Starting subtest: 4-tiled-8bpp-rotate-180
[450.669681] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (1.203s)
[450.796792] [100/133] (581s left) syncobj_basic (bad-destroy)
[450.842757] Starting subtest: bad-destroy
[450.843564] Subtest bad-destroy: SUCCESS (0.000s)
[450.936831] [101/133] (580s left) gem_exec_balancer (sequential)
[450.990750] Starting subtest: sequential
[454.163978] Subtest sequential: SUCCESS (3.173s)
[454.486552] [102/133] (577s left) kms_rotation_crc (primary-rotation-90)
[454.574646] Starting subtest: primary-rotation-90
[454.576342] Subtest primary-rotation-90: SKIP (0.001s)
[454.645468] [103/133] (577s left) perf_pmu (most-busy-check-all)
[454.684327] Starting subtest: most-busy-check-all
[454.685202] Starting dynamic subtest: rcs0
[455.882996] Dynamic subtest rcs0: SUCCESS (1.187s)
[455.894060] Starting dynamic subtest: bcs0
[457.867341] Dynamic subtest bcs0: SUCCESS (1.981s)
[457.878367] Starting dynamic subtest: vcs0
[459.851028] Dynamic subtest vcs0: SUCCESS (1.980s)
[459.861421] Starting dynamic subtest: vcs1
[461.834594] Dynamic subtest vcs1: SUCCESS (1.980s)
[461.845292] Starting dynamic subtest: vecs0
[463.818698] Dynamic subtest vecs0: SUCCESS (1.981s)
[463.829156] Starting dynamic subtest: ccs0
[465.867358] Dynamic subtest ccs0: SUCCESS (2.045s)
[465.868648] Subtest most-busy-check-all: SUCCESS (11.170s)
[465.961575] [104/133] (566s left) i915_getparams_basic (basic-eu-total)
[466.013193] Starting subtest: basic-eu-total
[466.015099] Subtest basic-eu-total: SUCCESS (0.000s)
[466.112133] [105/133] (565s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-blt)
[466.219723] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-blt
[466.221312] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[466.319407] [106/133] (565s left) gem_create (create-massive)
[466.361849] Starting subtest: create-massive
[466.362689] Subtest create-massive: SUCCESS (0.000s)
[466.558415] [107/133] (565s left) kms_flip (nonexisting-fb)
[466.649777] Starting subtest: nonexisting-fb
[466.651695] Starting dynamic subtest: A-eDP1
[467.799101] Dynamic subtest A-eDP1: SUCCESS (1.147s)
[467.811745] Starting dynamic subtest: B-eDP1
[468.931576] Dynamic subtest B-eDP1: SUCCESS (1.131s)
[468.942009] Starting dynamic subtest: C-eDP1
[470.057642] Dynamic subtest C-eDP1: SUCCESS (1.123s)
[470.068234] Starting dynamic subtest: D-eDP1
[471.191755] Dynamic subtest D-eDP1: SUCCESS (1.131s)
[471.196047] Subtest nonexisting-fb: SUCCESS (4.546s)
[472.352995] [108/133] (559s left) i915_pm_rpm (debugfs-read)
[473.983674] Starting subtest: debugfs-read
[475.138635] Subtest debugfs-read: SUCCESS (1.155s)
[475.518565] [109/133] (556s left) kms_feature_discovery (dp-mst)
[475.618124] Starting subtest: dp-mst
[475.619872] Subtest dp-mst: SKIP (0.000s)
[475.685241] [110/133] (556s left) kms_psr (fbc-psr-cursor-plane-onoff)
[475.776295] Starting subtest: fbc-psr-cursor-plane-onoff
[475.777191] Starting dynamic subtest: eDP-1
[475.778922] Dynamic subtest eDP-1: SKIP (0.000s)
[475.780765] Subtest fbc-psr-cursor-plane-onoff: SKIP (0.001s)
[475.857578] [111/133] (556s left) syncobj_timeline (multi-wait-available-submitted)
[475.911684] Starting subtest: multi-wait-available-submitted
[475.912898] Subtest multi-wait-available-submitted: SUCCESS (0.000s)
[475.990453] [112/133] (556s left) i915_suspend (debugfs-reader)
[476.049563] Starting subtest: debugfs-reader
[494.795118] Subtest debugfs-reader: SUCCESS (3.559s)
[499.927832] [113/133] (537s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[500.030695] Starting subtest: plane-downscale-factor-0-75-with-rotation
[500.031610] Starting dynamic subtest: pipe-A
[500.261124] Dynamic subtest pipe-A: SUCCESS (0.231s)
[500.271794] Starting dynamic subtest: pipe-B
[501.585939] Dynamic subtest pipe-B: SUCCESS (1.308s)
[501.594474] Starting dynamic subtest: pipe-C
[502.935459] Dynamic subtest pipe-C: SUCCESS (1.323s)
[502.944286] Starting dynamic subtest: pipe-D
[504.305906] Dynamic subtest pipe-D: SUCCESS (1.347s)
[504.307936] Subtest plane-downscale-factor-0-75-with-rotation: SUCCESS (4.213s)
[505.498889] [114/133] (531s left) kms_lease (lease-invalid-crtc)
[505.592645] Starting subtest: lease-invalid-crtc
[505.593438] Starting dynamic subtest: pipe-A-eDP-1
[505.594208] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[505.602587] Starting dynamic subtest: pipe-B-eDP-1
[505.603413] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[505.611752] Starting dynamic subtest: pipe-C-eDP-1
[505.612632] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[505.621027] Starting dynamic subtest: pipe-D-eDP-1
[505.621912] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[505.622796] Subtest lease-invalid-crtc: SUCCESS (0.004s)
[505.664509] [115/133] (531s left) kms_big_fb (yf-tiled-32bpp-rotate-270)
[505.761548] Starting subtest: yf-tiled-32bpp-rotate-270
[505.763127] Subtest yf-tiled-32bpp-rotate-270: SKIP (0.000s)
[505.853621] [116/133] (531s left) gem_tiling_max_stride
[505.961464] [117/133] (531s left) kms_flip (2x-flip-vs-suspend)
[506.049721] Starting subtest: 2x-flip-vs-suspend
[506.060112] Subtest 2x-flip-vs-suspend: SKIP (0.011s)
[506.134761] [118/133] (531s left) gem_mmap_wc (pf-nonblock)
[506.185263] Subtest pf-nonblock: SKIP (0.000s)
[506.244546] [119/133] (531s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[506.327477] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[506.328225] Starting dynamic subtest: pipe-A-default-mode
[509.088695] Dynamic subtest pipe-A-default-mode: SUCCESS (2.734s)
[509.089455] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (2.736s)
[509.923021] [120/133] (527s left) gem_ctx_exec (basic)
[509.979219] Starting subtest: basic
[509.984608] Subtest basic: SUCCESS (0.006s)
[510.102123] [121/133] (527s left) gem_exec_schedule (lateslice)
[510.157873] Starting subtest: lateslice
[510.158816] Starting dynamic subtest: rcs0
[510.178466] Dynamic subtest rcs0: SUCCESS (0.020s)
[510.188590] Starting dynamic subtest: bcs0
[510.196344] Dynamic subtest bcs0: SUCCESS (0.017s)
[510.206956] Starting dynamic subtest: vcs0
[510.214079] Dynamic subtest vcs0: SUCCESS (0.017s)
[510.222704] Starting dynamic subtest: vcs1
[510.233572] Dynamic subtest vcs1: SUCCESS (0.019s)
[510.242927] Starting dynamic subtest: vecs0
[510.255028] Dynamic subtest vecs0: SUCCESS (0.020s)
[510.263709] Starting dynamic subtest: ccs0
[510.273073] Dynamic subtest ccs0: SUCCESS (0.017s)
[510.274028] Subtest lateslice: SUCCESS (0.115s)
[512.097809] [122/133] (525s left) kms_cursor_crc (cursor-suspend)
[512.215422] Starting subtest: cursor-suspend
[512.216308] Starting dynamic subtest: pipe-A-eDP-1
[546.275314] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.904s)
[546.286222] Starting dynamic subtest: pipe-D-eDP-1
[581.280841] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.569s)
[581.281823] Subtest cursor-suspend: SUCCESS (8.478s)
[588.125804] [123/133] (455s left) gem_exec_reloc (basic-write-wc-active)
[588.182995] Subtest basic-write-wc-active: SKIP (0.000s)
[588.245762] [124/133] (455s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[588.366450] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[589.204005] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.831s)
[589.373264] [125/133] (454s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-gtt)
[589.469362] Starting subtest: fbc-rgb101010-draw-mmap-gtt
[589.470969] Subtest fbc-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[589.562166] [126/133] (454s left) gem_create (create-valid-nonaligned)
[589.618233] Starting subtest: create-valid-nonaligned
[589.619191] Subtest create-valid-nonaligned: SUCCESS (0.000s)
[589.813277] [127/133] (454s left) gem_ctx_param (set-priority-range)
[589.871520] Starting subtest: set-priority-range
[589.887140] Subtest set-priority-range: SUCCESS (0.015s)
[589.996681] [128/133] (453s left) kms_big_fb (y-tiled-addfb-size-overflow)
[590.085704] Starting subtest: y-tiled-addfb-size-overflow
[590.087401] Subtest y-tiled-addfb-size-overflow: SKIP (0.000s)
[590.193993] [129/133] (453s left) prime_busy (hang)
[590.247092] Starting subtest: hang
[590.248064] Starting dynamic subtest: rcs0
[616.134546] Dynamic subtest rcs0: SUCCESS (25.738s)
[616.145747] Starting dynamic subtest: bcs0
[623.212130] Dynamic subtest bcs0: SUCCESS (7.074s)
[623.222608] Starting dynamic subtest: vcs0
[630.249720] Dynamic subtest vcs0: SUCCESS (7.039s)
[630.258698] Starting dynamic subtest: vcs1
[637.228553] Dynamic subtest vcs1: SUCCESS (6.976s)
[637.238637] Starting dynamic subtest: vecs0
[644.264494] Dynamic subtest vecs0: SUCCESS (7.035s)
[644.276376] Starting dynamic subtest: ccs0
[658.105851] Dynamic subtest ccs0: SUCCESS (13.835s)
[658.107042] Subtest hang: SUCCESS (67.704s)
[658.245709] [130/133] (385s left) device_reset (cold-reset-bound)
[658.292741] Starting subtest: cold-reset-bound
[658.294838] Subtest cold-reset-bound: SKIP (0.000s)
[658.371140] [131/133] (385s left) kms_plane_multiple (tiling-yf)
[658.467245] Starting subtest: tiling-yf
[658.469039] Subtest tiling-yf: SKIP (0.000s)
[658.535520] [132/133] (385s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[658.634178] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[665.930917] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.296s)
[666.050866] [133/133] (378s left) kms_pm_dc (dc6-dpms)
[667.154943] Starting subtest: dc6-dpms
[669.190688] Subtest dc6-dpms: SUCCESS (2.024s)
[669.264892] Closing watchdogs
results: parsing output: 0/ for test: kms_sequence
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_psr2_sf
results: parsing output: 3/ for test: perf
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_plane
results: parsing output: 6/ for test: kms_psr
results: parsing output: 7/ for test: gem_render_copy
results: parsing output: 8/ for test: api_intel_allocator
results: parsing output: 9/ for test: kms_flip
results: parsing output: 10/ for test: kms_ccs
results: parsing output: 11/ for test: kms_flip
results: parsing output: 12/ for test: kms_chamelium_hpd
results: parsing output: 13/ for test: gem_mmap_gtt
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: gem_exec_schedule
results: parsing output: 17/ for test: kms_psr
results: parsing output: 18/ for test: kms_big_fb
results: parsing output: 19/ for test: kms_flip
results: parsing output: 20/ for test: gem_mmap_gtt
results: parsing output: 21/ for test: kms_atomic_transition
results: parsing output: 22/ for test: syncobj_timeline
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: vgem_basic
results: parsing output: 25/ for test: syncobj_timeline
results: parsing output: 26/ for test: gem_ctx_persistence
results: parsing output: 27/ for test: gem_request_retire
results: parsing output: 28/ for test: kms_cursor_crc
results: parsing output: 29/ for test: kms_color
results: parsing output: 30/ for test: kms_pipe_crc_basic
results: parsing output: 31/ for test: kms_dirtyfb
results: parsing output: 32/ for test: kms_rotation_crc
results: parsing output: 33/ for test: gem_exec_reloc
results: parsing output: 34/ for test: kms_rotation_crc
results: parsing output: 35/ for test: kms_async_flips
results: parsing output: 36/ for test: kms_big_fb
results: parsing output: 37/ for test: gem_mmap_gtt
results: parsing output: 38/ for test: gem_mmap_wc
results: parsing output: 39/ for test: kms_flip_scaled_crc
results: parsing output: 40/ for test: kms_plane_scaling
results: parsing output: 41/ for test: kms_content_protection
results: parsing output: 42/ for test: gem_basic
results: parsing output: 43/ for test: gem_exec_flush
results: parsing output: 44/ for test: kms_atomic_interruptible
results: parsing output: 45/ for test: kms_ccs
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: kms_ccs
results: parsing output: 48/ for test: kms_big_fb
results: parsing output: 49/ for test: i915_drm_fdinfo
results: parsing output: 50/ for test: syncobj_timeline
results: parsing output: 51/ for test: gem_pxp
results: parsing output: 52/ for test: gem_exec_fence
results: parsing output: 53/ for test: gem_render_copy
results: parsing output: 54/ for test: gem_tiled_pread_pwrite
results: parsing output: 55/ for test: gem_exec_whisper
results: parsing output: 56/ for test: gem_render_copy_redux
results: parsing output: 57/ for test: kms_cursor_crc
results: parsing output: 58/ for test: gem_ctx_persistence
results: parsing output: 59/ for test: syncobj_wait
results: parsing output: 60/ for test: vgem_basic
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: gem_workarounds
results: parsing output: 63/ for test: gen9_exec_parse
results: parsing output: 64/ for test: kms_psr2_sf
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: kms_cursor_legacy
results: parsing output: 67/ for test: gem_ctx_shared
results: parsing output: 68/ for test: gem_media_fill
results: parsing output: 69/ for test: api_intel_bb
results: parsing output: 70/ for test: gem_userptr_blits
results: parsing output: 71/ for test: kms_addfb_basic
results: parsing output: 72/ for test: kms_pm_rpm
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: gem_spin_batch
results: parsing output: 75/ for test: kms_invalid_mode
results: parsing output: 76/ for test: gem_unfence_active_buffers
results: parsing output: 77/ for test: kms_ccs
results: parsing output: 78/ for test: kms_plane_alpha_blend
results: parsing output: 79/ for test: gem_vm_create
results: parsing output: 80/ for test: kms_chamelium_frames
results: parsing output: 81/ for test: gem_fenced_exec_thrash
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: kms_vblank
results: parsing output: 84/ for test: gem_exec_reloc
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: gem_exec_balancer
results: parsing output: 90/ for test: gem_ctx_param
results: parsing output: 91/ for test: sysfs_timeslice_duration
results: parsing output: 92/ for test: syncobj_wait
results: parsing output: 93/ for test: gem_exec_parallel
results: parsing output: 94/ for test: kms_cdclk
results: parsing output: 95/ for test: kms_psr
results: parsing output: 96/ for test: kms_psr2_sf
results: parsing output: 97/ for test: gem_exec_schedule
results: parsing output: 98/ for test: kms_big_fb
results: parsing output: 99/ for test: syncobj_basic
results: parsing output: 100/ for test: gem_exec_balancer
results: parsing output: 101/ for test: kms_rotation_crc
results: parsing output: 102/ for test: perf_pmu
results: parsing output: 103/ for test: i915_getparams_basic
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: gem_create
results: parsing output: 106/ for test: kms_flip
results: parsing output: 107/ for test: i915_pm_rpm
results: parsing output: 108/ for test: kms_feature_discovery
results: parsing output: 109/ for test: kms_psr
results: parsing output: 110/ for test: syncobj_timeline
results: parsing output: 111/ for test: i915_suspend
results: parsing output: 112/ for test: kms_plane_scaling
results: parsing output: 113/ for test: kms_lease
results: parsing output: 114/ for test: kms_big_fb
results: parsing output: 115/ for test: gem_tiling_max_stride
results: parsing output: 116/ for test: kms_flip
results: parsing output: 117/ for test: gem_mmap_wc
results: parsing output: 118/ for test: kms_flip_scaled_crc
results: parsing output: 119/ for test: gem_ctx_exec
results: parsing output: 120/ for test: gem_exec_schedule
results: parsing output: 121/ for test: kms_cursor_crc
results: parsing output: 122/ for test: gem_exec_reloc
results: parsing output: 123/ for test: kms_big_fb
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: gem_create
results: parsing output: 126/ for test: gem_ctx_param
results: parsing output: 127/ for test: kms_big_fb
results: parsing output: 128/ for test: prime_busy
results: parsing output: 129/ for test: device_reset
results: parsing output: 130/ for test: kms_plane_multiple
results: parsing output: 131/ for test: kms_frontbuffer_tracking
results: parsing output: 132/ for test: kms_pm_dc
Done.