[65.253914] Initializing watchdogs
[65.253981]   /dev/watchdog0
[65.274266] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[65.285453] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[65.289527] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[65.292230] [001/133] (960s left) gen9_exec_parse (allowed-all)
[65.376358] Subtest allowed-all: SKIP (0.000s)
[65.423368] [002/133] (960s left) gem_exec_balancer (sequential)
[65.504617] Starting subtest: sequential
[71.476245] Subtest sequential: SUCCESS (5.978s)
[71.899992] [003/133] (953s left) kms_big_fb (4-tiled-8bpp-rotate-0)
[73.422995] Starting subtest: 4-tiled-8bpp-rotate-0
[75.077865] Subtest 4-tiled-8bpp-rotate-0: SUCCESS (1.655s)
[75.267858] [004/133] (950s left) gem_pwrite (basic-self)
[75.340039] Subtest basic-self: SKIP (0.000s)
[75.400464] [005/133] (950s left) kms_ccs (random-ccs-data-4-tiled-bmg-ccs)
[76.910259] Starting subtest: random-ccs-data-4-tiled-bmg-ccs
[76.912130] Subtest random-ccs-data-4-tiled-bmg-ccs: SKIP (0.000s)
[77.087565] [006/133] (948s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[78.609000] Starting subtest: nonblocking-crc-frame-sequence
[78.609900] Starting dynamic subtest: pipe-A-HDMI-A-3
[79.321181] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.711s)
[79.329423] Starting dynamic subtest: pipe-B-HDMI-A-3
[79.849193] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.527s)
[79.856972] Starting dynamic subtest: pipe-C-HDMI-A-3
[80.361995] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.511s)
[80.369485] Starting dynamic subtest: pipe-D-HDMI-A-3
[80.914289] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.551s)
[80.915206] Subtest nonblocking-crc-frame-sequence: SUCCESS (2.305s)
[81.073066] [007/133] (945s left) gem_mmap_gtt (fault-concurrent-x)
[81.145769] Subtest fault-concurrent-X: SKIP (0.000s)
[81.219929] [008/133] (944s left) gem_exec_whisper (basic-queues-forked)
[81.300297] Starting subtest: basic-queues-forked
[103.715210] Subtest basic-queues-forked: SUCCESS (22.412s)
[103.943695] [009/133] (922s left) kms_flip (dpms-off-confusion)
[105.455949] Starting subtest: dpms-off-confusion
[105.461057] Starting dynamic subtest: A-HDMI-A3
[113.238247] Dynamic subtest A-HDMI-A3: SUCCESS (7.777s)
[113.247458] Starting dynamic subtest: B-HDMI-A3
[120.922054] Dynamic subtest B-HDMI-A3: SUCCESS (7.683s)
[120.930146] Starting dynamic subtest: C-HDMI-A3
[128.604929] Dynamic subtest C-HDMI-A3: SUCCESS (7.682s)
[128.613099] Starting dynamic subtest: D-HDMI-A3
[136.288645] Dynamic subtest D-HDMI-A3: SUCCESS (7.683s)
[136.289527] Subtest dpms-off-confusion: SUCCESS (30.833s)
[136.489993] [010/133] (889s left) kms_big_fb (yf-tiled-16bpp-rotate-0)
[138.008427] Starting subtest: yf-tiled-16bpp-rotate-0
[138.010262] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s)
[138.120648] [011/133] (888s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[139.663516] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[139.665246] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[139.766974] [012/133] (886s left) gem_exec_whisper (basic-contexts-forked-all)
[139.879065] Starting subtest: basic-contexts-forked-all
[162.322714] Subtest basic-contexts-forked-all: SUCCESS (22.443s)
[162.542575] [013/133] (863s left) gem_mmap_wc (coherency)
[162.618063] Subtest coherency: SKIP (0.000s)
[162.690456] [014/133] (863s left) gem_exec_fence (keep-in-fence)
[162.888579] Starting subtest: keep-in-fence
[162.889745] Starting dynamic subtest: rcs0
[162.995411] Dynamic subtest rcs0: SUCCESS (0.107s)
[163.004669] Starting dynamic subtest: bcs0
[163.050530] Dynamic subtest bcs0: SUCCESS (0.055s)
[163.063694] Starting dynamic subtest: vcs0
[163.108204] Dynamic subtest vcs0: SUCCESS (0.057s)
[163.130672] Starting dynamic subtest: vcs1
[163.177831] Dynamic subtest vcs1: SUCCESS (0.069s)
[163.197747] Starting dynamic subtest: vecs0
[163.241469] Dynamic subtest vecs0: SUCCESS (0.063s)
[163.268395] Starting dynamic subtest: vecs1
[163.312410] Dynamic subtest vecs1: SUCCESS (0.070s)
[163.339070] Starting dynamic subtest: ccs0
[163.552587] Dynamic subtest ccs0: SUCCESS (0.240s)
[163.553624] Subtest keep-in-fence: SUCCESS (0.664s)
[164.356342] [FACT gem_exec_fence (keep-in-fence)] new: kernel.kmod_is_loaded.vgem: true
[164.358256] [015/133] (862s left) kms_atomic (plane-primary-overlay-mutable-zpos)
[165.873015] Starting subtest: plane-primary-overlay-mutable-zpos
[167.511933] Subtest plane-primary-overlay-mutable-zpos: SKIP (1.638s)
[167.727510] [016/133] (858s left) kms_chamelium_color (ctm-0-75)
[169.237981] Subtest ctm-0-75: SKIP (0.000s)
[169.288493] [017/133] (857s left) kms_addfb_basic (bad-pitch-65536)
[169.371010] Starting subtest: bad-pitch-65536
[169.371949] Subtest bad-pitch-65536: SUCCESS (0.000s)
[170.957236] [018/133] (855s left) kms_plane (pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping)
[172.515113] Starting subtest: pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping
[172.516894] Subtest pixel-format-4-tiled-mtl-mc-ccs-modifier-source-clamping: SKIP (0.000s)
[172.627043] [019/133] (854s left) gem_eio (in-flight-1us)
[172.941408] Starting subtest: in-flight-1us
[177.842631] Subtest in-flight-1us: SUCCESS (4.901s)
[179.391375] [020/133] (847s left) gem_exec_params (cliprects_ptr-dirt)
[179.489952] Starting subtest: cliprects_ptr-dirt
[179.490897] Subtest cliprects_ptr-dirt: SUCCESS (0.000s)
[179.642416] [021/133] (847s left) i915_query (test-query-geometry-subslices)
[179.719031] Starting subtest: test-query-geometry-subslices
[179.720157] Subtest test-query-geometry-subslices: SUCCESS (0.000s)
[179.840482] [022/133] (847s left) kms_chamelium_edid (dp-edid-change-during-suspend)
[181.390297] Subtest dp-edid-change-during-suspend: SKIP (0.000s)
[181.485743] [023/133] (845s left) kms_cursor_legacy (torture-move)
[183.004008] Starting subtest: torture-move
[183.004946] Starting dynamic subtest: pipe-A
[188.457408] Dynamic subtest pipe-A: SUCCESS (5.452s)
[188.466253] Starting dynamic subtest: pipe-B
[193.912925] Dynamic subtest pipe-B: SUCCESS (5.455s)
[193.937724] Starting dynamic subtest: pipe-C
[199.363245] Dynamic subtest pipe-C: SUCCESS (5.450s)
[199.371896] Starting dynamic subtest: pipe-D
[204.808766] Dynamic subtest pipe-D: SUCCESS (5.445s)
[204.818818] Starting dynamic subtest: all-pipes
[210.262588] Dynamic subtest all-pipes: SUCCESS (5.453s)
[210.263447] Subtest torture-move: SUCCESS (27.257s)
[210.367056] [024/133] (816s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[211.916210] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-wc
[211.917982] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[212.090270] [025/133] (815s left) gem_create (create-ext-cpu-access-sanity-check)
[212.295010] Starting subtest: create-ext-cpu-access-sanity-check
[212.301206] Subtest create-ext-cpu-access-sanity-check: SUCCESS (0.006s)
[212.415941] [026/133] (814s left) gem_eio (in-flight-internal-immediate)
[212.730556] Starting subtest: in-flight-internal-immediate
[213.886884] Subtest in-flight-internal-immediate: SUCCESS (1.157s)
[215.507743] [027/133] (811s left) perf_pmu (frequency)
[215.591867] Starting subtest: frequency
[215.595265] Starting dynamic subtest: gt0
[217.839455] Dynamic subtest gt0: FAIL (2.173s)
[217.873169] Starting dynamic subtest: idle-gt0
[218.275308] Dynamic subtest idle-gt0: SUCCESS (0.504s)
[218.277065] Subtest frequency: FAIL (2.684s)
[218.440634] [028/133] (809s left) gem_exec_fence (basic-wait-all)
[218.529171] Starting subtest: basic-wait-all
[218.642396] Subtest basic-wait-all: SUCCESS (0.113s)
[219.488076] [029/133] (808s left) dmabuf_sync_file (export-multiwait)
[219.540849] Starting subtest: export-multiwait
[219.541896] Subtest export-multiwait: SUCCESS (0.000s)
[219.621145] [030/133] (807s left) syncobj_timeline (single-wait-all-for-submit-available-signaled)
[219.699958] Starting subtest: single-wait-all-for-submit-available-signaled
[219.700905] Subtest single-wait-all-for-submit-available-signaled: SUCCESS (0.000s)
[219.870490] [031/133] (807s left) kms_psr (fbc-pr-cursor-plane-move)
[221.379087] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s)
[221.432661] [032/133] (806s left) kms_psr (psr2-suspend)
[222.947324] Subtest psr2-suspend: SKIP (0.000s)
[223.000162] [033/133] (804s left) gem_exec_reloc (basic-write-cpu)
[223.085409] Subtest basic-write-cpu: SKIP (0.000s)
[223.177519] [034/133] (804s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs)
[224.684099] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs
[224.685048] Starting dynamic subtest: pipe-A-HDMI-A-3
[224.693535] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.001s)
[224.703397] Starting dynamic subtest: pipe-B-HDMI-A-3
[224.712709] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.001s)
[224.722292] Starting dynamic subtest: pipe-C-HDMI-A-3
[224.730978] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.001s)
[224.740318] Starting dynamic subtest: pipe-D-HDMI-A-3
[224.749457] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.001s)
[224.751574] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SKIP (0.006s)
[224.914966] [035/133] (802s left) kms_plane_scaling (plane-downscale-factor-0-5-with-pixel-format)
[226.429050] Starting subtest: plane-downscale-factor-0-5-with-pixel-format
[226.429999] Starting dynamic subtest: pipe-A
[228.387790] Dynamic subtest pipe-A: SUCCESS (1.958s)
[228.399292] Starting dynamic subtest: pipe-B
[230.345770] Dynamic subtest pipe-B: SUCCESS (1.957s)
[230.365064] Starting dynamic subtest: pipe-C
[230.587334] Dynamic subtest pipe-C: SUCCESS (0.241s)
[230.606640] Starting dynamic subtest: pipe-D
[230.829029] Dynamic subtest pipe-D: SUCCESS (0.241s)
[230.830255] Subtest plane-downscale-factor-0-5-with-pixel-format: SUCCESS (4.400s)
[231.046824] [036/133] (796s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite)
[232.570730] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite
[232.572407] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[232.712329] [037/133] (795s left) gem_exec_schedule (smoketest)
[232.962464] Starting subtest: smoketest
[232.963957] Starting dynamic subtest: rcs0
[238.455601] Dynamic subtest rcs0: SUCCESS (5.488s)
[238.465473] Starting dynamic subtest: bcs0
[243.918969] Dynamic subtest bcs0: SUCCESS (5.464s)
[243.928663] Starting dynamic subtest: vcs0
[249.379853] Dynamic subtest vcs0: SUCCESS (5.460s)
[249.390288] Starting dynamic subtest: vcs1
[254.840161] Dynamic subtest vcs1: SUCCESS (5.460s)
[254.850200] Starting dynamic subtest: vecs0
[260.312955] Dynamic subtest vecs0: SUCCESS (5.471s)
[260.322603] Starting dynamic subtest: vecs1
[265.768810] Dynamic subtest vecs1: SUCCESS (5.456s)
[265.779788] Starting dynamic subtest: ccs0
[271.227433] Dynamic subtest ccs0: SUCCESS (5.456s)
[271.228314] Subtest smoketest: SUCCESS (38.259s)
[271.506525] [038/133] (756s left) kms_flip (plain-flip-interruptible)
[273.022189] Starting subtest: plain-flip-interruptible
[273.028108] Starting dynamic subtest: A-HDMI-A3
[273.787657] Dynamic subtest A-HDMI-A3: SUCCESS (0.759s)
[273.803566] Starting dynamic subtest: B-HDMI-A3
[274.453924] Dynamic subtest B-HDMI-A3: SUCCESS (0.664s)
[274.466944] Starting dynamic subtest: C-HDMI-A3
[275.121221] Dynamic subtest C-HDMI-A3: SUCCESS (0.666s)
[275.137044] Starting dynamic subtest: D-HDMI-A3
[275.787342] Dynamic subtest D-HDMI-A3: SUCCESS (0.663s)
[275.788910] Subtest plain-flip-interruptible: SUCCESS (2.765s)
[276.019254] [039/133] (752s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[277.538172] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[277.539949] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[277.665273] [040/133] (750s left) i915_drm_fdinfo (virtual-busy-hang)
[277.760503] Starting subtest: virtual-busy-hang
[277.762288] Subtest virtual-busy-hang: SKIP (0.000s)
[277.879792] [041/133] (750s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt)
[279.393271] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt
[279.395045] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[279.539942] [042/133] (748s left) kms_lease (cursor-implicit-plane)
[281.078404] Starting subtest: cursor-implicit-plane
[281.079270] Starting dynamic subtest: pipe-A-HDMI-A-3
[281.435552] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.357s)
[281.447181] Starting dynamic subtest: pipe-B-HDMI-A-3
[281.637295] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.199s)
[281.651526] Starting dynamic subtest: pipe-C-HDMI-A-3
[281.841610] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.202s)
[281.853388] Starting dynamic subtest: pipe-D-HDMI-A-3
[282.062232] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.219s)
[282.064053] Subtest cursor-implicit-plane: SUCCESS (0.985s)
[282.246663] [043/133] (746s left) sw_sync (alloc_merge_fence)
[282.295519] Starting subtest: alloc_merge_fence
[282.296410] Subtest alloc_merge_fence: SUCCESS (0.000s)
[282.365721] [044/133] (746s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-msflip-blt)
[283.881879] Starting subtest: fbc-2p-primscrn-shrfb-msflip-blt
[283.883595] Subtest fbc-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[284.033806] [045/133] (744s left) i915_query (query-topology-unsupported)
[284.140350] Starting subtest: query-topology-unsupported
[284.142148] Subtest query-topology-unsupported: SKIP (0.000s)
[284.279281] [046/133] (744s left) kms_cursor_legacy (flip-vs-cursor-crc-atomic)
[285.794710] Starting subtest: flip-vs-cursor-crc-atomic
[286.342431] Subtest flip-vs-cursor-crc-atomic: SUCCESS (0.548s)
[286.545730] [047/133] (742s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[288.063184] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[288.064910] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[288.236115] [048/133] (740s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted-signaled)
[288.332142] Starting subtest: multi-wait-available-unsubmitted-submitted-signaled
[288.333062] Subtest multi-wait-available-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[288.531192] [049/133] (740s left) kms_setmode (basic)
[288.610121] Starting subtest: basic
[288.708182] Starting dynamic subtest: pipe-A-HDMI-A-3
[290.838589] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.128s)
[290.929365] Starting dynamic subtest: pipe-B-HDMI-A-3
[293.050926] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (2.128s)
[293.090364] Subtest basic: SUCCESS (4.479s)
[293.265320] [050/133] (735s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling)
[294.778482] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling
[294.780247] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-downscaling: SKIP (0.000s)
[294.874504] [051/133] (734s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-render)
[296.403168] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-render
[296.404893] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[296.543488] [052/133] (732s left) syncobj_eventfd (binary-wait-before-signal)
[296.648341] Starting subtest: binary-wait-before-signal
[296.679164] Subtest binary-wait-before-signal: SUCCESS (0.031s)
[296.830512] [053/133] (732s left) kms_big_fb (x-tiled-addfb)
[298.351288] Starting subtest: x-tiled-addfb
[298.352420] Subtest x-tiled-addfb: SUCCESS (0.000s)
[298.512742] [054/133] (730s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-wc)
[300.049542] Starting subtest: fbcpsr-rgb101010-draw-mmap-wc
[300.051282] Subtest fbcpsr-rgb101010-draw-mmap-wc: SKIP (0.000s)
[300.249663] [055/133] (729s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[301.772079] Starting subtest: addfb25-y-tiled-small-legacy
[301.773838] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s)
[301.914324] [056/133] (727s left) gem_ctx_param (invalid-set-ringsize)
[302.021536] Starting subtest: invalid-set-ringsize
[302.022422] Subtest invalid-set-ringsize: SUCCESS (0.000s)
[302.152972] [057/133] (727s left) kms_prime (basic-modeset-hybrid)
[303.670259] Subtest basic-modeset-hybrid: SKIP (0.000s)
[303.877782] [058/133] (725s left) kms_vblank (crtc-id)
[305.395196] Starting subtest: crtc-id
[305.397343] Starting dynamic subtest: pipe-A-HDMI-A-3
[305.752683] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.356s)
[305.772806] Starting dynamic subtest: pipe-D-HDMI-A-3
[305.999691] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.241s)
[306.000533] Subtest crtc-id: SUCCESS (0.604s)
[306.164026] [059/133] (723s left) gem_exec_balancer (noheartbeat)
[306.559913] Starting subtest: noheartbeat
[306.561855] Subtest noheartbeat: SKIP (0.000s)
[306.650348] [060/133] (723s left) prime_udl
[306.764771] [061/133] (723s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-cpu)
[308.281793] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-cpu
[308.283414] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[308.433775] [062/133] (721s left) gem_busy (extended)
[308.731647] Starting subtest: extended
[308.732562] Starting dynamic subtest: rcs0
[308.827967] Dynamic subtest rcs0: SUCCESS (0.095s)
[308.844102] Starting dynamic subtest: bcs0
[308.874304] Dynamic subtest bcs0: SUCCESS (0.045s)
[308.889180] Starting dynamic subtest: vcs0
[308.917863] Dynamic subtest vcs0: SUCCESS (0.042s)
[308.945770] Starting dynamic subtest: vcs1
[308.963854] Dynamic subtest vcs1: SUCCESS (0.045s)
[308.984931] Starting dynamic subtest: vecs0
[309.008738] Dynamic subtest vecs0: SUCCESS (0.044s)
[309.024068] Starting dynamic subtest: vecs1
[309.050591] Dynamic subtest vecs1: SUCCESS (0.041s)
[309.069968] Starting dynamic subtest: ccs0
[309.093787] Dynamic subtest ccs0: SUCCESS (0.042s)
[309.095032] Subtest extended: SUCCESS (0.363s)
[309.394665] [063/133] (720s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-fully-sf)
[310.909560] Subtest pr-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[310.963038] [064/133] (719s left) gem_userptr_blits (sync-unmap)
[311.059304] Starting subtest: sync-unmap
[311.081212] Subtest sync-unmap: SUCCESS (0.023s)
[311.263637] [065/133] (718s left) kms_flip (blocking-wf_vblank)
[312.774248] Starting subtest: blocking-wf_vblank
[312.779397] Starting dynamic subtest: A-HDMI-A3
[320.823150] Dynamic subtest A-HDMI-A3: SUCCESS (8.043s)
[320.835258] Starting dynamic subtest: B-HDMI-A3
[328.790031] Dynamic subtest B-HDMI-A3: SUCCESS (7.966s)
[328.800465] Starting dynamic subtest: C-HDMI-A3
[336.756442] Dynamic subtest C-HDMI-A3: SUCCESS (7.965s)
[336.766657] Starting dynamic subtest: D-HDMI-A3
[344.722383] Dynamic subtest D-HDMI-A3: SUCCESS (7.965s)
[344.723309] Subtest blocking-wf_vblank: SUCCESS (31.949s)
[344.914274] [066/133] (685s left) gem_spin_batch (legacy-resubmit)
[345.002745] Starting subtest: legacy-resubmit
[345.003620] Starting dynamic subtest: default
[345.031878] Dynamic subtest default: SUCCESS (0.028s)
[345.042274] Starting dynamic subtest: render
[345.043234] Dynamic subtest render: SUCCESS (0.001s)
[345.053639] Starting dynamic subtest: bsd
[345.054820] Dynamic subtest bsd: SUCCESS (0.003s)
[345.064753] Starting dynamic subtest: bsd1
[345.065882] Dynamic subtest bsd1: SUCCESS (0.002s)
[345.075527] Starting dynamic subtest: bsd2
[345.076740] Dynamic subtest bsd2: SUCCESS (0.002s)
[345.086245] Starting dynamic subtest: blt
[345.087325] Dynamic subtest blt: SUCCESS (0.002s)
[345.096725] Starting dynamic subtest: vebox
[345.097797] Dynamic subtest vebox: SUCCESS (0.002s)
[345.098924] Subtest legacy-resubmit: SUCCESS (0.047s)
[345.366763] [067/133] (684s left) kms_ccs (ccs-on-another-bo-yf-tiled-ccs)
[346.878481] Starting subtest: ccs-on-another-bo-yf-tiled-ccs
[346.879325] Starting dynamic subtest: pipe-A-HDMI-A-3
[346.887841] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.000s)
[346.897973] Starting dynamic subtest: pipe-B-HDMI-A-3
[346.906630] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.000s)
[346.916410] Starting dynamic subtest: pipe-C-HDMI-A-3
[346.924794] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.000s)
[346.934322] Starting dynamic subtest: pipe-D-HDMI-A-3
[346.944750] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.000s)
[346.946998] Subtest ccs-on-another-bo-yf-tiled-ccs: SKIP (0.006s)
[347.110879] [068/133] (683s left) kms_cursor_legacy (cursora-vs-flipa-atomic)
[348.622803] Starting subtest: cursorA-vs-flipA-atomic
[359.535973] Subtest cursorA-vs-flipA-atomic: SUCCESS (10.913s)
[359.731367] [069/133] (670s left) kms_setmode (clone-exclusive-crtc)
[359.809318] Starting subtest: clone-exclusive-crtc
[359.812081] Subtest clone-exclusive-crtc: SKIP (0.000s)
[359.962516] [070/133] (670s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[361.482442] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[361.484145] Subtest psr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[361.610692] [071/133] (668s left) gem_exec_schedule (fifo)
[361.732293] Starting subtest: fifo
[361.733295] Starting dynamic subtest: rcs0
[362.027038] Dynamic subtest rcs0: SUCCESS (0.282s)
[362.036820] Starting dynamic subtest: bcs0
[362.212564] Dynamic subtest bcs0: SUCCESS (0.197s)
[362.222397] Starting dynamic subtest: vcs0
[362.422769] Dynamic subtest vcs0: SUCCESS (0.209s)
[362.432582] Starting dynamic subtest: vcs1
[362.633323] Dynamic subtest vcs1: SUCCESS (0.210s)
[362.643174] Starting dynamic subtest: vecs0
[362.844372] Dynamic subtest vecs0: SUCCESS (0.210s)
[362.854734] Starting dynamic subtest: vecs1
[363.055678] Dynamic subtest vecs1: SUCCESS (0.211s)
[363.065691] Starting dynamic subtest: ccs0
[363.259054] Dynamic subtest ccs0: SUCCESS (0.203s)
[363.260195] Subtest fifo: SUCCESS (1.527s)
[363.674726] [072/133] (666s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)
[365.191461] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-cpu
[365.193234] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[365.409179] [073/133] (665s left) prime_mmap (test_reprime)
[365.491815] Starting subtest: test_reprime
[365.492721] Starting dynamic subtest: test_reprime-smem
[365.538888] Dynamic subtest test_reprime-smem: SUCCESS (0.047s)
[365.548617] Starting dynamic subtest: test_reprime-lmem0
[365.734500] Dynamic subtest test_reprime-lmem0: SUCCESS (0.195s)
[365.735500] Subtest test_reprime: SUCCESS (0.243s)
[365.881848] [074/133] (664s left) syncobj_timeline (invalid-multi-wait-unsubmitted)
[365.963153] Starting subtest: invalid-multi-wait-unsubmitted
[365.964188] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[366.152747] [075/133] (664s left) gem_exec_schedule (preempt-queue)
[366.244558] Subtest preempt-queue: SKIP (0.000s)
[366.654711] [076/133] (664s left) kms_addfb_basic (small-bo)
[368.165747] Starting subtest: small-bo
[368.166527] Subtest small-bo: SUCCESS (0.000s)
[368.291722] [077/133] (662s left) i915_hangman (engine-engine-error)
[368.412960] Starting subtest: engine-engine-error
[368.413883] Starting dynamic subtest: rcs0
[369.199383] Dynamic subtest rcs0: SUCCESS (0.786s)
[369.210209] Starting dynamic subtest: bcs0
[369.914406] Dynamic subtest bcs0: SUCCESS (0.714s)
[369.924418] Starting dynamic subtest: vcs0
[370.623366] Dynamic subtest vcs0: SUCCESS (0.708s)
[370.633460] Starting dynamic subtest: vcs1
[371.365469] Dynamic subtest vcs1: SUCCESS (0.741s)
[371.376379] Starting dynamic subtest: vecs0
[372.094377] Dynamic subtest vecs0: SUCCESS (0.728s)
[372.104914] Starting dynamic subtest: vecs1
[372.811388] Dynamic subtest vecs1: SUCCESS (0.716s)
[372.821419] Starting dynamic subtest: ccs0
[373.560353] Dynamic subtest ccs0: SUCCESS (0.748s)
[373.561277] Subtest engine-engine-error: SUCCESS (5.148s)
[373.739228] [078/133] (657s left) gem_ctx_persistence (legacy-engines-hostile-preempt)
[373.824394] Starting subtest: legacy-engines-hostile-preempt
[373.825311] Starting dynamic subtest: render
[373.922375] Dynamic subtest render: SUCCESS (0.097s)
[373.936883] Starting dynamic subtest: bsd1
[373.967522] Dynamic subtest bsd1: SUCCESS (0.044s)
[373.987398] Starting dynamic subtest: bsd2
[374.020027] Dynamic subtest bsd2: SUCCESS (0.050s)
[374.033614] Starting dynamic subtest: blt
[374.069443] Dynamic subtest blt: SUCCESS (0.047s)
[374.084894] Starting dynamic subtest: vebox
[374.116432] Dynamic subtest vebox: SUCCESS (0.046s)
[374.117574] Subtest legacy-engines-hostile-preempt: SUCCESS (0.293s)
[374.320938] [079/133] (656s left) gem_create (create-valid-nonaligned)
[374.398177] Starting subtest: create-valid-nonaligned
[374.399136] Subtest create-valid-nonaligned: SUCCESS (0.000s)
[374.657731] [080/133] (656s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[376.173482] Starting subtest: psr-farfromfence-mmap-gtt
[376.175262] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[376.314220] [081/133] (655s left) kms_plane_scaling (plane-upscale-factor-0-25-with-pixel-format)
[377.852303] Starting subtest: plane-upscale-factor-0-25-with-pixel-format
[377.853209] Starting dynamic subtest: pipe-A
[379.523300] Dynamic subtest pipe-A: SUCCESS (1.670s)
[379.542469] Starting dynamic subtest: pipe-B
[381.164345] Dynamic subtest pipe-B: SUCCESS (1.640s)
[381.177940] Starting dynamic subtest: pipe-C
[381.390181] Dynamic subtest pipe-C: SUCCESS (0.225s)
[381.417533] Starting dynamic subtest: pipe-D
[381.632782] Dynamic subtest pipe-D: SUCCESS (0.241s)
[381.633987] Subtest plane-upscale-factor-0-25-with-pixel-format: SUCCESS (3.781s)
[381.854817] [082/133] (649s left) kms_prop_blob (blob-multiple)
[381.935454] Starting subtest: blob-multiple
[381.968207] Subtest blob-multiple: SUCCESS (0.034s)
[382.112942] [083/133] (649s left) api_intel_bb (bb-with-allocator)
[382.188446] Starting subtest: bb-with-allocator
[382.217795] Subtest bb-with-allocator: SUCCESS (0.029s)
[382.403882] [084/133] (649s left) kms_psr (fbc-pr-sprite-plane-move)
[383.922179] Subtest fbc-pr-sprite-plane-move: SKIP (0.000s)
[383.985209] [085/133] (647s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[385.502869] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt
[385.504505] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[385.650430] [086/133] (646s left) kms_atomic_interruptible (atomic-setmode)
[387.190907] Starting subtest: atomic-setmode
[387.192992] Starting dynamic subtest: pipe-A-HDMI-A-3
[393.376458] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (6.183s)
[393.377406] Subtest atomic-setmode: SUCCESS (6.185s)
[393.536281] [087/133] (638s left) gem_ctx_shared (disjoint-timelines)
[393.626383] Starting subtest: disjoint-timelines
[393.672468] Subtest disjoint-timelines: SUCCESS (0.046s)
[393.926303] [088/133] (637s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-msflip-blt)
[395.442085] Starting subtest: psr-2p-scndscrn-indfb-msflip-blt
[395.443897] Subtest psr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[395.590180] [089/133] (636s left) kms_chamelium_hpd (dp-hpd-storm)
[397.168663] Subtest dp-hpd-storm: SKIP (0.000s)
[397.268870] [090/133] (634s left) gem_render_copy (yf-tiled-ccs-to-y-tiled-ccs)
[397.360756] Starting subtest: yf-tiled-ccs-to-y-tiled-ccs
[397.362590] Subtest yf-tiled-ccs-to-y-tiled-ccs: SKIP (0.000s)
[397.611282] [091/133] (634s left) syncobj_wait (wait-all-interrupted)
[397.692331] Starting subtest: wait-all-interrupted
[397.796245] Subtest wait-all-interrupted: SUCCESS (0.101s)
[397.933739] [092/133] (634s left) gem_exec_create (madvise)
[398.024956] Starting subtest: madvise
[398.025870] Starting dynamic subtest: smem
[418.162990] Dynamic subtest smem: SUCCESS (20.137s)
[418.174666] Starting dynamic subtest: lmem0
[438.399637] Dynamic subtest lmem0: SUCCESS (20.235s)
[438.400532] Subtest madvise: SUCCESS (40.375s)
[439.490907] [093/133] (592s left) core_auth (getclient-simple)
[439.538920] Starting subtest: getclient-simple
[439.568299] Subtest getclient-simple: SUCCESS (0.030s)
[439.697666] [094/133] (592s left) kms_addfb_basic (tile-pitch-mismatch)
[439.777547] Starting subtest: tile-pitch-mismatch
[439.779283] Subtest tile-pitch-mismatch: SKIP (0.000s)
[441.342116] [095/133] (590s left) kms_color (invalid-degamma-lut-sizes)
[442.876992] Starting subtest: invalid-degamma-lut-sizes
[442.877951] Starting dynamic subtest: pipe-A
[442.927946] Dynamic subtest pipe-A: SUCCESS (0.052s)
[442.938207] Starting dynamic subtest: pipe-B
[442.939169] Dynamic subtest pipe-B: SUCCESS (0.001s)
[442.949215] Starting dynamic subtest: pipe-C
[442.950111] Dynamic subtest pipe-C: SUCCESS (0.000s)
[442.959943] Starting dynamic subtest: pipe-D
[442.960873] Dynamic subtest pipe-D: SUCCESS (0.000s)
[442.961764] Subtest invalid-degamma-lut-sizes: SUCCESS (0.057s)
[443.087053] [096/133] (589s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[444.605656] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[444.607327] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[444.763459] [097/133] (587s left) kms_ccs (bad-pixel-format-y-tiled-ccs)
[446.306046] Starting subtest: bad-pixel-format-y-tiled-ccs
[446.306976] Starting dynamic subtest: pipe-A-HDMI-A-3
[446.315263] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.000s)
[446.325423] Starting dynamic subtest: pipe-B-HDMI-A-3
[446.333996] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.000s)
[446.344078] Starting dynamic subtest: pipe-C-HDMI-A-3
[446.352756] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.000s)
[446.362475] Starting dynamic subtest: pipe-D-HDMI-A-3
[446.370970] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.000s)
[446.373173] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.007s)
[446.542085] [098/133] (585s left) gem_mmap_gtt (hang)
[446.620149] Subtest hang: SKIP (0.000s)
[446.694574] [099/133] (585s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-upscaling)
[448.213094] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-upscaling
[448.214863] Subtest flip-64bpp-ytile-to-16bpp-ytile-upscaling: SKIP (0.000s)
[448.384935] [100/133] (584s left) i915_pm_rpm (debugfs-read)
[452.059765] Starting subtest: debugfs-read
[453.082352] Subtest debugfs-read: SUCCESS (1.022s)
[454.091803] [101/133] (578s left) gem_pxp (reject-modify-context-protection-off-2)
[456.701520] Starting subtest: reject-modify-context-protection-off-2
[456.703554] Subtest reject-modify-context-protection-off-2: SKIP (0.000s)
[456.802445] [102/133] (575s left) prime_busy (after-wait)
[456.886705] Starting subtest: after-wait
[456.891779] Starting dynamic subtest: rcs0
[456.952747] Dynamic subtest rcs0: SUCCESS (0.061s)
[456.964924] Starting dynamic subtest: bcs0
[457.002613] Dynamic subtest bcs0: SUCCESS (0.048s)
[457.015294] Starting dynamic subtest: vcs0
[457.043055] Dynamic subtest vcs0: SUCCESS (0.039s)
[457.060900] Starting dynamic subtest: vcs1
[457.084120] Dynamic subtest vcs1: SUCCESS (0.040s)
[457.104168] Starting dynamic subtest: vecs0
[457.126679] Dynamic subtest vecs0: SUCCESS (0.041s)
[457.146743] Starting dynamic subtest: vecs1
[457.169790] Dynamic subtest vecs1: SUCCESS (0.041s)
[457.189684] Starting dynamic subtest: ccs0
[457.212252] Dynamic subtest ccs0: SUCCESS (0.041s)
[457.320220] Subtest after-wait: SUCCESS (0.433s)
[457.484183] [103/133] (575s left) sysfs_heartbeat_interval (invalid)
[457.568364] Starting subtest: invalid
[457.570485] Starting dynamic subtest: vecs0
[457.571387] Dynamic subtest vecs0: SUCCESS (0.000s)
[457.581841] Starting dynamic subtest: ccs0
[457.583071] Dynamic subtest ccs0: SUCCESS (0.000s)
[457.593203] Starting dynamic subtest: vcs0
[457.594458] Dynamic subtest vcs0: SUCCESS (0.000s)
[457.604405] Starting dynamic subtest: bcs0
[457.605620] Dynamic subtest bcs0: SUCCESS (0.000s)
[457.615479] Starting dynamic subtest: vecs1
[457.616556] Dynamic subtest vecs1: SUCCESS (0.000s)
[457.626280] Starting dynamic subtest: rcs0
[457.627528] Dynamic subtest rcs0: SUCCESS (0.000s)
[457.637630] Starting dynamic subtest: vcs1
[457.638789] Dynamic subtest vcs1: SUCCESS (0.000s)
[457.639958] Subtest invalid: SUCCESS (0.010s)
[457.690872] [104/133] (575s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[459.439447] Starting subtest: cursor-rapid-movement-256x256
[459.444360] Starting dynamic subtest: pipe-A-HDMI-A-3
[459.849506] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.405s)
[459.882265] Starting dynamic subtest: pipe-D-HDMI-A-3
[460.172879] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.299s)
[460.173786] Subtest cursor-rapid-movement-256x256: SUCCESS (0.733s)
[460.479881] [105/133] (572s left) kms_content_protection (atomic-hdcp14)
[462.064168] Starting subtest: atomic-hdcp14
[462.072415] Subtest atomic-hdcp14: SKIP (0.005s)
[462.237963] [106/133] (570s left) kms_big_fb (yf-tiled-8bpp-rotate-0)
[463.761492] Starting subtest: yf-tiled-8bpp-rotate-0
[463.763360] Subtest yf-tiled-8bpp-rotate-0: SKIP (0.000s)
[463.919580] [107/133] (569s left) kms_big_fb (y-tiled-64bpp-rotate-270)
[465.471559] Starting subtest: y-tiled-64bpp-rotate-270
[465.473460] Subtest y-tiled-64bpp-rotate-270: SKIP (0.000s)
[465.610335] [108/133] (567s left) gem_tiled_partial_pwrite_pread (reads)
[465.720967] Subtest reads: SKIP (0.000s)
[465.797927] [109/133] (567s left) prime_mmap (test_forked_cpu_write)
[465.882640] Starting subtest: test_forked_cpu_write
[465.883518] Starting dynamic subtest: test_forked_cpu_write-smem
[465.891749] Dynamic subtest test_forked_cpu_write-smem: SUCCESS (0.009s)
[465.903279] Starting dynamic subtest: test_forked_cpu_write-lmem0
[465.904229] Dynamic subtest test_forked_cpu_write-lmem0: SUCCESS (0.009s)
[465.905387] Subtest test_forked_cpu_write: SUCCESS (0.020s)
[466.093591] [110/133] (567s left) gem_wait (busy)
[466.185152] Starting subtest: busy
[466.186154] Starting dynamic subtest: all-engines
[466.764187] Dynamic subtest all-engines: SUCCESS (0.578s)
[466.774423] Starting dynamic subtest: rcs0
[467.302978] Dynamic subtest rcs0: SUCCESS (0.538s)
[467.313275] Starting dynamic subtest: bcs0
[467.842163] Dynamic subtest bcs0: SUCCESS (0.538s)
[467.852369] Starting dynamic subtest: vcs0
[468.381068] Dynamic subtest vcs0: SUCCESS (0.538s)
[468.391299] Starting dynamic subtest: vcs1
[468.919992] Dynamic subtest vcs1: SUCCESS (0.538s)
[468.930169] Starting dynamic subtest: vecs0
[469.458930] Dynamic subtest vecs0: SUCCESS (0.538s)
[469.469198] Starting dynamic subtest: vecs1
[469.998038] Dynamic subtest vecs1: SUCCESS (0.538s)
[470.008383] Starting dynamic subtest: ccs0
[470.537038] Dynamic subtest ccs0: SUCCESS (0.538s)
[470.538052] Subtest busy: SUCCESS (4.352s)
[470.851895] [111/133] (562s left) perf_pmu (rc6-suspend)
[470.923061] Starting subtest: rc6-suspend
[496.895193] Subtest rc6-suspend: SUCCESS (10.019s)
[498.582793] [112/133] (535s left) kms_pm_backlight (fade-with-dpms)
[500.131465] Subtest fade-with-dpms: SKIP (0.000s)
[500.189932] [113/133] (534s left) kms_flip (flip-vs-modeset-vs-hang)
[501.731343] Starting subtest: flip-vs-modeset-vs-hang
[501.734396] Starting dynamic subtest: A-HDMI-A3
[553.466960] Dynamic subtest A-HDMI-A3: SUCCESS (51.649s)
[553.478947] Starting dynamic subtest: D-HDMI-A3
[603.458763] Dynamic subtest D-HDMI-A3: SUCCESS (49.987s)
[603.459640] Subtest flip-vs-modeset-vs-hang: SUCCESS (101.642s)
[603.639320] [114/133] (431s left) gem_mmap_offset (open-flood)
[603.719584] Starting subtest: open-flood
[625.203550] Subtest open-flood: SUCCESS (21.484s)
[625.338506] [115/133] (409s left) kms_big_fb (linear-16bpp-rotate-180)
[626.891414] Starting subtest: linear-16bpp-rotate-180
[628.792605] Subtest linear-16bpp-rotate-180: SUCCESS (1.892s)
[628.982816] [116/133] (405s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling)
[630.495239] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling
[630.497019] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SKIP (0.000s)
[630.587918] [117/133] (404s left) kms_joiner (invalid-modeset-big-joiner)
[632.115174] Starting subtest: invalid-modeset-big-joiner
[632.116950] Subtest invalid-modeset-big-joiner: SKIP (0.000s)
[632.204604] [118/133] (402s left) gem_exec_params (invalid-ring2)
[632.298209] Starting subtest: invalid-ring2
[632.299165] Subtest invalid-ring2: SUCCESS (0.000s)
[632.493423] [119/133] (402s left) gem_mmap (short-mmap)
[632.573281] Subtest short-mmap: SKIP (0.000s)
[632.648671] [120/133] (402s left) kms_psr (fbc-psr-cursor-mmap-cpu)
[634.164245] Subtest fbc-psr-cursor-mmap-cpu: SKIP (0.000s)
[634.229853] [121/133] (400s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[634.307406] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[634.426039] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.108s)
[634.560659] [122/133] (400s left) kms_cursor_legacy (short-flip-before-cursor-atomic-transitions-varying-size)
[636.074069] Starting subtest: short-flip-before-cursor-atomic-transitions-varying-size
[637.108480] Subtest short-flip-before-cursor-atomic-transitions-varying-size: SUCCESS (1.034s)
[637.360234] [123/133] (397s left) kms_psr (psr-primary-render)
[638.873465] Subtest psr-primary-render: SKIP (0.000s)
[638.925958] [124/133] (396s left) gem_workarounds (suspend-resume)
[639.026400] Starting subtest: suspend-resume
[657.745233] Subtest suspend-resume: SUCCESS (3.735s)
[662.880634] [125/133] (377s left) kms_psr (fbc-psr-sprite-render)
[664.448659] Subtest fbc-psr-sprite-render: SKIP (0.000s)
[664.515284] [126/133] (375s left) kms_sequence (get-busy)
[666.054061] Starting subtest: get-busy
[666.055019] Starting dynamic subtest: pipe-A-HDMI-A-3
[668.621556] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.540s)
[668.634044] Starting dynamic subtest: pipe-B-HDMI-A-3
[671.032473] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (2.391s)
[671.045186] Starting dynamic subtest: pipe-C-HDMI-A-3
[673.443355] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (2.396s)
[673.455357] Starting dynamic subtest: pipe-D-HDMI-A-3
[675.855291] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.400s)
[675.856079] Subtest get-busy: SUCCESS (9.734s)
[676.043007] [127/133] (364s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-pgflip-blt)
[677.568171] Starting subtest: psr-1p-primscrn-indfb-pgflip-blt
[677.569833] Subtest psr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[677.791990] [128/133] (362s left) perf (non-zero-reason)
[678.200538] Starting subtest: non-zero-reason
[678.201402] Starting dynamic subtest: 0-rcs0
[681.244134] Dynamic subtest 0-rcs0: FAIL (2.754s)
[681.245456] Subtest non-zero-reason: FAIL (2.755s)
[681.319593] [129/133] (359s left) kms_fb_coherency (memset-crc)
[682.835123] Starting subtest: memset-crc
[682.836059] Starting dynamic subtest: mmap-offset-fixed
[683.363914] Dynamic subtest mmap-offset-fixed: SUCCESS (0.527s)
[683.420388] Subtest memset-crc: SUCCESS (0.584s)
[683.606440] [130/133] (357s left) kms_cursor_crc (cursor-sliding-256x256)
[685.351079] Starting subtest: cursor-sliding-256x256
[685.356074] Starting dynamic subtest: pipe-A-HDMI-A-3
[689.637405] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (4.276s)
[689.675487] Starting dynamic subtest: pipe-D-HDMI-A-3
[693.882335] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (4.215s)
[693.883163] Subtest cursor-sliding-256x256: SUCCESS (8.523s)
[694.202464] [131/133] (346s left) kms_vblank (query-forked-hang)
[695.717263] Starting subtest: query-forked-hang
[695.718258] Starting dynamic subtest: pipe-A-HDMI-A-3
[722.484778] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (26.772s)
[722.498669] Starting dynamic subtest: pipe-D-HDMI-A-3
[747.426760] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (24.932s)
[747.427662] Subtest query-forked-hang: SUCCESS (51.710s)
[747.586749] [132/133] (293s left) kms_cursor_crc (cursor-offscreen-512x170)
[749.392484] Starting subtest: cursor-offscreen-512x170
[749.394308] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[749.652129] [133/133] (291s left) kms_plane_multiple (2x-tiling-4)
[751.167280] Starting subtest: 2x-tiling-4
[751.169075] Subtest 2x-tiling-4: SKIP (0.000s)
[751.271057] Closing watchdogs
results: parsing output: 0/ for test: gen9_exec_parse
results: parsing output: 1/ for test: gem_exec_balancer
results: parsing output: 2/ for test: kms_big_fb
results: parsing output: 3/ for test: gem_pwrite
results: parsing output: 4/ for test: kms_ccs
results: parsing output: 5/ for test: kms_pipe_crc_basic
results: parsing output: 6/ for test: gem_mmap_gtt
results: parsing output: 7/ for test: gem_exec_whisper
results: parsing output: 8/ for test: kms_flip
results: parsing output: 9/ for test: kms_big_fb
results: parsing output: 10/ for test: kms_big_fb
results: parsing output: 11/ for test: gem_exec_whisper
results: parsing output: 12/ for test: gem_mmap_wc
results: parsing output: 13/ for test: gem_exec_fence
results: parsing output: 14/ for test: kms_atomic
results: parsing output: 15/ for test: kms_chamelium_color
results: parsing output: 16/ for test: kms_addfb_basic
results: parsing output: 17/ for test: kms_plane
results: parsing output: 18/ for test: gem_eio
results: parsing output: 19/ for test: gem_exec_params
results: parsing output: 20/ for test: i915_query
results: parsing output: 21/ for test: kms_chamelium_edid
results: parsing output: 22/ for test: kms_cursor_legacy
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: gem_create
results: parsing output: 25/ for test: gem_eio
results: parsing output: 26/ for test: perf_pmu
results: parsing output: 27/ for test: gem_exec_fence
results: parsing output: 28/ for test: dmabuf_sync_file
results: parsing output: 29/ for test: syncobj_timeline
results: parsing output: 30/ for test: kms_psr
results: parsing output: 31/ for test: kms_psr
results: parsing output: 32/ for test: gem_exec_reloc
results: parsing output: 33/ for test: kms_ccs
results: parsing output: 34/ for test: kms_plane_scaling
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: gem_exec_schedule
results: parsing output: 37/ for test: kms_flip
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: i915_drm_fdinfo
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: kms_lease
results: parsing output: 42/ for test: sw_sync
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: i915_query
results: parsing output: 45/ for test: kms_cursor_legacy
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: syncobj_timeline
results: parsing output: 48/ for test: kms_setmode
results: parsing output: 49/ for test: kms_flip_scaled_crc
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: syncobj_eventfd
results: parsing output: 52/ for test: kms_big_fb
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_addfb_basic
results: parsing output: 55/ for test: gem_ctx_param
results: parsing output: 56/ for test: kms_prime
results: parsing output: 57/ for test: kms_vblank
results: parsing output: 58/ for test: gem_exec_balancer
results: parsing output: 59/ for test: prime_udl
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: gem_busy
results: parsing output: 62/ for test: kms_psr2_sf
results: parsing output: 63/ for test: gem_userptr_blits
results: parsing output: 64/ for test: kms_flip
results: parsing output: 65/ for test: gem_spin_batch
results: parsing output: 66/ for test: kms_ccs
results: parsing output: 67/ for test: kms_cursor_legacy
results: parsing output: 68/ for test: kms_setmode
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: gem_exec_schedule
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: prime_mmap
results: parsing output: 73/ for test: syncobj_timeline
results: parsing output: 74/ for test: gem_exec_schedule
results: parsing output: 75/ for test: kms_addfb_basic
results: parsing output: 76/ for test: i915_hangman
results: parsing output: 77/ for test: gem_ctx_persistence
results: parsing output: 78/ for test: gem_create
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: kms_plane_scaling
results: parsing output: 81/ for test: kms_prop_blob
results: parsing output: 82/ for test: api_intel_bb
results: parsing output: 83/ for test: kms_psr
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_atomic_interruptible
results: parsing output: 86/ for test: gem_ctx_shared
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_chamelium_hpd
results: parsing output: 89/ for test: gem_render_copy
results: parsing output: 90/ for test: syncobj_wait
results: parsing output: 91/ for test: gem_exec_create
results: parsing output: 92/ for test: core_auth
results: parsing output: 93/ for test: kms_addfb_basic
results: parsing output: 94/ for test: kms_color
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_ccs
results: parsing output: 97/ for test: gem_mmap_gtt
results: parsing output: 98/ for test: kms_flip_scaled_crc
results: parsing output: 99/ for test: i915_pm_rpm
results: parsing output: 100/ for test: gem_pxp
results: parsing output: 101/ for test: prime_busy
results: parsing output: 102/ for test: sysfs_heartbeat_interval
results: parsing output: 103/ for test: kms_cursor_crc
results: parsing output: 104/ for test: kms_content_protection
results: parsing output: 105/ for test: kms_big_fb
results: parsing output: 106/ for test: kms_big_fb
results: parsing output: 107/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 108/ for test: prime_mmap
results: parsing output: 109/ for test: gem_wait
results: parsing output: 110/ for test: perf_pmu
results: parsing output: 111/ for test: kms_pm_backlight
results: parsing output: 112/ for test: kms_flip
results: parsing output: 113/ for test: gem_mmap_offset
results: parsing output: 114/ for test: kms_big_fb
results: parsing output: 115/ for test: kms_flip_scaled_crc
results: parsing output: 116/ for test: kms_joiner
results: parsing output: 117/ for test: gem_exec_params
results: parsing output: 118/ for test: gem_mmap
results: parsing output: 119/ for test: kms_psr
results: parsing output: 120/ for test: syncobj_timeline
results: parsing output: 121/ for test: kms_cursor_legacy
results: parsing output: 122/ for test: kms_psr
results: parsing output: 123/ for test: gem_workarounds
results: parsing output: 124/ for test: kms_psr
results: parsing output: 125/ for test: kms_sequence
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: perf
results: parsing output: 128/ for test: kms_fb_coherency
results: parsing output: 129/ for test: kms_cursor_crc
results: parsing output: 130/ for test: kms_vblank
results: parsing output: 131/ for test: kms_cursor_crc
results: parsing output: 132/ for test: kms_plane_multiple
Done.