[75.096852] Initializing watchdogs
[75.096911]   /dev/watchdog0
[75.113248] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[75.117967] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[75.120867] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[75.124330] [001/155] (960s left) gem_mmap_wc (pf-nonblock)
[75.206570] Subtest pf-nonblock: SKIP (0.000s)
[75.269724] [002/155] (960s left) kms_addfb_basic (addfb25-4-tiled)
[75.371637] Starting subtest: addfb25-4-tiled
[75.373600] Subtest addfb25-4-tiled: SUCCESS (0.000s)
[75.465836] [003/155] (960s left) dumb_buffer (map-invalid-size)
[75.524619] Starting subtest: map-invalid-size
[75.526866] Subtest map-invalid-size: SUCCESS (0.000s)
[75.634320] [004/155] (960s left) kms_fence_pin_leak
[75.816342] [005/155] (959s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling)
[75.909199] Starting subtest: flip-64bpp-linear-to-16bpp-linear-downscaling
[75.911140] Starting dynamic subtest: pipe-A-default-mode
[77.125607] Dynamic subtest pipe-A-default-mode: SKIP (1.213s)
[77.129793] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SKIP (1.214s)
[77.276767] [006/155] (958s left) kms_big_fb (linear-32bpp-rotate-0)
[77.376245] Starting subtest: linear-32bpp-rotate-0
[78.933580] Subtest linear-32bpp-rotate-0: SUCCESS (1.556s)
[79.074203] [007/155] (956s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-blt)
[79.188398] Starting subtest: psr-1p-primscrn-pri-indfb-draw-blt
[86.665053] Subtest psr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.480s)
[86.795653] [008/155] (949s left) gen3_mixed_blits
[86.904477] [009/155] (949s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[87.003400] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[94.501992] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.503s)
[94.622723] [010/155] (941s left) syncobj_wait (multi-wait-submitted-signaled)
[94.693439] Starting subtest: multi-wait-submitted-signaled
[94.695840] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[94.803105] [011/155] (941s left) kms_plane (pixel-format-yf-tiled-modifier-source-clamping)
[94.900191] Starting subtest: pixel-format-yf-tiled-modifier-source-clamping
[94.904845] Subtest pixel-format-yf-tiled-modifier-source-clamping: SKIP (0.000s)
[94.979812] [012/155] (941s left) kms_prop_blob (blob-multiple)
[95.028434] Starting subtest: blob-multiple
[95.030757] Subtest blob-multiple: SUCCESS (0.002s)
[95.140674] [013/155] (940s left) kms_chamelium_hpd (vga-hpd-for-each-pipe)
[95.540454] Subtest vga-hpd-for-each-pipe: SKIP (0.000s)
[96.380374] [014/155] (939s left) kms_pm_backlight (fade)
[96.470496] Starting subtest: fade
[96.518477] Starting dynamic subtest: eDP-1
[99.523723] Dynamic subtest eDP-1: SUCCESS (3.001s)
[99.525994] Subtest fade: SUCCESS (3.052s)
[100.328119] [015/155] (935s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions)
[100.443592] Starting subtest: cursorB-vs-flipA-atomic-transitions
[100.448265] Subtest cursorB-vs-flipA-atomic-transitions: SKIP (0.001s)
[100.584357] [016/155] (935s left) gem_exec_schedule (preempt-other)
[100.649537] Starting subtest: preempt-other
[100.651575] Starting dynamic subtest: rcs0
[100.721020] Dynamic subtest rcs0: SUCCESS (0.072s)
[100.737792] Starting dynamic subtest: bcs0
[100.790537] Dynamic subtest bcs0: SUCCESS (0.070s)
[100.804793] Starting dynamic subtest: vcs0
[100.862786] Dynamic subtest vcs0: SUCCESS (0.071s)
[100.877530] Starting dynamic subtest: vcs1
[100.930675] Dynamic subtest vcs1: SUCCESS (0.067s)
[100.943758] Starting dynamic subtest: vecs0
[100.992892] Dynamic subtest vecs0: SUCCESS (0.063s)
[101.006810] Starting dynamic subtest: ccs0
[101.058348] Dynamic subtest ccs0: SUCCESS (0.065s)
[101.061145] Subtest preempt-other: SUCCESS (0.411s)
[102.389520] [017/155] (933s left) gem_exec_suspend (basic-s0)
[102.446584] Starting subtest: basic-S0
[102.448445] Starting dynamic subtest: smem
[123.785831] Dynamic subtest smem: SUCCESS (7.857s)
[123.788971] Subtest basic-S0: SUCCESS (7.859s)
[128.999728] [018/155] (912s left) kms_atomic_transition (plane-all-transition-nonblocking-fencing)
[129.101996] Starting subtest: plane-all-transition-nonblocking-fencing
[129.104323] Starting dynamic subtest: pipe-A-eDP-1
[131.609812] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.496s)
[131.919215] Starting dynamic subtest: pipe-B-eDP-1
[135.192224] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.272s)
[135.499810] Subtest plane-all-transition-nonblocking-fencing: SUCCESS (6.369s)
[136.323810] [019/155] (905s left) gem_ctx_persistence (smoketest)
[136.386634] Starting subtest: smoketest
[176.809492] Subtest smoketest: SUCCESS (40.394s)
[176.887910] [020/155] (864s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-indfb-draw-blt)
[176.996748] Starting subtest: fbcpsrhdr-1p-offscreen-pri-indfb-draw-blt
[177.000893] Subtest fbcpsrhdr-1p-offscreen-pri-indfb-draw-blt: SKIP (0.000s)
[177.082714] [021/155] (864s left) kms_addfb_basic (unused-pitches)
[177.142480] Starting subtest: unused-pitches
[177.144672] Subtest unused-pitches: SUCCESS (0.000s)
[177.292638] [022/155] (864s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[177.389734] Starting subtest: fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[177.393765] Subtest fbcpsrhdr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[177.489024] [023/155] (864s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted-signaled)
[177.547952] Starting subtest: multi-wait-all-for-submit-available-submitted-signaled
[177.550612] Subtest multi-wait-all-for-submit-available-submitted-signaled: SUCCESS (0.001s)
[177.642058] [024/155] (863s left) kms_psr (pr-primary-mmap-cpu)
[177.726323] Starting subtest: pr-primary-mmap-cpu
[177.730725] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[177.796770] [025/155] (863s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled)
[177.845478] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[177.847357] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[177.939809] [026/155] (863s left) i915_pm_rpm (gem-pread)
[179.965917] Starting subtest: gem-pread
[181.728566] Subtest gem-pread: SUCCESS (1.764s)
[181.830888] [027/155] (859s left) syncobj_wait (wait-for-submit-snapshot)
[181.889968] Starting subtest: wait-for-submit-snapshot
[181.972450] Subtest wait-for-submit-snapshot: SUCCESS (0.081s)
[182.047376] [028/155] (859s left) gem_mmap_gtt (basic-small-copy)
[182.104865] Subtest basic-small-copy: SKIP (0.000s)
[182.163386] [029/155] (859s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-pri-indfb-draw-blt)
[182.270072] Starting subtest: fbchdr-1p-primscrn-pri-indfb-draw-blt
[182.274344] Subtest fbchdr-1p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[182.368655] [030/155] (859s left) gem_userptr_blits (dmabuf-unsync)
[182.431375] Subtest dmabuf-unsync: SKIP (0.000s)
[182.564047] [031/155] (859s left) kms_async_flips (test-cursor)
[182.651971] Starting subtest: test-cursor
[183.025682] Starting dynamic subtest: pipe-A-eDP-1
[183.793720] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.767s)
[184.178261] Starting dynamic subtest: pipe-B-eDP-1
[184.935215] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.765s)
[185.310283] Starting dynamic subtest: pipe-C-eDP-1
[186.070272] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.768s)
[186.434450] Starting dynamic subtest: pipe-D-eDP-1
[187.204238] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.777s)
[187.206562] Subtest test-cursor: SUCCESS (4.555s)
[188.375153] [032/155] (853s left) gem_mmap_offset (oob-read)
[188.430566] Starting subtest: oob-read
[188.432770] Subtest oob-read: SUCCESS (0.000s)
[188.537237] [033/155] (853s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-cur-indfb-onoff)
[188.650006] Starting subtest: fbchdr-2p-scndscrn-cur-indfb-onoff
[188.654135] Subtest fbchdr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[188.747891] [034/155] (853s left) kms_addfb_basic (unused-modifier)
[188.816237] Starting subtest: unused-modifier
[188.818384] Subtest unused-modifier: SUCCESS (0.000s)
[188.978325] [035/155] (852s left) gem_exec_schedule (smoketest-all)
[189.049098] Starting subtest: smoketest-all
[221.420722] Subtest smoketest-all: SUCCESS (32.315s)
[222.876279] [036/155] (819s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[222.976731] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[222.980722] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[223.071626] [037/155] (818s left) syncobj_basic (bad-flags-handle-to-fd)
[223.123450] Starting subtest: bad-flags-handle-to-fd
[223.125763] Subtest bad-flags-handle-to-fd: SUCCESS (0.000s)
[223.240786] [038/155] (818s left) kms_frontbuffer_tracking (hdr-rgb565-draw-render)
[223.333171] Starting subtest: hdr-rgb565-draw-render
[223.337255] Subtest hdr-rgb565-draw-render: SKIP (0.000s)
[223.442529] [039/155] (818s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[223.528203] Starting subtest: nonblocking-crc-frame-sequence
[223.530424] Starting dynamic subtest: pipe-A-eDP-1
[224.277761] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.749s)
[224.289813] Starting dynamic subtest: pipe-B-eDP-1
[225.720592] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.443s)
[225.731244] Starting dynamic subtest: pipe-C-eDP-1
[227.086048] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.362s)
[227.096524] Starting dynamic subtest: pipe-D-eDP-1
[228.431925] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.345s)
[228.434206] Subtest nonblocking-crc-frame-sequence: SUCCESS (4.904s)
[229.318617] [040/155] (812s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-spr-indfb-draw-blt)
[229.427901] Starting subtest: fbcpsrhdr-1p-primscrn-spr-indfb-draw-blt
[229.432341] Subtest fbcpsrhdr-1p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[229.512266] [041/155] (812s left) gem_exec_reloc (basic-write-cpu-active)
[229.572491] Subtest basic-write-cpu-active: SKIP (0.000s)
[229.634021] [042/155] (812s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[229.729021] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[229.733244] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[229.837448] [043/155] (812s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-pri-indfb-draw-pwrite)
[229.930869] Starting subtest: fbcpsrhdr-2p-primscrn-pri-indfb-draw-pwrite
[229.934865] Subtest fbcpsrhdr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[230.052219] [044/155] (812s left) prime_busy (before-wait)
[230.124354] Starting subtest: before-wait
[230.126646] Starting dynamic subtest: rcs0
[230.155744] Dynamic subtest rcs0: SUCCESS (0.031s)
[230.166943] Starting dynamic subtest: bcs0
[230.202823] Dynamic subtest bcs0: SUCCESS (0.046s)
[230.213325] Starting dynamic subtest: vcs0
[230.244234] Dynamic subtest vcs0: SUCCESS (0.041s)
[230.253673] Starting dynamic subtest: vcs1
[230.286709] Dynamic subtest vcs1: SUCCESS (0.042s)
[230.296106] Starting dynamic subtest: vecs0
[230.328855] Dynamic subtest vecs0: SUCCESS (0.041s)
[230.338086] Starting dynamic subtest: ccs0
[230.370463] Dynamic subtest ccs0: SUCCESS (0.041s)
[230.479720] Subtest before-wait: SUCCESS (0.356s)
[230.557076] [045/155] (811s left) syncobj_timeline (wait-all-for-submit-delayed-submit)
[230.621796] Starting subtest: wait-all-for-submit-delayed-submit
[230.724029] Subtest wait-all-for-submit-delayed-submit: SUCCESS (0.103s)
[230.800181] [046/155] (811s left) kms_ccs (crc-sprite-planes-basic-yf-tiled-ccs)
[230.892410] Starting subtest: crc-sprite-planes-basic-yf-tiled-ccs
[230.894569] Starting dynamic subtest: pipe-A-eDP-1
[230.952627] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[230.963791] Starting dynamic subtest: pipe-B-eDP-1
[231.022108] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[231.033305] Starting dynamic subtest: pipe-C-eDP-1
[231.090474] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[231.100756] Starting dynamic subtest: pipe-D-eDP-1
[231.158382] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[231.162428] Subtest crc-sprite-planes-basic-yf-tiled-ccs: SKIP (0.009s)
[233.184608] [047/155] (809s left) kms_flip (flip-vs-rmfb-interruptible)
[233.284110] Starting subtest: flip-vs-rmfb-interruptible
[233.286374] Starting dynamic subtest: A-eDP1
[241.975214] Dynamic subtest A-eDP1: SUCCESS (8.693s)
[241.987049] Starting dynamic subtest: B-eDP1
[250.611238] Dynamic subtest B-eDP1: SUCCESS (8.635s)
[250.623093] Starting dynamic subtest: C-eDP1
[259.232026] Dynamic subtest C-eDP1: SUCCESS (8.619s)
[259.244630] Starting dynamic subtest: D-eDP1
[267.860860] Dynamic subtest D-eDP1: SUCCESS (8.625s)
[267.865101] Subtest flip-vs-rmfb-interruptible: SUCCESS (34.583s)
[269.041979] [048/155] (773s left) kms_psr (psr2-primary-render)
[269.128040] Starting subtest: psr2-primary-render
[269.130302] Starting dynamic subtest: eDP-1
[270.838232] Dynamic subtest eDP-1: SUCCESS (1.709s)
[270.840574] Subtest psr2-primary-render: SUCCESS (1.710s)
[271.712416] [049/155] (770s left) kms_frontbuffer_tracking (hdr-2p-primscrn-shrfb-pgflip-blt)
[271.817995] Starting subtest: hdr-2p-primscrn-shrfb-pgflip-blt
[271.822224] Subtest hdr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[271.910626] [050/155] (770s left) kms_frontbuffer_tracking (fbchdr-suspend)
[272.017204] Starting subtest: fbchdr-suspend
[272.021457] Subtest fbchdr-suspend: SKIP (0.000s)
[272.124874] [051/155] (770s left) gem_exec_schedule (u-fairslice)
[272.192521] Starting subtest: u-fairslice
[272.194677] Starting dynamic subtest: rcs0
[274.208418] Dynamic subtest rcs0: SUCCESS (2.023s)
[274.217219] Starting dynamic subtest: bcs0
[276.233901] Dynamic subtest bcs0: SUCCESS (2.022s)
[276.246380] Starting dynamic subtest: vcs0
[278.253997] Dynamic subtest vcs0: SUCCESS (2.019s)
[278.265054] Starting dynamic subtest: vcs1
[280.271521] Dynamic subtest vcs1: SUCCESS (2.017s)
[280.283834] Starting dynamic subtest: vecs0
[282.299569] Dynamic subtest vecs0: SUCCESS (2.023s)
[282.311863] Starting dynamic subtest: ccs0
[284.317604] Dynamic subtest ccs0: SUCCESS (2.019s)
[284.319833] Subtest u-fairslice: SUCCESS (12.129s)
[284.612679] [052/155] (758s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[284.710608] Starting subtest: fbchdr-2p-primscrn-pri-indfb-draw-mmap-cpu
[284.714635] Subtest fbchdr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[284.803871] [053/155] (757s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[284.902839] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip
[284.907162] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[284.995537] [054/155] (757s left) kms_chamelium_edid (dp-edid-stress-resolution-non-4k)
[285.371803] Subtest dp-edid-stress-resolution-non-4k: SKIP (0.000s)
[286.225770] [055/155] (756s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-blt)
[286.336225] Starting subtest: psr-2p-primscrn-spr-indfb-draw-blt
[286.340337] Subtest psr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[286.445540] [056/155] (756s left) gem_ctx_param (set-priority-not-supported)
[286.508437] Starting subtest: set-priority-not-supported
[286.512904] Subtest set-priority-not-supported: SKIP (0.000s)
[286.586222] [057/155] (756s left) kms_joiner (invalid-modeset-big-joiner)
[286.685979] Starting subtest: invalid-modeset-big-joiner
[286.690239] Subtest invalid-modeset-big-joiner: SKIP (0.000s)
[286.752754] [058/155] (756s left) perf_pmu (busy)
[286.794119] Starting subtest: busy
[286.796039] Starting dynamic subtest: rcs0
[287.381265] Dynamic subtest rcs0: SUCCESS (0.588s)
[287.393856] Starting dynamic subtest: bcs0
[287.947059] Dynamic subtest bcs0: SUCCESS (0.563s)
[287.959845] Starting dynamic subtest: vcs0
[289.801101] Dynamic subtest vcs0: SUCCESS (1.850s)
[289.813233] Starting dynamic subtest: vcs1
[291.784713] Dynamic subtest vcs1: SUCCESS (1.981s)
[291.795461] Starting dynamic subtest: vecs0
[293.832552] Dynamic subtest vecs0: SUCCESS (2.045s)
[293.845182] Starting dynamic subtest: ccs0
[294.404589] Dynamic subtest ccs0: SUCCESS (0.570s)
[294.407066] Subtest busy: SUCCESS (7.612s)
[294.521038] [059/155] (748s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-mc-ccs)
[294.621912] Starting subtest: ccs-on-another-bo-y-tiled-gen12-mc-ccs
[294.624025] Starting dynamic subtest: pipe-A-eDP-1
[294.645999] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[294.657114] Starting dynamic subtest: pipe-B-eDP-1
[294.678739] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[294.688668] Starting dynamic subtest: pipe-C-eDP-1
[294.710482] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[294.720036] Starting dynamic subtest: pipe-D-eDP-1
[294.742095] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[294.746089] Subtest ccs-on-another-bo-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[296.894093] [060/155] (746s left) kms_cursor_crc (cursor-onscreen-32x32)
[297.037473] Starting subtest: cursor-onscreen-32x32
[297.087138] Subtest cursor-onscreen-32x32: SKIP (0.043s)
[297.371436] [061/155] (745s left) gem_lmem_swapping (parallel-multi)
[297.413528] Subtest parallel-multi: SKIP (0.000s)
[297.466832] [062/155] (745s left) gem_exec_balancer (parallel-bb-first)
[297.726092] Starting subtest: parallel-bb-first
[298.701413] Subtest parallel-bb-first: SUCCESS (0.975s)
[299.839113] [063/155] (743s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[299.942636] Starting subtest: hdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[299.946667] Subtest hdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[300.046393] [064/155] (743s left) syncobj_timeline (signal-point-0)
[300.097733] Starting subtest: signal-point-0
[300.099944] Subtest signal-point-0: SUCCESS (0.000s)
[300.198865] [065/155] (742s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc)
[300.296911] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc
[303.915186] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (3.623s)
[305.102725] [066/155] (738s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-wc)
[305.204132] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-wc
[305.208652] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[305.311170] [067/155] (737s left) kms_lease (lease-get)
[305.407140] Starting subtest: lease-get
[305.409426] Starting dynamic subtest: pipe-A-eDP-1
[305.411558] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[305.422375] Starting dynamic subtest: pipe-B-eDP-1
[305.424620] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[305.434521] Starting dynamic subtest: pipe-C-eDP-1
[305.436754] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[305.446582] Starting dynamic subtest: pipe-D-eDP-1
[305.448799] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[305.450996] Subtest lease-get: SUCCESS (0.009s)
[305.539925] [068/155] (737s left) kms_addfb_basic (small-bo)
[305.640404] Starting subtest: small-bo
[305.642598] Subtest small-bo: SUCCESS (0.000s)
[305.761399] [069/155] (737s left) kms_big_fb (y-tiled-64bpp-rotate-90)
[305.864907] Starting subtest: y-tiled-64bpp-rotate-90
[305.869349] Subtest y-tiled-64bpp-rotate-90: SKIP (0.000s)
[305.952637] [070/155] (737s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-pwrite)
[306.043467] Starting subtest: fbcpsr-rgb101010-draw-pwrite
[311.153715] Subtest fbcpsr-rgb101010-draw-pwrite: SUCCESS (5.112s)
[311.292418] [071/155] (732s left) gem_mmap_gtt (fault-concurrent)
[311.344834] Subtest fault-concurrent: SKIP (0.000s)
[311.399792] [072/155] (732s left) kms_content_protection (legacy-hdcp14)
[311.534684] Starting subtest: legacy-hdcp14
[311.539429] Subtest legacy-hdcp14: SKIP (0.000s)
[311.661979] [073/155] (731s left) gem_workarounds (suspend-resume-context)
[311.724498] Starting subtest: suspend-resume-context
[328.170043] Subtest suspend-resume-context: SUCCESS (1.556s)
[338.319275] [074/155] (715s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-render)
[338.434923] Starting subtest: psr-2p-primscrn-cur-indfb-draw-render
[338.439368] Subtest psr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[338.537414] [075/155] (715s left) gem_softpin (noreloc-interruptible)
[338.596943] Starting subtest: noreloc-interruptible
[344.032329] Subtest noreloc-interruptible: SUCCESS (5.408s)
[344.143571] [076/155] (709s left) kms_color (ctm-0-75)
[344.243995] Starting subtest: ctm-0-75
[344.246336] Starting dynamic subtest: pipe-A-eDP-1
[349.242950] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.988s)
[349.254092] Starting dynamic subtest: pipe-B-eDP-1
[354.997035] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.742s)
[355.010221] Starting dynamic subtest: pipe-C-eDP-1
[360.380233] Dynamic subtest pipe-C-eDP-1: SUCCESS (5.377s)
[360.392205] Starting dynamic subtest: pipe-D-eDP-1
[365.732058] Dynamic subtest pipe-D-eDP-1: SUCCESS (5.345s)
[365.734425] Subtest ctm-0-75: SUCCESS (21.457s)
[366.560784] [077/155] (687s left) kms_plane_lowres (tiling-yf)
[366.663839] Starting subtest: tiling-yf
[366.668107] Subtest tiling-yf: SKIP (0.000s)
[366.738055] [078/155] (686s left) kms_flip (plain-flip-fb-recreate)
[366.824203] Starting subtest: plain-flip-fb-recreate
[366.826735] Starting dynamic subtest: A-eDP1
[375.676126] Dynamic subtest A-eDP1: SUCCESS (8.851s)
[375.687425] Starting dynamic subtest: B-eDP1
[384.533025] Dynamic subtest B-eDP1: SUCCESS (8.857s)
[384.542966] Starting dynamic subtest: C-eDP1
[393.443120] Dynamic subtest C-eDP1: SUCCESS (8.907s)
[393.453168] Starting dynamic subtest: D-eDP1
[402.281531] Dynamic subtest D-eDP1: SUCCESS (8.835s)
[402.287532] Subtest plain-flip-fb-recreate: SUCCESS (35.459s)
[403.462357] [079/155] (650s left) kms_frontbuffer_tracking (hdr-1p-offscreen-pri-shrfb-draw-pwrite)
[403.557938] Starting subtest: hdr-1p-offscreen-pri-shrfb-draw-pwrite
[403.563044] Subtest hdr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[403.643073] [080/155] (650s left) kms_frontbuffer_tracking (hdr-1p-primscrn-pri-indfb-draw-render)
[403.748957] Starting subtest: hdr-1p-primscrn-pri-indfb-draw-render
[403.753629] Subtest hdr-1p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[403.832881] [081/155] (650s left) kms_psr (fbc-pr-primary-blt)
[403.921889] Starting subtest: fbc-pr-primary-blt
[403.927058] Subtest fbc-pr-primary-blt: SKIP (0.000s)
[403.994603] [082/155] (649s left) kms_cursor_edge_walk (256x256-top-bottom)
[404.088796] Starting subtest: 256x256-top-bottom
[404.091127] Starting dynamic subtest: pipe-A-eDP-1
[407.532208] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.442s)
[407.542917] Starting dynamic subtest: pipe-D-eDP-1
[410.756147] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.219s)
[410.759039] Subtest 256x256-top-bottom: SUCCESS (6.664s)
[411.567519] [083/155] (642s left) gem_mmap (short-mmap)
[411.627985] Subtest short-mmap: SKIP (0.000s)
[411.686101] [084/155] (642s left) gem_ctx_isolation (nonpriv-switch)
[411.744186] Starting subtest: nonpriv-switch
[411.747168] Starting dynamic subtest: rcs0
[412.024381] Dynamic subtest rcs0: SUCCESS (0.279s)
[412.036240] Starting dynamic subtest: bcs0
[412.326223] Dynamic subtest bcs0: SUCCESS (0.300s)
[412.336739] Starting dynamic subtest: vcs0
[412.604817] Dynamic subtest vcs0: SUCCESS (0.279s)
[412.616570] Starting dynamic subtest: vcs1
[413.933526] Dynamic subtest vcs1: SUCCESS (1.326s)
[413.944134] Starting dynamic subtest: vecs0
[416.029921] Dynamic subtest vecs0: SUCCESS (2.095s)
[416.042227] Starting dynamic subtest: ccs0
[418.085074] Dynamic subtest ccs0: SUCCESS (2.054s)
[418.087893] Subtest nonpriv-switch: SUCCESS (6.339s)
[418.313224] [085/155] (635s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[418.420887] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip
[419.398006] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip: SUCCESS (0.978s)
[419.510351] [086/155] (634s left) kms_frontbuffer_tracking (fbc-indfb-scaledprimary)
[419.610808] Starting subtest: fbc-indfb-scaledprimary
[422.413022] Subtest fbc-indfb-scaledprimary: SUCCESS (2.808s)
[423.583055] [087/155] (630s left) kms_cursor_legacy (cursora-vs-flipa-atomic)
[423.709504] Starting subtest: cursorA-vs-flipA-atomic
[434.848952] Subtest cursorA-vs-flipA-atomic: SUCCESS (11.135s)
[435.728329] [088/155] (618s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[435.836762] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[435.841801] Subtest fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[435.927826] [089/155] (618s left) kms_ccs (bad-pixel-format-yf-tiled-ccs)
[436.020731] Starting subtest: bad-pixel-format-yf-tiled-ccs
[436.023642] Starting dynamic subtest: pipe-A-eDP-1
[436.053688] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[436.066977] Starting dynamic subtest: pipe-B-eDP-1
[436.092995] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[436.102983] Starting dynamic subtest: pipe-C-eDP-1
[436.128679] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[436.138538] Starting dynamic subtest: pipe-D-eDP-1
[436.163527] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[436.168146] Subtest bad-pixel-format-yf-tiled-ccs: SKIP (0.005s)
[438.274852] [090/155] (615s left) template (b)
[438.328597] Starting subtest: B
[438.330890] Subtest B: SUCCESS (0.000s)
[438.422625] [091/155] (615s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-onoff)
[438.521779] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-onoff
[438.526994] Subtest fbcpsr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[438.616682] [092/155] (615s left) kms_pm_dc (dc5-dpms-negative)
[439.709088] Starting subtest: dc5-dpms-negative
[439.714351] Subtest dc5-dpms-negative: SKIP (0.000s)
[439.782100] [093/155] (614s left) core_auth (getclient-master-drop)
[439.816650] Starting subtest: getclient-master-drop
[439.834244] Subtest getclient-master-drop: SUCCESS (0.015s)
[439.927879] [094/155] (614s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-cur-indfb-draw-pwrite)
[440.025952] Starting subtest: psrhdr-2p-primscrn-cur-indfb-draw-pwrite
[440.031019] Subtest psrhdr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[440.115595] [095/155] (614s left) perf_pmu (gt-awake)
[440.159265] Starting subtest: gt-awake
[448.689727] Subtest gt-awake: SUCCESS (8.533s)
[448.783000] [096/155] (605s left) kms_busy (extended-modeset-hang-newfb)
[448.885804] Starting subtest: extended-modeset-hang-newfb
[448.888450] Starting dynamic subtest: pipe-A
[483.661474] Dynamic subtest pipe-A: SUCCESS (34.774s)
[483.672370] Starting dynamic subtest: pipe-D
[506.630052] Dynamic subtest pipe-D: SUCCESS (22.961s)
[506.632828] Subtest extended-modeset-hang-newfb: SUCCESS (57.741s)
[507.522876] [097/155] (547s left) kms_big_fb (4-tiled-64bpp-rotate-0)
[507.621136] Starting subtest: 4-tiled-64bpp-rotate-0
[509.235892] Subtest 4-tiled-64bpp-rotate-0: SUCCESS (1.615s)
[509.399876] [098/155] (545s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen)
[509.499985] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen
[509.504516] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[509.584532] [099/155] (545s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[509.689416] Starting subtest: fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-gtt
[509.693981] Subtest fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[509.781590] [100/155] (544s left) tools_test (tools_test)
[509.833848] Starting subtest: tools_test
[509.888918] Subtest tools_test: SUCCESS (0.068s)
[509.951204] [101/155] (544s left) kms_frontbuffer_tracking (psrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[510.046943] Starting subtest: psrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[510.050844] Subtest psrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[510.144650] [102/155] (544s left) kms_cursor_crc (cursor-random-32x32)
[510.303787] Starting subtest: cursor-random-32x32
[510.350961] Subtest cursor-random-32x32: SKIP (0.042s)
[510.637605] [103/155] (544s left) kms_big_fb (x-tiled-16bpp-rotate-180)
[510.740012] Starting subtest: x-tiled-16bpp-rotate-180
[512.030941] Subtest x-tiled-16bpp-rotate-180: SUCCESS (1.290s)
[512.168100] [104/155] (542s left) gem_exec_fence (syncobj-stationary-timeline-chain-engines)
[512.747691] Starting subtest: syncobj-stationary-timeline-chain-engines
[512.850982] Subtest syncobj-stationary-timeline-chain-engines: SUCCESS (0.103s)
[513.793976] [FACT gem_exec_fence (syncobj-stationary-timeline-chain-engines)] new: kernel.kmod_is_loaded.vgem: true
[513.798188] [105/155] (541s left) gem_busy (busy)
[513.865395] Starting subtest: busy
[513.867979] Starting dynamic subtest: all-engines
[513.928260] Dynamic subtest all-engines: SUCCESS (0.062s)
[513.939878] Starting dynamic subtest: rcs0
[515.705359] Dynamic subtest rcs0: SUCCESS (1.775s)
[515.716807] Starting dynamic subtest: bcs0
[515.762097] Dynamic subtest bcs0: SUCCESS (0.054s)
[515.773903] Starting dynamic subtest: vcs0
[515.802103] Dynamic subtest vcs0: SUCCESS (0.040s)
[515.812211] Starting dynamic subtest: vcs1
[517.685382] Dynamic subtest vcs1: SUCCESS (1.880s)
[517.699434] Starting dynamic subtest: vecs0
[519.734016] Dynamic subtest vecs0: SUCCESS (2.046s)
[519.745045] Starting dynamic subtest: ccs0
[521.716766] Dynamic subtest ccs0: SUCCESS (1.982s)
[521.719275] Subtest busy: SUCCESS (7.848s)
[522.071265] [106/155] (532s left) gem_exec_reloc (basic-cpu)
[522.130974] Subtest basic-cpu: SKIP (0.000s)
[522.198567] [107/155] (532s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[522.262196] Starting subtest: etime-multi-wait-all-submitted-signaled
[522.363151] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.102s)
[522.445848] [108/155] (532s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[522.552606] Starting subtest: psrhdr-2p-primscrn-pri-shrfb-draw-mmap-wc
[522.558072] Subtest psrhdr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[522.647075] [109/155] (532s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-downscaling)
[522.740039] Starting subtest: flip-32bpp-linear-to-64bpp-linear-downscaling
[522.742549] Starting dynamic subtest: pipe-A-default-mode
[523.885336] Dynamic subtest pipe-A-default-mode: SKIP (1.144s)
[523.890805] Subtest flip-32bpp-linear-to-64bpp-linear-downscaling: SKIP (1.145s)
[524.047299] [110/155] (531s left) i915_drm_fdinfo (idle)
[524.086150] Starting subtest: idle
[524.089078] Starting dynamic subtest: rcs0
[524.643681] Dynamic subtest rcs0: SUCCESS (0.557s)
[524.657232] Starting dynamic subtest: bcs0
[525.151538] Dynamic subtest bcs0: SUCCESS (0.503s)
[525.164773] Starting dynamic subtest: vcs0
[525.658884] Dynamic subtest vcs0: SUCCESS (0.504s)
[525.670148] Starting dynamic subtest: vcs1
[526.169237] Dynamic subtest vcs1: SUCCESS (0.504s)
[526.181766] Starting dynamic subtest: vecs0
[526.672085] Dynamic subtest vecs0: SUCCESS (0.504s)
[526.686155] Starting dynamic subtest: ccs0
[527.178143] Dynamic subtest ccs0: SUCCESS (0.503s)
[527.181188] Subtest idle: SUCCESS (3.092s)
[527.256032] [111/155] (527s left) kms_frontbuffer_tracking (hdr-2p-primscrn-cur-indfb-draw-pwrite)
[527.357769] Starting subtest: hdr-2p-primscrn-cur-indfb-draw-pwrite
[527.362751] Subtest hdr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[527.449085] [112/155] (527s left) kms_rotation_crc (primary-rotation-90)
[527.547947] Starting subtest: primary-rotation-90
[527.553206] Subtest primary-rotation-90: SKIP (0.001s)
[527.623805] [113/155] (527s left) gem_spin_batch (legacy)
[527.687188] Starting subtest: legacy
[527.689994] Starting dynamic subtest: default
[530.923533] Dynamic subtest default: SUCCESS (3.233s)
[530.936866] Starting dynamic subtest: render
[534.158688] Dynamic subtest render: SUCCESS (3.231s)
[534.170565] Starting dynamic subtest: bsd
[537.396548] Dynamic subtest bsd: SUCCESS (3.233s)
[537.407975] Starting dynamic subtest: bsd1
[540.631996] Dynamic subtest bsd1: SUCCESS (3.233s)
[540.643243] Starting dynamic subtest: bsd2
[543.866043] Dynamic subtest bsd2: SUCCESS (3.229s)
[543.882288] Starting dynamic subtest: blt
[547.105386] Dynamic subtest blt: SUCCESS (3.235s)
[547.118797] Starting dynamic subtest: vebox
[550.342835] Dynamic subtest vebox: SUCCESS (3.234s)
[550.345191] Subtest legacy: SUCCESS (22.650s)
[550.694917] [114/155] (504s left) syncobj_wait (wait-any-snapshot)
[550.746952] Starting subtest: wait-any-snapshot
[550.828743] Subtest wait-any-snapshot: SUCCESS (0.083s)
[550.911218] [115/155] (504s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-indfb-msflip-blt)
[551.011363] Starting subtest: psrhdr-1p-primscrn-indfb-msflip-blt
[551.016427] Subtest psrhdr-1p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[551.096623] [116/155] (504s left) api_intel_allocator (fork-simple-once)
[551.150206] Starting subtest: fork-simple-once
[551.164507] Subtest fork-simple-once: SUCCESS (0.017s)
[551.272332] [117/155] (504s left) gem_eio (unwedge-stress)
[551.469656] Starting subtest: unwedge-stress
[551.472011] Starting dynamic subtest: render
[555.470362] Dynamic subtest render: SUCCESS (3.999s)
[555.488249] Starting dynamic subtest: bsd1
[573.131200] Dynamic subtest bsd1: SUCCESS (17.660s)
[573.146552] Starting dynamic subtest: bsd2
[591.149120] Dynamic subtest bsd2: SUCCESS (18.020s)
[591.164567] Starting dynamic subtest: blt
[591.169082] Dynamic subtest blt: SKIP (0.000s)
[591.179827] Starting dynamic subtest: vebox
[609.110570] Dynamic subtest vebox: SUCCESS (17.960s)
[609.113064] Subtest unwedge-stress: SUCCESS (57.645s)
[610.717411] [118/155] (444s left) kms_tv_load_detect (load-detect)
[610.780751] Subtest load-detect: SKIP (0.000s)
[610.839376] [119/155] (444s left) gem_exec_reloc (basic-cpu-active)
[610.893677] Subtest basic-cpu-active: SKIP (0.000s)
[610.975628] [120/155] (444s left) kms_frontbuffer_tracking (fbc-rgb565-draw-pwrite)
[611.081838] Starting subtest: fbc-rgb565-draw-pwrite
[615.741458] Subtest fbc-rgb565-draw-pwrite: SUCCESS (4.666s)
[616.961033] [121/155] (438s left) sw_sync (alloc_timeline)
[616.997696] Starting subtest: alloc_timeline
[617.000382] Subtest alloc_timeline: SUCCESS (0.000s)
[617.058648] [122/155] (438s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[617.151232] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[617.153684] Starting dynamic subtest: pipe-A-eDP-1
[617.163594] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[617.177186] Starting dynamic subtest: pipe-B-eDP-1
[617.187502] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[617.198019] Starting dynamic subtest: pipe-C-eDP-1
[617.208158] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[617.218643] Starting dynamic subtest: pipe-D-eDP-1
[617.228965] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[617.233992] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[619.422967] [123/155] (436s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-wc)
[619.521739] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-wc
[619.526407] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[619.605321] [124/155] (436s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-indfb-pgflip-blt)
[619.703020] Starting subtest: psrhdr-2p-scndscrn-indfb-pgflip-blt
[619.707997] Subtest psrhdr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[619.796051] [125/155] (435s left) gem_mmap_gtt (cpuset-big-copy)
[619.849022] Subtest cpuset-big-copy: SKIP (0.000s)
[619.910735] [126/155] (435s left) i915_drm_fdinfo (virtual-idle)
[619.955840] Starting subtest: virtual-idle
[623.018990] Subtest virtual-idle: SUCCESS (3.064s)
[623.097803] [127/155] (432s left) kms_vblank (invalid)
[623.198351] Starting subtest: invalid
[623.200663] Starting dynamic subtest: pipe-A-eDP-1
[623.606037] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.408s)
[623.609030] Subtest invalid: SUCCESS (0.410s)
[624.458343] [128/155] (431s left) kms_psr (fbc-psr-sprite-mmap-cpu)
[624.544362] Starting subtest: fbc-psr-sprite-mmap-cpu
[624.547122] Starting dynamic subtest: eDP-1
[624.552208] Dynamic subtest eDP-1: SKIP (0.000s)
[624.557240] Subtest fbc-psr-sprite-mmap-cpu: SKIP (0.001s)
[624.619640] [129/155] (431s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu)
[624.722175] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu
[628.788482] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (4.074s)
[629.958754] [130/155] (426s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-pixel-formats)
[630.057036] Starting subtest: plane-scaler-with-clipping-clamping-pixel-formats
[630.059845] Starting dynamic subtest: pipe-A
[630.169832] Dynamic subtest pipe-A: SKIP (0.109s)
[630.180527] Starting dynamic subtest: pipe-B
[631.330820] Dynamic subtest pipe-B: SKIP (1.160s)
[631.341875] Starting dynamic subtest: pipe-C
[632.562929] Dynamic subtest pipe-C: SUCCESS (1.237s)
[632.573725] Starting dynamic subtest: pipe-D
[633.796105] Dynamic subtest pipe-D: SUCCESS (1.232s)
[633.798771] Subtest plane-scaler-with-clipping-clamping-pixel-formats: SUCCESS (3.742s)
[634.991566] [131/155] (421s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-fullscreen)
[635.097985] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-fullscreen
[641.840976] Subtest fbcpsr-1p-primscrn-spr-indfb-fullscreen: SUCCESS (6.748s)
[641.955747] [132/155] (414s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-pri-indfb-draw-mmap-wc)
[642.064228] Starting subtest: fbchdr-1p-primscrn-pri-indfb-draw-mmap-wc
[642.069441] Subtest fbchdr-1p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[642.151885] [133/155] (413s left) gen9_exec_parse (bb-secure)
[642.210724] Subtest bb-secure: SKIP (0.000s)
[642.289998] [134/155] (413s left) kms_cursor_legacy (2x-flip-vs-cursor-legacy)
[642.404349] Starting subtest: 2x-flip-vs-cursor-legacy
[642.409372] Subtest 2x-flip-vs-cursor-legacy: SKIP (0.001s)
[642.552495] [135/155] (413s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[642.660618] Starting subtest: fbchdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[642.665343] Subtest fbchdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[642.766283] [136/155] (413s left) gem_render_copy (y-tiled-ccs-to-y-tiled-ccs)
[642.833567] Starting subtest: y-tiled-ccs-to-y-tiled-ccs
[642.838576] Subtest y-tiled-ccs-to-y-tiled-ccs: SKIP (0.000s)
[643.047349] [137/155] (413s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled-ccs)
[643.095133] Starting subtest: yf-tiled-ccs-to-yf-tiled-ccs
[643.100688] Subtest yf-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[643.279518] [138/155] (413s left) kms_hdr (bpc-switch)
[643.373584] Starting subtest: bpc-switch
[643.376914] Starting dynamic subtest: pipe-A-eDP-1-XRGB2101010
[647.975718] Dynamic subtest pipe-A-eDP-1-XRGB2101010: SUCCESS (4.602s)
[647.987870] Starting dynamic subtest: pipe-A-eDP-1-XRGB16161616F
[652.434180] Dynamic subtest pipe-A-eDP-1-XRGB16161616F: SUCCESS (4.457s)
[652.437047] Subtest bpc-switch: SUCCESS (9.062s)
[652.536783] [139/155] (403s left) gem_create (create-ext-placement-all)
[652.706506] Starting subtest: create-ext-placement-all
[652.709370] Subtest create-ext-placement-all: SUCCESS (0.000s)
[652.800508] [140/155] (403s left) kms_dirtyfb (drrs-dirtyfb-ioctl)
[652.893849] Starting subtest: drrs-dirtyfb-ioctl
[652.908808] Subtest drrs-dirtyfb-ioctl: SKIP (0.001s)
[652.986216] [141/155] (403s left) kms_vblank (ts-continuation-modeset-rpm)
[653.071142] Starting subtest: ts-continuation-modeset-rpm
[653.073624] Starting dynamic subtest: pipe-A-eDP-1
[655.584070] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.512s)
[655.602910] Starting dynamic subtest: pipe-D-eDP-1
[657.844500] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.258s)
[657.847245] Subtest ts-continuation-modeset-rpm: SUCCESS (4.774s)
[658.734238] [142/155] (397s left) gem_exec_reloc (basic-active)
[658.790748] Subtest basic-active: SKIP (0.000s)
[658.860651] [143/155] (397s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy)
[658.984201] Starting subtest: 2x-cursor-vs-flip-legacy
[658.989644] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.001s)
[659.129992] [144/155] (397s left) i915_pm_rps (thresholds-park)
[659.186192] Starting subtest: thresholds-park
[659.191029] Subtest thresholds-park: SKIP (0.001s)
[659.276343] [145/155] (397s left) kms_feature_discovery (display)
[659.362045] Starting subtest: display
[659.364406] Subtest display: SUCCESS (0.000s)
[659.438823] [146/155] (397s left) gem_exec_balancer (parallel-keep-in-fence)
[659.692824] Starting subtest: parallel-keep-in-fence
[661.137127] Subtest parallel-keep-in-fence: SUCCESS (1.444s)
[661.245389] [147/155] (395s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)
[661.334647] Starting subtest: pr-overlay-plane-move-continuous-exceed-sf
[661.339851] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[661.406609] [148/155] (395s left) kms_prop_blob (invalid-get-prop-any)
[661.460240] Starting subtest: invalid-get-prop-any
[661.462761] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[661.574175] [149/155] (395s left) kms_frontbuffer_tracking (psrhdr-farfromfence-mmap-gtt)
[661.671052] Starting subtest: psrhdr-farfromfence-mmap-gtt
[661.675547] Subtest psrhdr-farfromfence-mmap-gtt: SKIP (0.000s)
[661.763226] [150/155] (395s left) kms_psr (fbc-psr2-cursor-plane-onoff)
[661.857184] Starting subtest: fbc-psr2-cursor-plane-onoff
[661.860068] Starting dynamic subtest: eDP-1
[661.865001] Dynamic subtest eDP-1: SKIP (0.000s)
[661.870015] Subtest fbc-psr2-cursor-plane-onoff: SKIP (0.001s)
[661.933662] [151/155] (395s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-pgflip-blt)
[662.028791] Starting subtest: fbcpsr-2p-primscrn-shrfb-pgflip-blt
[662.033945] Subtest fbcpsr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[662.132000] [152/155] (394s left) vgem_basic (bad-pad)
[662.168861] Starting subtest: bad-pad
[662.170571] Subtest bad-pad: SUCCESS (0.000s)
[662.234649] [153/155] (394s left) kms_ccs (random-ccs-data-4-tiled-mtl-mc-ccs)
[662.323858] Starting subtest: random-ccs-data-4-tiled-mtl-mc-ccs
[662.325828] Starting dynamic subtest: pipe-A-eDP-1
[663.569672] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.247s)
[663.580350] Starting dynamic subtest: pipe-B-eDP-1
[665.880282] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.308s)
[665.891355] Starting dynamic subtest: pipe-C-eDP-1
[668.194831] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.313s)
[668.207852] Starting dynamic subtest: pipe-D-eDP-1
[670.532156] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.336s)
[670.534970] Subtest random-ccs-data-4-tiled-mtl-mc-ccs: SUCCESS (8.210s)
[671.663334] [154/155] (385s left) kms_psr (psr-sprite-mmap-cpu)
[671.763703] Starting subtest: psr-sprite-mmap-cpu
[671.766152] Starting dynamic subtest: eDP-1
[673.472121] Dynamic subtest eDP-1: SUCCESS (1.710s)
[673.475096] Subtest psr-sprite-mmap-cpu: SUCCESS (1.711s)
[674.342582] [155/155] (382s left) gen7_exec_parse (basic-offset)
[674.400923] Subtest basic-offset: SKIP (0.000s)
[674.468033] Closing watchdogs
results: parsing output: 0/ for test: gem_mmap_wc
results: parsing output: 1/ for test: kms_addfb_basic
results: parsing output: 2/ for test: dumb_buffer
results: parsing output: 3/ for test: kms_fence_pin_leak
results: parsing output: 4/ for test: kms_flip_scaled_crc
results: parsing output: 5/ for test: kms_big_fb
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: gen3_mixed_blits
results: parsing output: 8/ for test: kms_frontbuffer_tracking
results: parsing output: 9/ for test: syncobj_wait
results: parsing output: 10/ for test: kms_plane
results: parsing output: 11/ for test: kms_prop_blob
results: parsing output: 12/ for test: kms_chamelium_hpd
results: parsing output: 13/ for test: kms_pm_backlight
results: parsing output: 14/ for test: kms_cursor_legacy
results: parsing output: 15/ for test: gem_exec_schedule
results: parsing output: 16/ for test: gem_exec_suspend
results: parsing output: 17/ for test: kms_atomic_transition
results: parsing output: 18/ for test: gem_ctx_persistence
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: kms_addfb_basic
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: syncobj_timeline
results: parsing output: 23/ for test: kms_psr
results: parsing output: 24/ for test: syncobj_timeline
results: parsing output: 25/ for test: i915_pm_rpm
results: parsing output: 26/ for test: syncobj_wait
results: parsing output: 27/ for test: gem_mmap_gtt
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: gem_userptr_blits
results: parsing output: 30/ for test: kms_async_flips
results: parsing output: 31/ for test: gem_mmap_offset
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_addfb_basic
results: parsing output: 34/ for test: gem_exec_schedule
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: syncobj_basic
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_pipe_crc_basic
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: gem_exec_reloc
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: prime_busy
results: parsing output: 44/ for test: syncobj_timeline
results: parsing output: 45/ for test: kms_ccs
results: parsing output: 46/ for test: kms_flip
results: parsing output: 47/ for test: kms_psr
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_exec_schedule
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_big_fb
results: parsing output: 53/ for test: kms_chamelium_edid
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: gem_ctx_param
results: parsing output: 56/ for test: kms_joiner
results: parsing output: 57/ for test: perf_pmu
results: parsing output: 58/ for test: kms_ccs
results: parsing output: 59/ for test: kms_cursor_crc
results: parsing output: 60/ for test: gem_lmem_swapping
results: parsing output: 61/ for test: gem_exec_balancer
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: syncobj_timeline
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_lease
results: parsing output: 67/ for test: kms_addfb_basic
results: parsing output: 68/ for test: kms_big_fb
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: gem_mmap_gtt
results: parsing output: 71/ for test: kms_content_protection
results: parsing output: 72/ for test: gem_workarounds
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: gem_softpin
results: parsing output: 75/ for test: kms_color
results: parsing output: 76/ for test: kms_plane_lowres
results: parsing output: 77/ for test: kms_flip
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: kms_psr
results: parsing output: 81/ for test: kms_cursor_edge_walk
results: parsing output: 82/ for test: gem_mmap
results: parsing output: 83/ for test: gem_ctx_isolation
results: parsing output: 84/ for test: kms_big_fb
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: kms_cursor_legacy
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_ccs
results: parsing output: 89/ for test: template
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: kms_pm_dc
results: parsing output: 92/ for test: core_auth
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: perf_pmu
results: parsing output: 95/ for test: kms_busy
results: parsing output: 96/ for test: kms_big_fb
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: tools_test
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: kms_cursor_crc
results: parsing output: 102/ for test: kms_big_fb
results: parsing output: 103/ for test: gem_exec_fence
results: parsing output: 104/ for test: gem_busy
results: parsing output: 105/ for test: gem_exec_reloc
results: parsing output: 106/ for test: syncobj_timeline
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_flip_scaled_crc
results: parsing output: 109/ for test: i915_drm_fdinfo
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_rotation_crc
results: parsing output: 112/ for test: gem_spin_batch
results: parsing output: 113/ for test: syncobj_wait
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: api_intel_allocator
results: parsing output: 116/ for test: gem_eio
results: parsing output: 117/ for test: kms_tv_load_detect
results: parsing output: 118/ for test: gem_exec_reloc
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: sw_sync
results: parsing output: 121/ for test: kms_ccs
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: gem_mmap_gtt
results: parsing output: 125/ for test: i915_drm_fdinfo
results: parsing output: 126/ for test: kms_vblank
results: parsing output: 127/ for test: kms_psr
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: kms_plane_scaling
results: parsing output: 130/ for test: kms_frontbuffer_tracking
results: parsing output: 131/ for test: kms_frontbuffer_tracking
results: parsing output: 132/ for test: gen9_exec_parse
results: parsing output: 133/ for test: kms_cursor_legacy
results: parsing output: 134/ for test: kms_frontbuffer_tracking
results: parsing output: 135/ for test: gem_render_copy
results: parsing output: 136/ for test: gem_render_copy
results: parsing output: 137/ for test: kms_hdr
results: parsing output: 138/ for test: gem_create
results: parsing output: 139/ for test: kms_dirtyfb
results: parsing output: 140/ for test: kms_vblank
results: parsing output: 141/ for test: gem_exec_reloc
results: parsing output: 142/ for test: kms_cursor_legacy
results: parsing output: 143/ for test: i915_pm_rps
results: parsing output: 144/ for test: kms_feature_discovery
results: parsing output: 145/ for test: gem_exec_balancer
results: parsing output: 146/ for test: kms_psr2_sf
results: parsing output: 147/ for test: kms_prop_blob
results: parsing output: 148/ for test: kms_frontbuffer_tracking
results: parsing output: 149/ for test: kms_psr
results: parsing output: 150/ for test: kms_frontbuffer_tracking
results: parsing output: 151/ for test: vgem_basic
results: parsing output: 152/ for test: kms_ccs
results: parsing output: 153/ for test: kms_psr
results: parsing output: 154/ for test: gen7_exec_parse
Done.