[66.938415] Initializing watchdogs
[66.938499]   /dev/watchdog0
[66.970752] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:4905 Intel Dg1 (Gen12) DG1 [Iris Xe MAX Graphics]
[66.985849] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[66.990992] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[66.994466] [001/156] (960s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-cpu)
[68.505885] Starting subtest: psr-rgb101010-draw-mmap-cpu
[68.508509] Subtest psr-rgb101010-draw-mmap-cpu: SKIP (0.000s)
[68.676387] [002/156] (958s left) kms_psr (psr-cursor-mmap-cpu)
[70.173346] Subtest psr-cursor-mmap-cpu: SKIP (0.000s)
[70.248699] [003/156] (957s left) perf_pmu (busy-accuracy-50)
[70.356645] Starting subtest: busy-accuracy-50
[70.358584] Starting dynamic subtest: rcs0
[71.897171] Dynamic subtest rcs0: SUCCESS (1.542s)
[71.907912] Starting dynamic subtest: bcs0
[73.460931] Dynamic subtest bcs0: SUCCESS (1.557s)
[73.471568] Starting dynamic subtest: vcs0
[75.000980] Dynamic subtest vcs0: SUCCESS (1.546s)
[75.011582] Starting dynamic subtest: vcs1
[76.551383] Dynamic subtest vcs1: SUCCESS (1.550s)
[76.561880] Starting dynamic subtest: vecs0
[78.096955] Dynamic subtest vecs0: SUCCESS (1.545s)
[78.098536] Subtest busy-accuracy-50: SUCCESS (7.741s)
[78.274676] [004/156] (949s left) kms_ccs (crc-primary-basic-y-tiled-gen12-mc-ccs)
[79.766230] Starting subtest: crc-primary-basic-y-tiled-gen12-mc-ccs
[79.767721] Starting dynamic subtest: pipe-A-HDMI-A-4
[79.781721] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.001s)
[79.791946] Starting dynamic subtest: pipe-B-HDMI-A-4
[79.806566] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.001s)
[79.817273] Starting dynamic subtest: pipe-C-HDMI-A-4
[79.832043] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.001s)
[79.842167] Starting dynamic subtest: pipe-D-HDMI-A-4
[79.858203] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.001s)
[79.861649] Subtest crc-primary-basic-y-tiled-gen12-mc-ccs: SKIP (0.009s)
[80.038729] [005/156] (947s left) i915_drm_fdinfo (memory-info-idle)
[80.114882] Starting subtest: memory-info-idle
[80.116797] Starting dynamic subtest: lmem0
[80.175197] Dynamic subtest lmem0: SUCCESS (0.060s)
[80.185958] Starting dynamic subtest: smem0
[80.216931] Dynamic subtest smem0: SUCCESS (0.041s)
[80.219030] Subtest memory-info-idle: SUCCESS (0.102s)
[80.330346] [006/156] (947s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[81.828699] Starting subtest: fbchdr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[81.832303] Subtest fbchdr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[82.020019] [007/156] (945s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[83.538818] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[83.542506] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[83.722422] [008/156] (944s left) kms_cursor_crc (cursor-rapid-movement-512x170)
[85.521425] Starting subtest: cursor-rapid-movement-512x170
[85.524246] Subtest cursor-rapid-movement-512x170: SKIP (0.001s)
[85.736418] [009/156] (942s left) gem_exec_whisper (basic-fds-all)
[85.796962] Starting subtest: basic-fds-all
[91.911773] Subtest basic-fds-all: SUCCESS (6.106s)
[92.241135] [010/156] (936s left) gem_vm_create (isolation)
[92.305436] Starting subtest: isolation
[92.315827] Subtest isolation: SUCCESS (0.010s)
[92.519376] [011/156] (935s left) template (b)
[92.566770] Starting subtest: B
[92.568521] Subtest B: SUCCESS (0.000s)
[92.689844] [012/156] (935s left) kms_atomic (atomic-invalid-params)
[94.180026] Starting subtest: atomic-invalid-params
[94.181432] Starting dynamic subtest: pipe-A-HDMI-A-4
[94.621638] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.439s)
[94.623219] Subtest atomic-invalid-params: SUCCESS (0.440s)
[94.821224] [013/156] (933s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[96.322830] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[96.326159] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[96.496537] [014/156] (932s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-cpu)
[97.996528] Starting subtest: fbcpsr-rgb101010-draw-mmap-cpu
[97.999445] Subtest fbcpsr-rgb101010-draw-mmap-cpu: SKIP (0.000s)
[98.165479] [015/156] (930s left) i915_hangman (gt-engine-hang)
[98.234683] Starting subtest: gt-engine-hang
[98.236205] Starting dynamic subtest: rcs0
[98.939986] Dynamic subtest rcs0: SUCCESS (0.706s)
[98.951107] Starting dynamic subtest: bcs0
[99.608019] Dynamic subtest bcs0: SUCCESS (0.667s)
[99.619837] Starting dynamic subtest: vcs0
[100.272062] Dynamic subtest vcs0: SUCCESS (0.664s)
[100.283840] Starting dynamic subtest: vcs1
[100.935994] Dynamic subtest vcs1: SUCCESS (0.663s)
[100.947309] Starting dynamic subtest: vecs0
[101.597051] Dynamic subtest vecs0: SUCCESS (0.661s)
[101.598747] Subtest gt-engine-hang: SUCCESS (3.363s)
[101.751831] [016/156] (927s left) kms_lease (page-flip-implicit-plane)
[103.242572] Starting subtest: page-flip-implicit-plane
[103.244282] Starting dynamic subtest: pipe-A-HDMI-A-4
[103.674714] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.432s)
[103.686277] Starting dynamic subtest: pipe-B-HDMI-A-4
[103.936692] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.259s)
[103.949060] Starting dynamic subtest: pipe-C-HDMI-A-4
[104.183231] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.245s)
[104.196856] Starting dynamic subtest: pipe-D-HDMI-A-4
[104.450626] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.265s)
[104.452043] Subtest page-flip-implicit-plane: SUCCESS (1.207s)
[104.675416] [017/156] (924s left) gem_exec_schedule (semaphore-resolve)
[104.739905] Starting subtest: semaphore-resolve
[104.801233] Subtest semaphore-resolve: SUCCESS (0.061s)
[105.201439] [018/156] (923s left) gem_linear_blits (normal)
[105.550921] Starting subtest: normal
[114.461304] Subtest normal: SUCCESS (8.907s)
[114.945491] [019/156] (914s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-render)
[116.508558] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-render
[116.511564] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-render: SKIP (0.000s)
[116.712850] [020/156] (912s left) api_intel_bb (intel-bb-blit-none)
[116.764798] Starting subtest: intel-bb-blit-none
[117.455274] Subtest intel-bb-blit-none: SUCCESS (0.692s)
[117.607937] [021/156] (911s left) kms_plane (pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping)
[119.097638] Starting subtest: pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping
[119.100882] Subtest pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping: SKIP (0.000s)
[119.225169] [022/156] (910s left) prime_vgem (fence-flip-hang)
[119.437355] Subtest fence-flip-hang: SKIP (0.000s)
[119.608078] [FACT prime_vgem (fence-flip-hang)] new: kernel.kmod_is_loaded.vgem: true
[119.611093] [023/156] (909s left) kms_atomic_transition (plane-toggle-modeset-transition)
[121.103778] Starting subtest: plane-toggle-modeset-transition
[121.105351] Starting dynamic subtest: pipe-A-HDMI-A-4
[122.304130] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (1.196s)
[122.329506] Starting dynamic subtest: pipe-B-HDMI-A-4
[123.255398] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.939s)
[123.257566] Subtest plane-toggle-modeset-transition: SUCCESS (2.151s)
[123.448802] [024/156] (906s left) kms_frontbuffer_tracking (hdr-2p-primscrn-cur-indfb-onoff)
[124.951728] Starting subtest: hdr-2p-primscrn-cur-indfb-onoff
[124.958127] Subtest hdr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[125.152058] [025/156] (904s left) kms_psr (psr2-dpms)
[126.644464] Subtest psr2-dpms: SKIP (0.000s)
[126.737625] [026/156] (903s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping)
[128.230523] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping
[128.233759] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s)
[128.364838] [027/156] (901s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-spr-indfb-onoff)
[129.876119] Starting subtest: fbchdr-2p-primscrn-spr-indfb-onoff
[129.879178] Subtest fbchdr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[130.074938] [028/156] (899s left) gem_exec_schedule (lateslice)
[130.144949] Starting subtest: lateslice
[130.146654] Starting dynamic subtest: rcs0
[130.182040] Dynamic subtest rcs0: SUCCESS (0.038s)
[130.193891] Starting dynamic subtest: bcs0
[130.201498] Dynamic subtest bcs0: SUCCESS (0.019s)
[130.213302] Starting dynamic subtest: vcs0
[130.222384] Dynamic subtest vcs0: SUCCESS (0.021s)
[130.234247] Starting dynamic subtest: vcs1
[130.244957] Dynamic subtest vcs1: SUCCESS (0.022s)
[130.256993] Starting dynamic subtest: vecs0
[130.265301] Dynamic subtest vecs0: SUCCESS (0.020s)
[130.267068] Subtest lateslice: SUCCESS (0.122s)
[130.723729] [029/156] (899s left) gem_exec_fence (syncobj-timeline-export)
[131.296748] Starting subtest: syncobj-timeline-export
[131.315803] Subtest syncobj-timeline-export: SUCCESS (0.022s)
[131.623181] [030/156] (898s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf)
[133.119166] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[133.193969] [031/156] (897s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[134.691657] Starting subtest: fbc-rgb565-draw-mmap-gtt
[134.694896] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[134.897860] [032/156] (895s left) gem_softpin (evict-single-offset)
[134.958154] Starting subtest: evict-single-offset
[177.190858] Subtest evict-single-offset: SUCCESS (42.234s)
[177.319093] [033/156] (853s left) kms_addfb_basic (size-max)
[178.865408] Starting subtest: size-max
[178.866823] Subtest size-max: SUCCESS (0.000s)
[179.074526] [034/156] (851s left) kms_cursor_crc (cursor-onscreen-max-size)
[180.878511] Starting subtest: cursor-onscreen-max-size
[180.883271] Subtest cursor-onscreen-max-size: SKIP (0.000s)
[181.082682] [035/156] (849s left) kms_frontbuffer_tracking (hdr-indfb-scaledprimary)
[182.595597] Starting subtest: hdr-indfb-scaledprimary
[182.598791] Subtest hdr-indfb-scaledprimary: SKIP (0.000s)
[182.797546] [036/156] (848s left) kms_lease (empty-lease)
[184.306554] Starting subtest: empty-lease
[184.309985] Starting dynamic subtest: pipe-A-HDMI-A-4
[184.311724] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.001s)
[184.324578] Starting dynamic subtest: pipe-B-HDMI-A-4
[184.326139] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.001s)
[184.338272] Starting dynamic subtest: pipe-C-HDMI-A-4
[184.339839] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.001s)
[184.352111] Starting dynamic subtest: pipe-D-HDMI-A-4
[184.353855] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.001s)
[184.355655] Subtest empty-lease: SUCCESS (0.009s)
[184.432766] [037/156] (846s left) gem_exec_balancer (parallel-contexts)
[184.860381] Starting subtest: parallel-contexts
[189.506375] Subtest parallel-contexts: SUCCESS (4.646s)
[189.613917] [038/156] (841s left) kms_content_protection (dp-mst-type-0)
[191.160465] Starting subtest: dp-mst-type-0
[191.164009] Subtest dp-mst-type-0: SKIP (0.000s)
[191.344614] [039/156] (839s left) gem_exec_reloc (basic-wc-gtt-noreloc)
[191.403394] Subtest basic-wc-gtt-noreloc: SKIP (0.000s)
[191.496278] [040/156] (839s left) gem_lmem_swapping (heavy-verify-multi)
[195.837107] Starting subtest: heavy-verify-multi
[195.838866] Starting dynamic subtest: lmem0
[212.043332] Dynamic subtest lmem0: SUCCESS (16.203s)
[212.044960] Subtest heavy-verify-multi: SUCCESS (16.203s)
[213.355113] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[213.356250] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: kernel.kmod_is_loaded.i915: true
[213.359222] [041/156] (817s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[216.657041] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[216.658445] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.001s)
[216.743474] [FACT syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[216.746722] [FACT syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)] new: kernel.kmod_is_loaded.i915: true
[216.750454] [042/156] (814s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-wc)
[218.251971] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-wc
[218.254968] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[218.410564] [043/156] (812s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-blt)
[219.912102] Starting subtest: psr-1p-primscrn-cur-indfb-draw-blt
[219.914844] Subtest psr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[220.095043] [044/156] (811s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt)
[222.247850] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt
[225.111638] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (2.865s)
[225.307169] [045/156] (806s left) kms_cdclk (mode-transition)
[225.360240] Subtest mode-transition: SKIP (0.000s)
[225.444050] [046/156] (806s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0)
[226.955033] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0
[228.245236] Subtest y-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.290s)
[228.423209] [047/156] (803s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-render)
[229.923514] Starting subtest: fbc-rgb101010-draw-render
[230.761845] Subtest fbc-rgb101010-draw-render: SUCCESS (0.841s)
[230.950959] [048/156] (800s left) kms_pm_dc (dc5-psr)
[233.453157] Starting subtest: dc5-psr
[233.456740] Subtest dc5-psr: SKIP (0.000s)
[233.571868] [049/156] (798s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-pgflip-blt)
[235.087142] Starting subtest: psr-2p-primscrn-indfb-pgflip-blt
[235.090143] Subtest psr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[235.281565] [050/156] (796s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-shrfb-pgflip-blt)
[236.780457] Starting subtest: hdr-2p-scndscrn-shrfb-pgflip-blt
[236.783512] Subtest hdr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[237.007970] [051/156] (795s left) gem_ctx_persistence (legacy-engines-hang)
[237.069289] Starting subtest: legacy-engines-hang
[237.070990] Starting dynamic subtest: render
[237.136943] Dynamic subtest render: SUCCESS (0.067s)
[237.153175] Starting dynamic subtest: bsd1
[237.229350] Dynamic subtest bsd1: SUCCESS (0.090s)
[237.275559] Starting dynamic subtest: bsd2
[237.287954] Dynamic subtest bsd2: SUCCESS (0.056s)
[237.303898] Starting dynamic subtest: blt
[237.378121] Dynamic subtest blt: SUCCESS (0.088s)
[237.429427] Starting dynamic subtest: vebox
[237.437044] Dynamic subtest vebox: SUCCESS (0.056s)
[237.438922] Subtest legacy-engines-hang: SUCCESS (0.368s)
[237.673093] [052/156] (794s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions-varying-size)
[239.166829] Starting subtest: cursorA-vs-flipB-atomic-transitions-varying-size
[239.170133] Subtest cursorA-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s)
[239.286270] [053/156] (793s left) syncobj_wait (multi-wait-for-submit-unsubmitted)
[239.342291] Starting subtest: multi-wait-for-submit-unsubmitted
[239.444386] Subtest multi-wait-for-submit-unsubmitted: SUCCESS (0.101s)
[239.655889] [054/156] (792s left) syncobj_timeline (invalid-multi-wait-unsubmitted)
[239.706470] Starting subtest: invalid-multi-wait-unsubmitted
[239.708365] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[239.812602] [055/156] (792s left) kms_prop_blob (invalid-get-prop-any)
[239.878547] Starting subtest: invalid-get-prop-any
[239.881678] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[240.037797] [056/156] (792s left) gem_render_copy (yf-tiled)
[240.092954] Starting subtest: yf-tiled
[240.094554] Starting dynamic subtest: smem
[240.184276] Dynamic subtest smem: SUCCESS (0.091s)
[240.198374] Starting dynamic subtest: lmem0
[240.971241] Dynamic subtest lmem0: SUCCESS (0.766s)
[240.988831] Subtest yf-tiled: SUCCESS (0.858s)
[241.238484] [057/156] (791s left) gem_ctx_shared (q-out-order)
[241.300202] Starting subtest: Q-out-order
[241.301680] Starting dynamic subtest: rcs0
[241.486678] Dynamic subtest rcs0: SUCCESS (0.184s)
[241.500879] Starting dynamic subtest: bcs0
[241.610323] Dynamic subtest bcs0: SUCCESS (0.123s)
[241.623448] Starting dynamic subtest: vcs0
[241.729176] Dynamic subtest vcs0: SUCCESS (0.121s)
[241.742099] Starting dynamic subtest: vcs1
[241.865777] Dynamic subtest vcs1: SUCCESS (0.133s)
[241.878663] Starting dynamic subtest: vecs0
[242.000951] Dynamic subtest vecs0: SUCCESS (0.135s)
[242.002712] Subtest Q-out-order: SUCCESS (0.699s)
[242.336465] [058/156] (790s left) kms_flip (2x-modeset-vs-vblank-race)
[243.828770] Starting subtest: 2x-modeset-vs-vblank-race
[243.845029] Subtest 2x-modeset-vs-vblank-race: SKIP (0.018s)
[243.977755] [059/156] (788s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[245.476992] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[245.480442] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[245.634402] [060/156] (787s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-cur-indfb-draw-pwrite)
[247.140785] Starting subtest: fbchdr-1p-primscrn-cur-indfb-draw-pwrite
[247.143434] Subtest fbchdr-1p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[247.297398] [061/156] (785s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[248.801336] Starting subtest: fbcpsrhdr-2p-primscrn-cur-indfb-draw-mmap-gtt
[248.804979] Subtest fbcpsrhdr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[248.968880] [062/156] (784s left) kms_big_fb (linear-64bpp-rotate-270)
[250.484853] Starting subtest: linear-64bpp-rotate-270
[250.552185] Subtest linear-64bpp-rotate-270: SKIP (0.066s)
[250.784839] [063/156] (782s left) kms_getfb (getfb2-handle-not-fb)
[252.275590] Starting subtest: getfb2-handle-not-fb
[252.277232] Subtest getfb2-handle-not-fb: SUCCESS (0.000s)
[252.458616] [064/156] (781s left) device_reset (cold-reset-bound)
[252.566218] Starting subtest: cold-reset-bound
[252.570217] Subtest cold-reset-bound: SKIP (0.000s)
[252.699838] [065/156] (780s left) kms_flip (nonexisting-fb)
[254.191253] Starting subtest: nonexisting-fb
[254.197680] Starting dynamic subtest: A-HDMI-A4
[254.447871] Dynamic subtest A-HDMI-A4: SUCCESS (0.250s)
[254.462417] Starting dynamic subtest: B-HDMI-A4
[254.644769] Dynamic subtest B-HDMI-A4: SUCCESS (0.196s)
[254.657399] Starting dynamic subtest: C-HDMI-A4
[254.822460] Dynamic subtest C-HDMI-A4: SUCCESS (0.176s)
[254.835157] Starting dynamic subtest: D-HDMI-A4
[255.022634] Dynamic subtest D-HDMI-A4: SUCCESS (0.199s)
[255.024311] Subtest nonexisting-fb: SUCCESS (0.833s)
[255.301128] [066/156] (778s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-spr-indfb-draw-render)
[256.799404] Starting subtest: fbchdr-1p-primscrn-spr-indfb-draw-render
[256.802039] Subtest fbchdr-1p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[257.006576] [067/156] (776s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[258.506110] Starting subtest: psrhdr-1p-primscrn-pri-indfb-draw-mmap-cpu
[258.509881] Subtest psrhdr-1p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[258.670930] [068/156] (775s left) kms_frontbuffer_tracking (psrhdr-1p-rte)
[260.184340] Starting subtest: psrhdr-1p-rte
[260.187813] Subtest psrhdr-1p-rte: SKIP (0.000s)
[260.359509] [069/156] (773s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-pgflip-blt)
[261.859600] Starting subtest: fbcpsr-2p-primscrn-indfb-pgflip-blt
[261.862790] Subtest fbcpsr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[262.057037] [070/156] (772s left) kms_psr (psr-suspend)
[263.554348] Subtest psr-suspend: SKIP (0.000s)
[263.628730] [071/156] (770s left) kms_psr (fbc-pr-dpms)
[265.121182] Subtest fbc-pr-dpms: SKIP (0.000s)
[265.197914] [072/156] (769s left) i915_query (query-regions-garbage-items)
[265.247475] Starting subtest: query-regions-garbage-items
[265.249225] Subtest query-regions-garbage-items: SUCCESS (0.000s)
[265.373881] [073/156] (768s left) perf_pmu (frequency)
[265.428253] Starting subtest: frequency
[265.431972] Starting dynamic subtest: gt0
[267.548777] Dynamic subtest gt0: SUCCESS (2.113s)
[267.563548] Starting dynamic subtest: idle-gt0
[268.055771] Dynamic subtest idle-gt0: SUCCESS (0.504s)
[268.057561] Subtest frequency: SUCCESS (2.626s)
[268.168712] [074/156] (766s left) kms_color (invalid-ctm-matrix-sizes)
[269.658197] Starting subtest: invalid-ctm-matrix-sizes
[269.659973] Starting dynamic subtest: pipe-A
[269.664277] Dynamic subtest pipe-A: SUCCESS (0.006s)
[269.677276] Starting dynamic subtest: pipe-B
[269.679153] Dynamic subtest pipe-B: SUCCESS (0.009s)
[269.692187] Starting dynamic subtest: pipe-C
[269.693674] Dynamic subtest pipe-C: SUCCESS (0.008s)
[269.706730] Starting dynamic subtest: pipe-D
[269.708302] Dynamic subtest pipe-D: SUCCESS (0.009s)
[269.709994] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.035s)
[269.838097] [075/156] (764s left) kms_plane_scaling (planes-upscale-20x20-downscale-factor-0-75)
[271.328808] Starting subtest: planes-upscale-20x20-downscale-factor-0-75
[271.330430] Starting dynamic subtest: pipe-A
[271.446180] Dynamic subtest pipe-A: SUCCESS (0.117s)
[271.460013] Starting dynamic subtest: pipe-B
[271.603840] Dynamic subtest pipe-B: SUCCESS (0.157s)
[271.616454] Starting dynamic subtest: pipe-C
[271.760839] Dynamic subtest pipe-C: SUCCESS (0.156s)
[271.773830] Starting dynamic subtest: pipe-D
[271.917412] Dynamic subtest pipe-D: SUCCESS (0.156s)
[271.919035] Subtest planes-upscale-20x20-downscale-factor-0-75: SUCCESS (0.589s)
[272.135943] [076/156] (762s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-downscaling)
[273.625538] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-downscaling
[273.628733] Subtest flip-32bpp-4tile-to-64bpp-4tile-downscaling: SKIP (0.000s)
[273.753684] [077/156] (760s left) sysfs_heartbeat_interval (nopreempt)
[273.817186] Starting subtest: nopreempt
[273.818857] Starting dynamic subtest: vecs0
[277.826462] Dynamic subtest vecs0: SUCCESS (4.008s)
[277.839818] Starting dynamic subtest: vcs0
[281.753029] Dynamic subtest vcs0: SUCCESS (3.926s)
[281.766469] Starting dynamic subtest: bcs0
[285.730184] Dynamic subtest bcs0: SUCCESS (3.978s)
[285.744286] Starting dynamic subtest: rcs0
[289.767135] Dynamic subtest rcs0: SUCCESS (4.037s)
[289.780553] Starting dynamic subtest: vcs1
[293.715670] Dynamic subtest vcs1: SUCCESS (3.948s)
[293.717576] Subtest nopreempt: SUCCESS (19.902s)
[293.879734] [078/156] (740s left) syncobj_timeline (wait-for-submit-delayed-submit)
[293.934699] Starting subtest: wait-for-submit-delayed-submit
[294.041853] Subtest wait-for-submit-delayed-submit: SUCCESS (0.105s)
[294.207438] [079/156] (740s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[294.254822] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[294.256311] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[294.393489] [080/156] (740s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite)
[295.892121] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite
[295.895646] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[296.062402] [081/156] (738s left) kms_chamelium_hpd (hdmi-hpd-for-each-pipe)
[297.598474] Subtest hdmi-hpd-for-each-pipe: SKIP (0.000s)
[297.728624] [082/156] (737s left) kms_flip (plain-flip-ts-check)
[299.219530] Starting subtest: plain-flip-ts-check
[299.226198] Starting dynamic subtest: A-HDMI-A4
[307.267749] Dynamic subtest A-HDMI-A4: SUCCESS (8.043s)
[307.284205] Starting dynamic subtest: B-HDMI-A4
[315.262448] Dynamic subtest B-HDMI-A4: SUCCESS (7.994s)
[315.277038] Starting dynamic subtest: C-HDMI-A4
[323.256587] Dynamic subtest C-HDMI-A4: SUCCESS (7.993s)
[323.272713] Starting dynamic subtest: D-HDMI-A4
[331.249673] Dynamic subtest D-HDMI-A4: SUCCESS (7.992s)
[331.251437] Subtest plain-flip-ts-check: SUCCESS (32.036s)
[331.474088] [083/156] (703s left) kms_dsc (dsc-basic)
[332.965230] Starting subtest: dsc-basic
[332.975750] Subtest dsc-basic: SKIP (0.000s)
[333.081598] [084/156] (702s left) kms_frontbuffer_tracking (hdr-1p-primscrn-cur-indfb-move)
[334.599952] Starting subtest: hdr-1p-primscrn-cur-indfb-move
[334.603559] Subtest hdr-1p-primscrn-cur-indfb-move: SKIP (0.000s)
[334.753506] [085/156] (700s left) kms_setmode (basic-clone-single-crtc)
[334.807967] Starting subtest: basic-clone-single-crtc
[334.813228] Subtest basic-clone-single-crtc: SKIP (0.000s)
[334.929743] [086/156] (700s left) prime_busy (hang-wait)
[334.984226] Starting subtest: hang-wait
[334.985998] Starting dynamic subtest: rcs0
[362.424777] Dynamic subtest rcs0: SUCCESS (27.440s)
[362.438204] Starting dynamic subtest: bcs0
[369.573648] Dynamic subtest bcs0: SUCCESS (7.147s)
[369.586999] Starting dynamic subtest: vcs0
[376.549678] Dynamic subtest vcs0: SUCCESS (6.975s)
[376.563237] Starting dynamic subtest: vcs1
[383.591863] Dynamic subtest vcs1: SUCCESS (7.041s)
[383.605375] Starting dynamic subtest: vecs0
[390.563120] Dynamic subtest vecs0: SUCCESS (6.972s)
[390.567123] Subtest hang-wait: SUCCESS (55.583s)
[390.726801] [087/156] (644s left) kms_ccs (bad-rotation-90-4-tiled-bmg-ccs)
[392.220166] Starting subtest: bad-rotation-90-4-tiled-bmg-ccs
[392.223338] Subtest bad-rotation-90-4-tiled-bmg-ccs: SKIP (0.000s)
[392.444801] [088/156] (643s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-pri-indfb-draw-render)
[393.941998] Starting subtest: fbcpsrhdr-2p-primscrn-pri-indfb-draw-render
[393.945040] Subtest fbcpsrhdr-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[394.151907] [089/156] (641s left) kms_frontbuffer_tracking (hdr-2p-primscrn-pri-indfb-draw-pwrite)
[395.670302] Starting subtest: hdr-2p-primscrn-pri-indfb-draw-pwrite
[395.673612] Subtest hdr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[395.842413] [090/156] (640s left) vgem_basic (create)
[395.901967] Starting subtest: create
[395.903837] Subtest create: SUCCESS (0.000s)
[396.023999] [091/156] (639s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[397.534967] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[397.537971] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[397.722188] [092/156] (638s left) gem_exec_reloc (basic-concurrent16)
[397.777156] Subtest basic-concurrent16: SKIP (0.000s)
[397.887997] [093/156] (638s left) kms_cursor_edge_walk (64x64-left-edge)
[399.379842] Starting subtest: 64x64-left-edge
[399.381330] Starting dynamic subtest: pipe-A-HDMI-A-4
[402.714217] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (3.334s)
[402.728129] Starting dynamic subtest: pipe-D-HDMI-A-4
[405.946357] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (3.229s)
[405.948119] Subtest 64x64-left-edge: SUCCESS (6.567s)
[406.143384] [094/156] (630s left) kms_chamelium_frames (vga-frame-dump)
[407.681706] Subtest vga-frame-dump: SKIP (0.000s)
[407.820325] [095/156] (628s left) kms_flip (2x-flip-vs-fences-interruptible)
[409.316647] Starting subtest: 2x-flip-vs-fences-interruptible
[409.319897] Subtest 2x-flip-vs-fences-interruptible: SKIP (0.000s)
[409.437554] [096/156] (626s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-render)
[410.943180] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-render
[410.946496] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[411.139228] [097/156] (625s left) api_intel_bb (bb-with-allocator)
[411.207660] Starting subtest: bb-with-allocator
[411.231028] Subtest bb-with-allocator: SUCCESS (0.025s)
[411.421703] [098/156] (625s left) gem_mmap_wc (pf-nonblock)
[411.485296] Subtest pf-nonblock: SKIP (0.000s)
[411.562082] [099/156] (625s left) gem_readwrite (beyond-eob)
[411.612860] Subtest beyond-EOB: SKIP (0.000s)
[411.713614] [100/156] (625s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-shrfb-pgflip-blt)
[413.211485] Starting subtest: fbcpsrhdr-2p-scndscrn-shrfb-pgflip-blt
[413.214276] Subtest fbcpsrhdr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[413.400879] [101/156] (623s left) kms_psr (fbc-psr2-primary-mmap-gtt)
[414.891566] Subtest fbc-psr2-primary-mmap-gtt: SKIP (0.000s)
[414.976338] [102/156] (621s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[416.467174] Starting subtest: basic-flip-before-cursor-varying-size
[417.498362] Subtest basic-flip-before-cursor-varying-size: SUCCESS (1.032s)
[417.702660] [103/156] (619s left) gem_mmap_offset (mmap-boundaries)
[417.751148] Starting subtest: mmap-boundaries
[417.752620] Starting dynamic subtest: lmem0
[418.062141] Dynamic subtest lmem0: SUCCESS (0.308s)
[418.075556] Starting dynamic subtest: smem0
[420.028167] Dynamic subtest smem0: SUCCESS (1.965s)
[420.029624] Subtest mmap-boundaries: SUCCESS (2.275s)
[420.375268] [104/156] (616s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-render)
[421.871853] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-render
[421.874763] Subtest fbc-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[422.060988] [105/156] (615s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[423.559856] Starting subtest: psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[423.562910] Subtest psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[423.698804] [106/156] (613s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-pri-indfb-draw-pwrite)
[425.203529] Starting subtest: fbcpsrhdr-1p-primscrn-pri-indfb-draw-pwrite
[425.206948] Subtest fbcpsrhdr-1p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[425.361583] [107/156] (612s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-spr-indfb-fullscreen)
[426.864103] Starting subtest: fbchdr-2p-scndscrn-spr-indfb-fullscreen
[426.867353] Subtest fbchdr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[427.072624] [108/156] (610s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-pwrite)
[428.572993] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-pwrite
[431.974843] Subtest fbc-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (3.405s)
[432.175512] [109/156] (605s left) gen9_exec_parse (bb-chained)
[432.231610] Subtest bb-chained: SKIP (0.000s)
[432.306285] [110/156] (605s left) i915_query (query-topology-coherent-slice-mask)
[432.355864] Starting subtest: query-topology-coherent-slice-mask
[432.357705] Subtest query-topology-coherent-slice-mask: SUCCESS (0.000s)
[432.480878] [111/156] (605s left) gem_mmap_gtt (basic-small-bo-tiledx)
[432.531724] Subtest basic-small-bo-tiledX: SKIP (0.000s)
[432.606489] [112/156] (605s left) gem_render_copy (yf-tiled-ccs-to-y-tiled-ccs)
[432.661043] Starting subtest: yf-tiled-ccs-to-y-tiled-ccs
[432.662804] Starting dynamic subtest: smem
[432.760111] Dynamic subtest smem: SUCCESS (0.098s)
[432.773826] Starting dynamic subtest: lmem0
[433.869768] Dynamic subtest lmem0: SUCCESS (1.105s)
[433.871671] Subtest yf-tiled-ccs-to-y-tiled-ccs: SUCCESS (1.206s)
[434.112457] [113/156] (603s left) kms_ccs (missing-ccs-buffer-y-tiled-gen12-rc-ccs)
[435.603829] Starting subtest: missing-ccs-buffer-y-tiled-gen12-rc-ccs
[435.605403] Starting dynamic subtest: pipe-A-HDMI-A-4
[435.619282] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.001s)
[435.633145] Starting dynamic subtest: pipe-B-HDMI-A-4
[435.647742] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.001s)
[435.660860] Starting dynamic subtest: pipe-C-HDMI-A-4
[435.677866] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.001s)
[435.691264] Starting dynamic subtest: pipe-D-HDMI-A-4
[435.707869] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.001s)
[435.709778] Subtest missing-ccs-buffer-y-tiled-gen12-rc-ccs: SUCCESS (0.011s)
[435.891739] [114/156] (602s left) kms_frontbuffer_tracking (hdr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[437.392160] Starting subtest: hdr-1p-offscreen-pri-indfb-draw-mmap-gtt
[437.395697] Subtest hdr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[437.560606] [115/156] (600s left) gem_ctx_param (root-set)
[437.610317] Starting subtest: root-set
[437.611860] Subtest root-set: SUCCESS (0.001s)
[437.734965] [116/156] (600s left) gem_ctx_isolation (nonpriv)
[437.797853] Starting subtest: nonpriv
[437.799455] Starting dynamic subtest: rcs0
[438.837579] Dynamic subtest rcs0: SUCCESS (1.039s)
[438.851363] Starting dynamic subtest: bcs0
[439.974449] Dynamic subtest bcs0: SUCCESS (1.137s)
[439.990799] Starting dynamic subtest: vcs0
[441.128039] Dynamic subtest vcs0: SUCCESS (1.150s)
[441.141399] Starting dynamic subtest: vcs1
[442.252123] Dynamic subtest vcs1: SUCCESS (1.125s)
[442.266227] Starting dynamic subtest: vecs0
[443.387713] Dynamic subtest vecs0: SUCCESS (1.130s)
[443.389330] Subtest nonpriv: SUCCESS (5.588s)
[443.689037] [117/156] (594s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[445.187470] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu
[447.370512] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (2.187s)
[447.581656] [118/156] (590s left) kms_flip (2x-modeset-vs-vblank-race-interruptible)
[449.079405] Starting subtest: 2x-modeset-vs-vblank-race-interruptible
[449.098595] Subtest 2x-modeset-vs-vblank-race-interruptible: SKIP (0.017s)
[449.252383] [119/156] (589s left) gem_exec_balancer (parallel-out-fence)
[449.676396] Starting subtest: parallel-out-fence
[452.065546] Subtest parallel-out-fence: SUCCESS (2.389s)
[452.222687] [120/156] (586s left) kms_psr (fbc-psr-suspend)
[453.718581] Subtest fbc-psr-suspend: SKIP (0.000s)
[453.801950] [121/156] (584s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-spr-indfb-move)
[455.300476] Starting subtest: psrhdr-2p-scndscrn-spr-indfb-move
[455.303573] Subtest psrhdr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[455.448853] [122/156] (583s left) gem_mmap_gtt (cpuset-big-copy)
[455.504163] Subtest cpuset-big-copy: SKIP (0.000s)
[455.584983] [123/156] (583s left) perf_pmu (idle-no-semaphores)
[455.636902] Starting subtest: idle-no-semaphores
[455.638595] Starting dynamic subtest: rcs0
[456.203620] Dynamic subtest rcs0: SUCCESS (0.562s)
[456.217865] Starting dynamic subtest: bcs0
[456.719050] Dynamic subtest bcs0: SUCCESS (0.510s)
[456.732947] Starting dynamic subtest: vcs0
[457.234135] Dynamic subtest vcs0: SUCCESS (0.509s)
[457.248126] Starting dynamic subtest: vcs1
[457.753410] Dynamic subtest vcs1: SUCCESS (0.513s)
[457.768353] Starting dynamic subtest: vecs0
[458.269249] Dynamic subtest vecs0: SUCCESS (0.510s)
[458.271320] Subtest idle-no-semaphores: SUCCESS (2.632s)
[458.403662] [124/156] (580s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-shrfb-plflip-blt)
[459.904755] Starting subtest: psrhdr-2p-primscrn-shrfb-plflip-blt
[459.908314] Subtest psrhdr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[460.087499] [125/156] (578s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-sf)
[461.584456] Subtest pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[461.669586] [126/156] (577s left) syncobj_wait (multi-wait-for-submit-signaled)
[461.719272] Starting subtest: multi-wait-for-submit-signaled
[461.720903] Subtest multi-wait-for-submit-signaled: SUCCESS (0.000s)
[461.850620] [127/156] (577s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-plflip-blt)
[463.350243] Starting subtest: fbcpsr-2p-scndscrn-indfb-plflip-blt
[463.353475] Subtest fbcpsr-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s)
[463.614138] [128/156] (575s left) syncobj_timeline (reset-unsignaled)
[463.662240] Starting subtest: reset-unsignaled
[463.664132] Subtest reset-unsignaled: SUCCESS (0.000s)
[463.777439] [129/156] (575s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-spr-indfb-draw-blt)
[465.275935] Starting subtest: fbcpsrhdr-2p-scndscrn-spr-indfb-draw-blt
[465.279153] Subtest fbcpsrhdr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[465.442961] [130/156] (574s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0-hflip)
[466.955224] Starting subtest: linear-max-hw-stride-32bpp-rotate-0-hflip
[466.958393] Subtest linear-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[467.133461] [131/156] (572s left) kms_cursor_legacy (forked-move)
[468.624191] Starting subtest: forked-move
[468.625762] Starting dynamic subtest: pipe-A
[474.056113] Dynamic subtest pipe-A: SUCCESS (5.429s)
[474.074611] Starting dynamic subtest: pipe-B
[479.499122] Dynamic subtest pipe-B: SUCCESS (5.440s)
[479.527244] Starting dynamic subtest: pipe-C
[484.947058] Dynamic subtest pipe-C: SUCCESS (5.445s)
[484.972151] Starting dynamic subtest: pipe-D
[490.387360] Dynamic subtest pipe-D: SUCCESS (5.437s)
[490.413927] Starting dynamic subtest: all-pipes
[495.833767] Dynamic subtest all-pipes: SUCCESS (5.444s)
[495.835396] Subtest forked-move: SUCCESS (27.208s)
[495.957651] [132/156] (543s left) kms_tiled_display (basic-test-pattern)
[498.176505] Subtest basic-test-pattern: SKIP (0.000s)
[498.254459] [133/156] (541s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted)
[498.310547] Starting subtest: etime-multi-wait-all-for-submit-submitted
[498.415405] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.103s)
[498.582277] [134/156] (541s left) prime_mmap (test_refcounting)
[498.634203] Starting subtest: test_refcounting
[498.635593] Starting dynamic subtest: test_refcounting-smem
[498.696450] Dynamic subtest test_refcounting-smem: SUCCESS (0.065s)
[498.710105] Starting dynamic subtest: test_refcounting-lmem0
[498.764262] Dynamic subtest test_refcounting-lmem0: SUCCESS (0.066s)
[498.765781] Subtest test_refcounting: SUCCESS (0.134s)
[498.893286] [135/156] (541s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-plflip-blt)
[500.393846] Starting subtest: fbc-2p-scndscrn-shrfb-plflip-blt
[500.397734] Subtest fbc-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[500.565641] [136/156] (539s left) kms_async_flips (async-flip-with-page-flip-events-linear-atomic)
[502.060913] Starting subtest: async-flip-with-page-flip-events-linear-atomic
[502.297520] Starting dynamic subtest: pipe-A-HDMI-A-4
[504.628761] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (2.327s)
[504.817115] Starting dynamic subtest: pipe-B-HDMI-A-4
[506.873274] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (2.065s)
[507.040997] Starting dynamic subtest: pipe-C-HDMI-A-4
[509.108401] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (2.077s)
[509.270280] Starting dynamic subtest: pipe-D-HDMI-A-4
[511.328526] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (2.069s)
[511.330352] Subtest async-flip-with-page-flip-events-linear-atomic: SUCCESS (9.268s)
[511.695734] [137/156] (528s left) kms_plane (plane-panning-top-left)
[513.188103] Starting subtest: plane-panning-top-left
[513.189477] Starting dynamic subtest: pipe-A
[513.922574] Dynamic subtest pipe-A: SUCCESS (0.732s)
[513.938616] Starting dynamic subtest: pipe-B
[514.483151] Dynamic subtest pipe-B: SUCCESS (0.557s)
[514.485129] Subtest plane-panning-top-left: SUCCESS (1.295s)
[514.724293] [138/156] (525s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-wc)
[516.223424] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-wc
[516.229337] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[516.417971] [139/156] (524s left) gem_tiled_wb
[516.560283] [140/156] (523s left) kms_vblank (wait-forked-hang)
[518.054942] Starting subtest: wait-forked-hang
[518.056691] Starting dynamic subtest: pipe-A-HDMI-A-4
[544.481339] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (26.425s)
[544.498873] Starting dynamic subtest: pipe-D-HDMI-A-4
[569.487469] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (25.002s)
[569.489095] Subtest wait-forked-hang: SUCCESS (51.435s)
[569.698393] [141/156] (470s left) fbdev (write)
[569.752913] Starting subtest: write
[570.477952] Subtest write: SUCCESS (0.722s)
[570.570417] [142/156] (470s left) gem_mmap_gtt (coherency)
[570.622262] Subtest coherency: SKIP (0.000s)
[570.703492] [143/156] (470s left) syncobj_timeline (invalid-transfer-bad-pad)
[570.771871] Starting subtest: invalid-transfer-bad-pad
[570.773854] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s)
[570.907655] [144/156] (469s left) gem_ctx_exec (basic)
[570.959945] Starting subtest: basic
[570.965562] Subtest basic: SUCCESS (0.006s)
[571.182361] [145/156] (469s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs)
[572.680794] Starting subtest: crc-primary-suspend-4-tiled-mtl-rc-ccs
[572.682530] Starting dynamic subtest: pipe-A-HDMI-A-4
[572.689510] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.000s)
[572.704137] Starting dynamic subtest: pipe-B-HDMI-A-4
[572.711336] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.000s)
[572.725591] Starting dynamic subtest: pipe-C-HDMI-A-4
[572.732637] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.000s)
[572.746831] Starting dynamic subtest: pipe-D-HDMI-A-4
[572.753895] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.000s)
[572.757786] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs: SKIP (0.010s)
[572.954989] [146/156] (468s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180)
[574.468310] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180
[575.714842] Subtest y-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.246s)
[575.945926] [147/156] (465s left) i915_pm_rpm (reg-read-ioctl)
[580.064804] Starting subtest: reg-read-ioctl
[582.016836] Subtest reg-read-ioctl: SUCCESS (1.954s)
[583.099937] [148/156] (458s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[584.602251] Starting subtest: read-crc-frame-sequence
[584.603955] Starting dynamic subtest: pipe-A-HDMI-A-4
[585.293628] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.689s)
[585.307936] Starting dynamic subtest: pipe-B-HDMI-A-4
[585.851305] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.555s)
[585.867642] Starting dynamic subtest: pipe-C-HDMI-A-4
[586.360525] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.506s)
[586.376879] Starting dynamic subtest: pipe-D-HDMI-A-4
[586.875148] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.511s)
[586.877221] Subtest read-crc-frame-sequence: SUCCESS (2.273s)
[587.108537] [149/156] (454s left) kms_frontbuffer_tracking (fbchdr-rgb565-draw-render)
[588.610190] Starting subtest: fbchdr-rgb565-draw-render
[588.613582] Subtest fbchdr-rgb565-draw-render: SKIP (0.000s)
[588.792243] [150/156] (452s left) gem_userptr_blits (unsync-unmap-after-close)
[588.853043] Subtest unsync-unmap-after-close: SKIP (0.000s)
[589.087295] [151/156] (452s left) kms_big_fb (yf-tiled-16bpp-rotate-180)
[590.601394] Starting subtest: yf-tiled-16bpp-rotate-180
[590.604812] Subtest yf-tiled-16bpp-rotate-180: SKIP (0.000s)
[590.788902] [152/156] (450s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-pwrite)
[592.287529] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-pwrite
[592.290811] Subtest psr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[592.479268] [153/156] (449s left) syncobj_wait (invalid-reset-bad-pad)
[592.546431] Starting subtest: invalid-reset-bad-pad
[592.548554] Subtest invalid-reset-bad-pad: SUCCESS (0.000s)
[592.679817] [154/156] (449s left) perf (buffer-fill)
[592.841934] Starting subtest: buffer-fill
[592.843474] Starting dynamic subtest: 0-rcs0
[595.098878] Dynamic subtest 0-rcs0: SUCCESS (2.255s)
[595.100338] Subtest buffer-fill: SUCCESS (2.256s)
[595.173581] [155/156] (446s left) syncobj_wait (single-wait-for-submit-submitted)
[595.225371] Starting subtest: single-wait-for-submit-submitted
[595.334859] Subtest single-wait-for-submit-submitted: SUCCESS (0.107s)
[595.549633] [156/156] (446s left) gem_ctx_exec (basic-invalid-context)
[595.599529] Starting subtest: basic-invalid-context
[595.604129] Subtest basic-invalid-context: SUCCESS (0.006s)
[595.800036] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_psr
results: parsing output: 2/ for test: perf_pmu
results: parsing output: 3/ for test: kms_ccs
results: parsing output: 4/ for test: i915_drm_fdinfo
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: kms_big_fb
results: parsing output: 7/ for test: kms_cursor_crc
results: parsing output: 8/ for test: gem_exec_whisper
results: parsing output: 9/ for test: gem_vm_create
results: parsing output: 10/ for test: template
results: parsing output: 11/ for test: kms_atomic
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: kms_frontbuffer_tracking
results: parsing output: 14/ for test: i915_hangman
results: parsing output: 15/ for test: kms_lease
results: parsing output: 16/ for test: gem_exec_schedule
results: parsing output: 17/ for test: gem_linear_blits
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: api_intel_bb
results: parsing output: 20/ for test: kms_plane
results: parsing output: 21/ for test: prime_vgem
results: parsing output: 22/ for test: kms_atomic_transition
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: kms_psr
results: parsing output: 25/ for test: kms_plane
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: gem_exec_schedule
results: parsing output: 28/ for test: gem_exec_fence
results: parsing output: 29/ for test: kms_psr2_sf
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: gem_softpin
results: parsing output: 32/ for test: kms_addfb_basic
results: parsing output: 33/ for test: kms_cursor_crc
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: kms_lease
results: parsing output: 36/ for test: gem_exec_balancer
results: parsing output: 37/ for test: kms_content_protection
results: parsing output: 38/ for test: gem_exec_reloc
results: parsing output: 39/ for test: gem_lmem_swapping
results: parsing output: 40/ for test: syncobj_wait
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: kms_cdclk
results: parsing output: 45/ for test: kms_big_fb
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: kms_pm_dc
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: gem_ctx_persistence
results: parsing output: 51/ for test: kms_cursor_legacy
results: parsing output: 52/ for test: syncobj_wait
results: parsing output: 53/ for test: syncobj_timeline
results: parsing output: 54/ for test: kms_prop_blob
results: parsing output: 55/ for test: gem_render_copy
results: parsing output: 56/ for test: gem_ctx_shared
results: parsing output: 57/ for test: kms_flip
results: parsing output: 58/ for test: kms_flip_scaled_crc
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: kms_big_fb
results: parsing output: 62/ for test: kms_getfb
results: parsing output: 63/ for test: device_reset
results: parsing output: 64/ for test: kms_flip
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: kms_psr
results: parsing output: 70/ for test: kms_psr
results: parsing output: 71/ for test: i915_query
results: parsing output: 72/ for test: perf_pmu
results: parsing output: 73/ for test: kms_color
results: parsing output: 74/ for test: kms_plane_scaling
results: parsing output: 75/ for test: kms_flip_scaled_crc
results: parsing output: 76/ for test: sysfs_heartbeat_interval
results: parsing output: 77/ for test: syncobj_timeline
results: parsing output: 78/ for test: syncobj_wait
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: kms_chamelium_hpd
results: parsing output: 81/ for test: kms_flip
results: parsing output: 82/ for test: kms_dsc
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_setmode
results: parsing output: 85/ for test: prime_busy
results: parsing output: 86/ for test: kms_ccs
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: vgem_basic
results: parsing output: 90/ for test: kms_big_fb
results: parsing output: 91/ for test: gem_exec_reloc
results: parsing output: 92/ for test: kms_cursor_edge_walk
results: parsing output: 93/ for test: kms_chamelium_frames
results: parsing output: 94/ for test: kms_flip
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: api_intel_bb
results: parsing output: 97/ for test: gem_mmap_wc
results: parsing output: 98/ for test: gem_readwrite
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_psr
results: parsing output: 101/ for test: kms_cursor_legacy
results: parsing output: 102/ for test: gem_mmap_offset
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: gen9_exec_parse
results: parsing output: 109/ for test: i915_query
results: parsing output: 110/ for test: gem_mmap_gtt
results: parsing output: 111/ for test: gem_render_copy
results: parsing output: 112/ for test: kms_ccs
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: gem_ctx_param
results: parsing output: 115/ for test: gem_ctx_isolation
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: kms_flip
results: parsing output: 118/ for test: gem_exec_balancer
results: parsing output: 119/ for test: kms_psr
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: gem_mmap_gtt
results: parsing output: 122/ for test: perf_pmu
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_psr2_sf
results: parsing output: 125/ for test: syncobj_wait
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: syncobj_timeline
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: kms_big_fb
results: parsing output: 130/ for test: kms_cursor_legacy
results: parsing output: 131/ for test: kms_tiled_display
results: parsing output: 132/ for test: syncobj_timeline
results: parsing output: 133/ for test: prime_mmap
results: parsing output: 134/ for test: kms_frontbuffer_tracking
results: parsing output: 135/ for test: kms_async_flips
results: parsing output: 136/ for test: kms_plane
results: parsing output: 137/ for test: kms_frontbuffer_tracking
results: parsing output: 138/ for test: gem_tiled_wb
results: parsing output: 139/ for test: kms_vblank
results: parsing output: 140/ for test: fbdev
results: parsing output: 141/ for test: gem_mmap_gtt
results: parsing output: 142/ for test: syncobj_timeline
results: parsing output: 143/ for test: gem_ctx_exec
results: parsing output: 144/ for test: kms_ccs
results: parsing output: 145/ for test: kms_big_fb
results: parsing output: 146/ for test: i915_pm_rpm
results: parsing output: 147/ for test: kms_pipe_crc_basic
results: parsing output: 148/ for test: kms_frontbuffer_tracking
results: parsing output: 149/ for test: gem_userptr_blits
results: parsing output: 150/ for test: kms_big_fb
results: parsing output: 151/ for test: kms_frontbuffer_tracking
results: parsing output: 152/ for test: syncobj_wait
results: parsing output: 153/ for test: perf
results: parsing output: 154/ for test: syncobj_wait
results: parsing output: 155/ for test: gem_ctx_exec
Done.