[57.337146] Initializing watchdogs
[57.337195]   /dev/watchdog0
[57.350538] [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]
[57.355205] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.357431] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.360790] [001/133] (960s left) i915_drm_fdinfo (virtual-busy)
[57.425104] Starting subtest: virtual-busy
[57.429683] Subtest virtual-busy: SKIP (0.000s)
[57.511068] [002/133] (960s left) gem_exec_params (invalid-ring2)
[57.569350] Starting subtest: invalid-ring2
[57.571713] Subtest invalid-ring2: SUCCESS (0.000s)
[57.655875] [003/133] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[57.758284] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[57.762502] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[57.863589] [004/133] (960s left) api_intel_allocator (standalone)
[57.929431] Starting subtest: standalone
[57.947497] Subtest standalone: SUCCESS (0.019s)
[58.072174] [005/133] (959s left) gem_partial_pwrite_pread (reads-display)
[58.128251] Subtest reads-display: SKIP (0.000s)
[58.209138] [006/133] (959s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[58.304942] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu
[64.880310] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (6.584s)
[65.001658] [007/133] (953s left) gen7_exec_parse (chained-batch)
[65.055161] Subtest chained-batch: SKIP (0.000s)
[65.120767] [008/133] (952s left) syncobj_wait (invalid-reset-bad-pad)
[65.175238] Starting subtest: invalid-reset-bad-pad
[65.177613] Subtest invalid-reset-bad-pad: SUCCESS (0.000s)
[65.265163] [009/133] (952s left) gem_exec_whisper (basic-fds-forked-all)
[65.326273] Starting subtest: basic-fds-forked-all
[86.957348] Subtest basic-fds-forked-all: SUCCESS (21.634s)
[87.139258] [010/133] (931s left) kms_universal_plane (cursor-fb-leak)
[87.239724] Starting subtest: cursor-fb-leak
[87.241639] Starting dynamic subtest: pipe-A-eDP-1
[87.576876] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.338s)
[87.587701] Starting dynamic subtest: pipe-B-eDP-1
[88.953306] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.375s)
[88.964641] Starting dynamic subtest: pipe-C-eDP-1
[90.279452] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.324s)
[90.288234] Starting dynamic subtest: pipe-D-eDP-1
[91.605945] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.326s)
[91.608511] Subtest cursor-fb-leak: SUCCESS (4.369s)
[92.762502] [011/133] (925s left) kms_chamelium_color (ctm-red-to-blue)
[92.855093] Subtest ctm-red-to-blue: SKIP (0.000s)
[92.896341] [012/133] (925s left) gem_mmap_gtt (medium-copy)
[92.953848] Subtest medium-copy: SKIP (0.000s)
[93.019565] [013/133] (925s left) gem_exec_balancer (parallel-bb-first)
[93.272917] Starting subtest: parallel-bb-first
[94.208859] Subtest parallel-bb-first: SUCCESS (0.936s)
[94.977701] [014/133] (923s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-plflip-blt)
[95.066903] Starting subtest: fbc-2p-scndscrn-indfb-plflip-blt
[95.071289] Subtest fbc-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s)
[95.158160] [015/133] (923s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-plflip-blt)
[95.262176] Starting subtest: fbc-2p-scndscrn-shrfb-plflip-blt
[95.266409] Subtest fbc-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[95.357048] [016/133] (923s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-blt)
[95.459197] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-blt
[99.921741] Subtest fbc-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (4.468s)
[101.067722] [017/133] (917s left) gem_exec_fence (invalid-fence-array)
[101.571272] Starting subtest: invalid-fence-array
[101.576402] Subtest invalid-fence-array: SUCCESS (0.003s)
[102.984479] [FACT gem_exec_fence (invalid-fence-array)] new: kernel.kmod_is_loaded.vgem: true
[102.987929] [018/133] (915s left) kms_vblank (ts-continuation-modeset-rpm)
[103.082231] Starting subtest: ts-continuation-modeset-rpm
[103.084405] Starting dynamic subtest: pipe-A-eDP-1
[108.824439] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.741s)
[108.839157] Starting dynamic subtest: pipe-D-eDP-1
[111.092063] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.262s)
[111.094433] Subtest ts-continuation-modeset-rpm: SUCCESS (8.007s)
[111.893178] [019/133] (906s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-onoff)
[111.985774] Starting subtest: psr-1p-primscrn-spr-indfb-onoff
[119.073375] Subtest psr-1p-primscrn-spr-indfb-onoff: SUCCESS (7.091s)
[119.196332] [020/133] (899s left) kms_addfb_basic (bad-pitch-999)
[119.260355] Starting subtest: bad-pitch-999
[119.262824] Subtest bad-pitch-999: SUCCESS (0.000s)
[119.394150] [021/133] (899s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area)
[119.492659] Starting subtest: psr2-overlay-plane-update-sf-dmg-area
[119.494923] Starting dynamic subtest: pipe-A-eDP-1
[125.384809] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.898s)
[125.394753] Starting dynamic subtest: pipe-B-eDP-1
[132.049530] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.661s)
[132.051965] Subtest psr2-overlay-plane-update-sf-dmg-area: SUCCESS (12.561s)
[132.910328] [022/133] (885s left) gem_exec_schedule (semaphore-resolve)
[132.986152] Starting subtest: semaphore-resolve
[133.023227] Subtest semaphore-resolve: SUCCESS (0.038s)
[133.353949] [023/133] (885s left) kms_chamelium_color (ctm-negative)
[133.443338] Subtest ctm-negative: SKIP (0.000s)
[133.486948] [024/133] (885s left) kms_prop_blob (blob-multiple)
[133.543646] Starting subtest: blob-multiple
[133.545808] Subtest blob-multiple: SUCCESS (0.002s)
[133.658015] [025/133] (885s left) kms_draw_crc (draw-method-mmap-cpu)
[133.747367] Starting subtest: draw-method-mmap-cpu
[133.749585] Starting dynamic subtest: xrgb8888-untiled
[133.979639] Dynamic subtest xrgb8888-untiled: SUCCESS (0.233s)
[133.990080] Starting dynamic subtest: rgb565-untiled
[134.189625] Dynamic subtest rgb565-untiled: SUCCESS (0.210s)
[134.198581] Starting dynamic subtest: xrgb2101010-untiled
[134.400162] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.210s)
[134.409725] Starting dynamic subtest: xbgr16161616f-untiled
[134.613136] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.211s)
[134.622162] Starting dynamic subtest: xrgb8888-xtiled
[134.755627] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.144s)
[134.763488] Starting dynamic subtest: rgb565-xtiled
[134.877817] Dynamic subtest rgb565-xtiled: SUCCESS (0.121s)
[134.885694] Starting dynamic subtest: xrgb2101010-xtiled
[135.000075] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.122s)
[135.008312] Starting dynamic subtest: xbgr16161616f-xtiled
[135.122042] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.122s)
[135.132611] Starting dynamic subtest: xrgb8888-4tiled
[135.256063] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.132s)
[135.264066] Starting dynamic subtest: rgb565-4tiled
[135.400354] Dynamic subtest rgb565-4tiled: SUCCESS (0.142s)
[135.408187] Starting dynamic subtest: xrgb2101010-4tiled
[135.533940] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.131s)
[135.542322] Starting dynamic subtest: xbgr16161616f-4tiled
[135.667298] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.131s)
[135.669175] Subtest draw-method-mmap-cpu: SUCCESS (1.922s)
[135.758508] [026/133] (883s left) syncobj_timeline (wait-any-complex)
[135.813136] Starting subtest: wait-any-complex
[135.876100] Subtest wait-any-complex: SUCCESS (0.063s)
[135.964661] [027/133] (882s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[136.203383] Starting subtest: cursor-rapid-movement-256x256
[136.209981] Starting dynamic subtest: pipe-A-eDP-1
[136.766048] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.554s)
[136.795278] Starting dynamic subtest: pipe-D-eDP-1
[138.011080] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.224s)
[138.013472] Subtest cursor-rapid-movement-256x256: SUCCESS (1.808s)
[138.864732] [028/133] (880s left) sysfs_timeslice_duration (timeout)
[138.927093] Starting subtest: timeout
[138.929368] Starting dynamic subtest: vecs0
[148.882802] Dynamic subtest vecs0: SUCCESS (9.954s)
[148.893744] Starting dynamic subtest: ccs0
[150.192796] Dynamic subtest ccs0: SUCCESS (1.309s)
[150.204816] Starting dynamic subtest: vcs0
[159.887374] Dynamic subtest vcs0: SUCCESS (9.689s)
[159.897179] Starting dynamic subtest: bcs0
[160.543649] Dynamic subtest bcs0: SUCCESS (0.656s)
[160.554661] Starting dynamic subtest: rcs0
[161.828541] Dynamic subtest rcs0: SUCCESS (1.283s)
[161.840181] Starting dynamic subtest: vcs1
[170.896673] Dynamic subtest vcs1: SUCCESS (9.063s)
[170.899255] Subtest timeout: SUCCESS (31.967s)
[170.981657] [029/133] (847s left) gem_create (create-ext-placement-sanity-check)
[171.138145] Starting subtest: create-ext-placement-sanity-check
[171.144074] Subtest create-ext-placement-sanity-check: SUCCESS (0.004s)
[171.250556] [030/133] (847s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling)
[171.351330] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-upscaling
[171.353728] Starting dynamic subtest: pipe-A-default-mode
[174.120207] Dynamic subtest pipe-A-default-mode: SUCCESS (2.769s)
[174.122628] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SUCCESS (2.770s)
[174.943717] [031/133] (844s left) gem_mmap_gtt (cpuset-big-copy-odd)
[174.995384] Subtest cpuset-big-copy-odd: SKIP (0.000s)
[175.053172] [032/133] (844s left) i915_pm_rpm (gem-execbuf-stress-pc8)
[177.087079] Starting subtest: gem-execbuf-stress-pc8
[177.129408] Subtest gem-execbuf-stress-pc8: SKIP (0.039s)
[177.459169] [033/133] (841s left) core_debugfs (read-all-entries)
[177.521935] Starting subtest: read-all-entries
[177.615517] Subtest read-all-entries: SUCCESS (0.096s)
[177.683144] [034/133] (841s left) gem_render_copy (linear-to-vebox-y-tiled)
[177.746962] Starting subtest: linear-to-vebox-y-tiled
[177.751444] Subtest linear-to-vebox-y-tiled: SKIP (0.000s)
[177.928633] [035/133] (841s left) kms_color (ctm-green-to-red)
[178.014293] Starting subtest: ctm-green-to-red
[178.016453] Starting dynamic subtest: pipe-A-eDP-1
[178.699294] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.687s)
[178.709889] Starting dynamic subtest: pipe-B-eDP-1
[180.077360] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.375s)
[180.086642] Starting dynamic subtest: pipe-C-eDP-1
[181.433987] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.356s)
[181.442385] Starting dynamic subtest: pipe-D-eDP-1
[182.770043] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.337s)
[182.772400] Subtest ctm-green-to-red: SUCCESS (4.759s)
[183.581891] [036/133] (835s left) kms_big_fb (x-tiled-8bpp-rotate-270)
[183.690690] Starting subtest: x-tiled-8bpp-rotate-270
[183.712693] Subtest x-tiled-8bpp-rotate-270: SKIP (0.021s)
[183.826515] [037/133] (835s left) kms_pipe_crc_basic (read-crc)
[183.924012] Starting subtest: read-crc
[183.925963] Starting dynamic subtest: pipe-A-eDP-1
[184.613339] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.690s)
[184.622589] Starting dynamic subtest: pipe-B-eDP-1
[185.956498] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.340s)
[185.966263] Starting dynamic subtest: pipe-C-eDP-1
[187.244674] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.287s)
[187.254790] Starting dynamic subtest: pipe-D-eDP-1
[188.579413] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.333s)
[188.581682] Subtest read-crc: SUCCESS (4.656s)
[189.427823] [038/133] (829s left) kms_psr (psr-sprite-mmap-gtt)
[189.519269] Starting subtest: psr-sprite-mmap-gtt
[189.521383] Starting dynamic subtest: eDP-1
[190.957825] Dynamic subtest eDP-1: SKIP (1.434s)
[190.962951] Subtest psr-sprite-mmap-gtt: SKIP (1.437s)
[191.105498] [039/133] (828s left) kms_pm_dc (dc5-retention-flops)
[192.199135] Starting subtest: dc5-retention-flops
[192.203641] Subtest dc5-retention-flops: SKIP (0.000s)
[192.271358] [040/133] (827s left) syncobj_wait (multi-wait-all-for-submit-signaled)
[192.346867] Starting subtest: multi-wait-all-for-submit-signaled
[192.349373] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.000s)
[192.461212] [041/133] (826s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-wc)
[192.562760] Starting subtest: psr-rgb101010-draw-mmap-wc
[199.606440] Subtest psr-rgb101010-draw-mmap-wc: SUCCESS (7.047s)
[199.720189] [042/133] (819s left) kms_cursor_legacy (cursorb-vs-flipb-varying-size)
[199.836426] Starting subtest: cursorB-vs-flipB-varying-size
[199.840969] Subtest cursorB-vs-flipB-varying-size: SKIP (0.001s)
[199.976801] [043/133] (819s left) prime_vgem (basic-fence-flip)
[200.048932] Starting subtest: basic-fence-flip
[200.349741] Subtest basic-fence-flip: SUCCESS (0.301s)
[200.455447] [044/133] (819s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt)
[200.563109] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt
[207.227132] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SUCCESS (6.668s)
[207.370470] [045/133] (812s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[207.489814] Starting subtest: basic-flip-after-cursor-atomic
[208.401127] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.912s)
[209.261813] [046/133] (810s left) kms_plane (plane-panning-top-left)
[209.361182] Starting subtest: plane-panning-top-left
[209.363686] Starting dynamic subtest: pipe-A
[211.009964] Dynamic subtest pipe-A: SUCCESS (1.647s)
[211.019062] Starting dynamic subtest: pipe-B
[213.300867] Dynamic subtest pipe-B: SUCCESS (2.292s)
[213.303234] Subtest plane-panning-top-left: SUCCESS (3.943s)
[214.122912] [047/133] (805s left) syncobj_wait (invalid-reset-zero-handles)
[214.186100] Starting subtest: invalid-reset-zero-handles
[214.188301] Subtest invalid-reset-zero-handles: SUCCESS (0.000s)
[214.287541] [048/133] (805s left) perf_pmu (busy-double-start)
[214.329846] Starting subtest: busy-double-start
[214.331836] Starting dynamic subtest: rcs0
[217.963529] Dynamic subtest rcs0: FAIL (3.578s)
[217.975653] Starting dynamic subtest: bcs0
[221.500782] Dynamic subtest bcs0: SUCCESS (3.594s)
[221.516645] Starting dynamic subtest: vcs0
[225.456957] Dynamic subtest vcs0: SUCCESS (3.954s)
[225.468743] Starting dynamic subtest: vcs1
[229.404613] Dynamic subtest vcs1: SUCCESS (3.946s)
[229.415676] Starting dynamic subtest: vecs0
[233.461550] Dynamic subtest vecs0: SUCCESS (4.055s)
[233.472754] Starting dynamic subtest: ccs0
[237.097708] Dynamic subtest ccs0: FAIL (3.565s)
[237.100097] Subtest busy-double-start: FAIL (22.703s)
[237.148036] [049/133] (782s left) kms_psr (fbc-psr2-cursor-render)
[237.247542] Starting subtest: fbc-psr2-cursor-render
[237.249922] Starting dynamic subtest: eDP-1
[237.254358] Dynamic subtest eDP-1: SKIP (0.000s)
[237.258858] Subtest fbc-psr2-cursor-render: SKIP (0.001s)
[237.324082] [050/133] (782s left) kms_big_fb (y-tiled-32bpp-rotate-0)
[237.440670] Starting subtest: y-tiled-32bpp-rotate-0
[237.445336] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s)
[237.547160] [051/133] (782s left) gem_caching (read-writes)
[237.620199] Subtest read-writes: SKIP (0.000s)
[237.689943] [052/133] (782s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[237.786496] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[238.399507] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.614s)
[238.574190] [053/133] (781s left) kms_flip (2x-busy-flip)
[238.678043] Starting subtest: 2x-busy-flip
[238.686390] Subtest 2x-busy-flip: SKIP (0.010s)
[238.763715] [054/133] (781s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[238.856287] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[238.858583] Starting dynamic subtest: pipe-A-eDP-1
[238.867636] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[238.877617] Starting dynamic subtest: pipe-B-eDP-1
[238.886693] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[238.894899] Starting dynamic subtest: pipe-C-eDP-1
[238.903252] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[238.910972] Starting dynamic subtest: pipe-D-eDP-1
[238.919280] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[238.923197] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[241.080562] [055/133] (778s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-wc)
[241.180388] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-wc
[244.792924] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (3.616s)
[245.984084] [056/133] (774s left) kms_psr (fbc-psr-cursor-plane-onoff)
[246.069224] Starting subtest: fbc-psr-cursor-plane-onoff
[246.071668] Starting dynamic subtest: eDP-1
[246.076209] Dynamic subtest eDP-1: SKIP (0.000s)
[246.080704] Subtest fbc-psr-cursor-plane-onoff: SKIP (0.001s)
[246.141459] [057/133] (773s left) gem_exec_gttfill (basic)
[246.212526] Starting subtest: basic
[248.846519] Subtest basic: SUCCESS (2.633s)
[249.049305] [058/133] (771s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling)
[249.193661] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling
[249.196076] Starting dynamic subtest: pipe-A-default-mode
[251.917434] Dynamic subtest pipe-A-default-mode: SUCCESS (2.725s)
[251.919837] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (2.727s)
[252.750544] [059/133] (767s left) kms_psr (psr2-cursor-blt)
[252.840230] Starting subtest: psr2-cursor-blt
[252.842524] Starting dynamic subtest: eDP-1
[254.548476] Dynamic subtest eDP-1: SUCCESS (1.708s)
[254.550863] Subtest psr2-cursor-blt: SUCCESS (1.709s)
[255.336474] [060/133] (764s left) gem_sync (basic-all)
[255.415803] Starting subtest: basic-all
[258.582117] Subtest basic-all: SUCCESS (3.175s)
[258.774747] [061/133] (761s left) gem_lmem_swapping (parallel-random)
[258.838473] Subtest parallel-random: SKIP (0.000s)
[258.895872] [062/133] (761s left) fbdev (read)
[258.929156] Starting subtest: read
[259.453080] Subtest read: SUCCESS (0.524s)
[259.517159] [063/133] (760s left) kms_addfb_basic (tile-pitch-mismatch)
[259.573136] Starting subtest: tile-pitch-mismatch
[259.578342] Subtest tile-pitch-mismatch: SKIP (0.000s)
[259.702876] [064/133] (760s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt)
[259.800991] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt
[264.318025] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (4.522s)
[265.450238] [065/133] (754s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc)
[265.541447] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc
[269.504243] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (3.966s)
[270.637377] [066/133] (749s left) kms_flip (flip-vs-panning)
[270.731257] Starting subtest: flip-vs-panning
[270.733171] Starting dynamic subtest: A-eDP1
[279.443727] Dynamic subtest A-eDP1: SUCCESS (8.713s)
[279.455082] Starting dynamic subtest: B-eDP1
[288.177354] Dynamic subtest B-eDP1: SUCCESS (8.732s)
[288.186698] Starting dynamic subtest: C-eDP1
[296.892131] Dynamic subtest C-eDP1: SUCCESS (8.713s)
[296.904616] Starting dynamic subtest: D-eDP1
[305.608545] Dynamic subtest D-eDP1: SUCCESS (8.714s)
[305.612879] Subtest flip-vs-panning: SUCCESS (34.882s)
[306.790426] [067/133] (713s left) syncobj_wait (invalid-reset-illegal-handle)
[306.856631] Starting subtest: invalid-reset-illegal-handle
[306.858561] Subtest invalid-reset-illegal-handle: SUCCESS (0.000s)
[306.970199] [068/133] (713s left) dmabuf_sync_file (export-multiwait)
[307.008972] Starting subtest: export-multiwait
[307.011428] Subtest export-multiwait: SUCCESS (0.000s)
[307.067985] [069/133] (713s left) kms_panel_fitting (atomic-fastset)
[307.164390] Starting subtest: atomic-fastset
[307.166612] Starting dynamic subtest: pipe-A-eDP-1
[307.315595] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.153s)
[307.326094] Starting dynamic subtest: pipe-B-eDP-1
[308.537696] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.221s)
[308.549569] Starting dynamic subtest: pipe-C-eDP-1
[309.727115] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.187s)
[309.736951] Starting dynamic subtest: pipe-D-eDP-1
[310.857940] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.129s)
[310.860601] Subtest atomic-fastset: SUCCESS (3.695s)
[312.015409] [070/133] (708s left) kms_chamelium_hpd (hdmi-hpd-fast)
[312.390788] Subtest hdmi-hpd-fast: SKIP (0.000s)
[313.208483] [071/133] (707s left) kms_invalid_mode (int-max-clock)
[313.298159] Starting subtest: int-max-clock
[313.300771] Starting dynamic subtest: pipe-A-eDP-1
[313.587023] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.291s)
[313.596860] Starting dynamic subtest: pipe-B-eDP-1
[313.599125] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[313.608073] Starting dynamic subtest: pipe-C-eDP-1
[313.610648] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[313.618800] Starting dynamic subtest: pipe-D-eDP-1
[313.620688] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[313.622695] Subtest int-max-clock: SUCCESS (0.297s)
[314.454674] [072/133] (706s left) sw_sync (timeline_closed_signaled)
[314.500046] Starting subtest: timeline_closed_signaled
[314.502092] Subtest timeline_closed_signaled: SUCCESS (0.000s)
[314.558672] [073/133] (706s left) perf_pmu (busy-idle-check-all)
[314.600879] Starting subtest: busy-idle-check-all
[314.603080] Starting dynamic subtest: rcs0
[315.249528] Dynamic subtest rcs0: SUCCESS (0.651s)
[315.261154] Starting dynamic subtest: bcs0
[315.903965] Dynamic subtest bcs0: SUCCESS (0.652s)
[315.916316] Starting dynamic subtest: vcs0
[317.910528] Dynamic subtest vcs0: SUCCESS (2.002s)
[317.922712] Starting dynamic subtest: vcs1
[319.893506] Dynamic subtest vcs1: SUCCESS (1.980s)
[319.904571] Starting dynamic subtest: vecs0
[321.877634] Dynamic subtest vecs0: SUCCESS (1.981s)
[321.889440] Starting dynamic subtest: ccs0
[322.534531] Dynamic subtest ccs0: SUCCESS (0.656s)
[322.537088] Subtest busy-idle-check-all: SUCCESS (7.937s)
[322.629770] [074/133] (698s left) gem_ctx_isolation (dirty-switch)
[322.689178] Starting subtest: dirty-switch
[322.691471] Starting dynamic subtest: rcs0
[322.925128] Dynamic subtest rcs0: SUCCESS (0.235s)
[322.935774] Starting dynamic subtest: bcs0
[323.160919] Dynamic subtest bcs0: SUCCESS (0.235s)
[323.172886] Starting dynamic subtest: vcs0
[323.400993] Dynamic subtest vcs0: SUCCESS (0.239s)
[323.410947] Starting dynamic subtest: vcs1
[325.090533] Dynamic subtest vcs1: SUCCESS (1.687s)
[325.100107] Starting dynamic subtest: vecs0
[327.063320] Dynamic subtest vecs0: SUCCESS (1.972s)
[327.072236] Starting dynamic subtest: ccs0
[329.141140] Dynamic subtest ccs0: SUCCESS (2.077s)
[329.143309] Subtest dirty-switch: SUCCESS (6.452s)
[329.379924] [075/133] (691s left) prime_busy (before-wait)
[329.442535] Starting subtest: before-wait
[329.448961] Starting dynamic subtest: rcs0
[329.482253] Dynamic subtest rcs0: SUCCESS (0.033s)
[329.493149] Starting dynamic subtest: bcs0
[329.534812] Dynamic subtest bcs0: SUCCESS (0.051s)
[329.543632] Starting dynamic subtest: vcs0
[329.578125] Dynamic subtest vcs0: SUCCESS (0.043s)
[329.586691] Starting dynamic subtest: vcs1
[329.620827] Dynamic subtest vcs1: SUCCESS (0.042s)
[329.636996] Starting dynamic subtest: vecs0
[329.663089] Dynamic subtest vecs0: SUCCESS (0.041s)
[329.672676] Starting dynamic subtest: ccs0
[329.705122] Dynamic subtest ccs0: SUCCESS (0.041s)
[329.813924] Subtest before-wait: SUCCESS (0.372s)
[329.890377] [076/133] (691s left) kms_async_flips (test-time-stamp)
[329.992334] Starting subtest: test-time-stamp
[330.368967] Starting dynamic subtest: pipe-A-eDP-1
[331.162024] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.792s)
[331.530059] Starting dynamic subtest: pipe-B-eDP-1
[332.298055] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.773s)
[332.677298] Starting dynamic subtest: pipe-C-eDP-1
[333.426806] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.754s)
[333.787992] Starting dynamic subtest: pipe-D-eDP-1
[334.561468] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.779s)
[334.563925] Subtest test-time-stamp: SUCCESS (4.569s)
[335.714324] [077/133] (685s left) kms_cursor_legacy (2x-long-flip-vs-cursor-legacy)
[335.846295] Starting subtest: 2x-long-flip-vs-cursor-legacy
[335.850661] Subtest 2x-long-flip-vs-cursor-legacy: SKIP (0.001s)
[335.993613] [078/133] (685s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping)
[336.088819] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping
[336.092787] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s)
[336.170903] [079/133] (684s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[336.264432] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[336.268708] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[336.370851] [080/133] (684s left) gem_exec_capture (capture-invisible)
[336.436741] Starting subtest: capture-invisible
[336.439071] Starting dynamic subtest: smem0
[336.443326] Dynamic subtest smem0: SKIP (0.000s)
[336.447742] Subtest capture-invisible: SKIP (0.001s)
[336.556695] [081/133] (684s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-move)
[336.655646] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-move
[336.659382] Subtest fbcpsr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[336.762075] [082/133] (684s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc)
[336.856504] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc
[336.858454] Starting dynamic subtest: pipe-A-eDP-1
[336.875646] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[336.888867] Starting dynamic subtest: pipe-B-eDP-1
[336.904221] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[336.912275] Starting dynamic subtest: pipe-C-eDP-1
[336.927641] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[336.935520] Starting dynamic subtest: pipe-D-eDP-1
[336.950892] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[336.952508] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.008s)
[339.174229] [083/133] (682s left) kms_dither (fb-8bpc-vs-panel-8bpc)
[339.268087] Starting subtest: fb-8bpc-vs-panel-8bpc
[339.270402] Starting dynamic subtest: pipe-A-eDP-1
[340.675063] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.405s)
[340.677273] Subtest fb-8bpc-vs-panel-8bpc: SUCCESS (1.406s)
[341.525959] [084/133] (679s left) kms_big_fb (4-tiled-64bpp-rotate-90)
[341.643469] Starting subtest: 4-tiled-64bpp-rotate-90
[341.663643] Subtest 4-tiled-64bpp-rotate-90: SKIP (0.019s)
[341.782125] [085/133] (679s left) gem_ctx_sseu (mmap-args)
[341.847896] Subtest mmap-args: SKIP (0.000s)
[341.926301] [086/133] (679s left) kms_psr (psr2-primary-blt)
[342.014846] Starting subtest: psr2-primary-blt
[342.017168] Starting dynamic subtest: eDP-1
[343.716674] Dynamic subtest eDP-1: SUCCESS (1.703s)
[343.719077] Subtest psr2-primary-blt: SUCCESS (1.704s)
[344.586892] [087/133] (676s left) syncobj_wait (single-wait-for-submit-submitted)
[344.647264] Starting subtest: single-wait-for-submit-submitted
[344.753916] Subtest single-wait-for-submit-submitted: SUCCESS (0.106s)
[344.830565] [088/133] (676s left) gem_pwrite (basic-random)
[344.894063] Subtest basic-random: SKIP (0.000s)
[344.961299] [089/133] (676s left) syncobj_timeline (multi-wait-all-for-submit-available-signaled)
[345.013180] Starting subtest: multi-wait-all-for-submit-available-signaled
[345.015351] Subtest multi-wait-all-for-submit-available-signaled: SUCCESS (0.000s)
[345.118770] [090/133] (676s left) gem_userptr_blits (stress-mm-invalidate-close-overlap)
[345.182878] Starting subtest: stress-mm-invalidate-close-overlap
[347.331728] Subtest stress-mm-invalidate-close-overlap: SUCCESS (2.148s)
[347.444435] [091/133] (674s left) gem_tiled_pread_pwrite
[347.560409] [092/133] (674s left) kms_legacy_colorkey (basic)
[347.649862] Starting subtest: basic
[347.652076] Starting dynamic subtest: pipe-A
[347.693330] Dynamic subtest pipe-A: SUCCESS (0.045s)
[347.705451] Starting dynamic subtest: pipe-B
[347.707635] Dynamic subtest pipe-B: SUCCESS (0.000s)
[347.718504] Starting dynamic subtest: pipe-C
[347.720670] Dynamic subtest pipe-C: SUCCESS (0.000s)
[347.729016] Starting dynamic subtest: pipe-D
[347.731217] Dynamic subtest pipe-D: SUCCESS (0.000s)
[347.733318] Subtest basic: SUCCESS (0.050s)
[347.769935] [093/133] (673s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[347.862746] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu
[354.482020] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.623s)
[354.581357] [094/133] (667s left) kms_big_fb (linear-16bpp-rotate-180)
[354.677969] Starting subtest: linear-16bpp-rotate-180
[356.078452] Subtest linear-16bpp-rotate-180: SUCCESS (1.399s)
[356.192929] [095/133] (665s left) syncobj_eventfd (invalid-bad-pad)
[356.259887] Starting subtest: invalid-bad-pad
[356.261648] Subtest invalid-bad-pad: SUCCESS (0.000s)
[356.346319] [096/133] (665s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[356.440570] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[356.444416] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[356.534102] [097/133] (665s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-plflip-blt)
[356.625416] Starting subtest: fbc-1p-primscrn-shrfb-plflip-blt
[361.236642] Subtest fbc-1p-primscrn-shrfb-plflip-blt: SUCCESS (4.613s)
[362.433449] [098/133] (659s left) kms_cursor_legacy (short-flip-before-cursor-atomic-transitions)
[362.550446] Starting subtest: short-flip-before-cursor-atomic-transitions
[363.500828] Subtest short-flip-before-cursor-atomic-transitions: SUCCESS (0.952s)
[364.353798] [099/133] (657s left) gem_exec_schedule (implicit-write-read)
[364.425629] Starting subtest: implicit-write-read
[364.427595] Starting dynamic subtest: rcs0
[364.526170] Dynamic subtest rcs0: SUCCESS (0.110s)
[364.538095] Starting dynamic subtest: vcs0
[364.607924] Dynamic subtest vcs0: SUCCESS (0.080s)
[364.619938] Starting dynamic subtest: vcs1
[364.685756] Dynamic subtest vcs1: SUCCESS (0.077s)
[364.700894] Starting dynamic subtest: vecs0
[364.769893] Dynamic subtest vecs0: SUCCESS (0.084s)
[364.783681] Starting dynamic subtest: ccs0
[364.864880] Dynamic subtest ccs0: SUCCESS (0.093s)
[364.868093] Subtest implicit-write-read: SUCCESS (0.448s)
[366.021025] [100/133] (655s left) syncobj_timeline (etime-multi-wait-submitted)
[366.089593] Starting subtest: etime-multi-wait-submitted
[366.193497] Subtest etime-multi-wait-submitted: SUCCESS (0.104s)
[366.270337] [101/133] (655s left) kms_plane (pixel-format-yf-tiled-modifier)
[366.375591] Starting subtest: pixel-format-yf-tiled-modifier
[366.380155] Subtest pixel-format-yf-tiled-modifier: SKIP (0.000s)
[366.450088] [102/133] (655s left) kms_getfb (getfb2-handle-not-fb)
[366.534964] Starting subtest: getfb2-handle-not-fb
[366.537256] Subtest getfb2-handle-not-fb: SUCCESS (0.000s)
[366.654289] [103/133] (655s left) kms_psr2_sf (pr-overlay-plane-move-continuous-sf)
[366.755159] Starting subtest: pr-overlay-plane-move-continuous-sf
[366.759258] Subtest pr-overlay-plane-move-continuous-sf: SKIP (0.000s)
[366.834974] [104/133] (655s left) i915_query (query-topology-garbage-items)
[366.887331] Starting subtest: query-topology-garbage-items
[366.889271] Subtest query-topology-garbage-items: SUCCESS (0.000s)
[366.976092] [105/133] (655s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs)
[367.067447] Starting subtest: crc-sprite-planes-basic-4-tiled-bmg-ccs
[367.071928] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[368.184619] [106/133] (653s left) i915_query (query-topology-known-pci-ids)
[368.246411] Starting subtest: query-topology-known-pci-ids
[368.250579] Subtest query-topology-known-pci-ids: SKIP (0.000s)
[368.339885] [107/133] (653s left) perf (enable-disable)
[368.482946] Starting subtest: enable-disable
[368.485211] Starting dynamic subtest: 0-rcs0
[370.748575] Dynamic subtest 0-rcs0: SUCCESS (2.265s)
[370.760353] Starting dynamic subtest: 1-vecs0
[375.219525] Dynamic subtest 1-vecs0: SUCCESS (4.469s)
[375.221754] Subtest enable-disable: SUCCESS (6.736s)
[375.268402] [108/133] (646s left) gem_set_tiling_vs_gtt
[375.401299] [109/133] (646s left) gem_userptr_blits (dmabuf-sync)
[375.462342] Starting subtest: dmabuf-sync
[375.466760] Subtest dmabuf-sync: SKIP (0.002s)
[375.606055] [110/133] (646s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[375.722347] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[375.726337] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[375.823454] [111/133] (646s left) gem_exec_reloc (basic-wc-read)
[375.877436] Subtest basic-wc-read: SKIP (0.000s)
[375.945479] [112/133] (646s left) kms_addfb_basic (bad-pitch-128)
[376.001749] Starting subtest: bad-pitch-128
[376.003683] Subtest bad-pitch-128: SUCCESS (0.000s)
[376.125486] [113/133] (646s left) gem_ppgtt (flink-and-close-vma-leak)
[376.186320] Starting subtest: flink-and-close-vma-leak
[376.228365] Subtest flink-and-close-vma-leak: SUCCESS (0.042s)
[376.346164] [114/133] (646s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs)
[376.435450] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs
[376.437300] Starting dynamic subtest: pipe-A-eDP-1
[376.453695] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[376.462658] Starting dynamic subtest: pipe-B-eDP-1
[376.478397] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[376.487487] Starting dynamic subtest: pipe-C-eDP-1
[376.502772] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[376.511162] Starting dynamic subtest: pipe-D-eDP-1
[376.526375] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[376.528105] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs: SUCCESS (0.005s)
[378.745144] [115/133] (643s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted)
[378.799312] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted
[378.801197] Subtest multi-wait-for-submit-available-unsubmitted-submitted: SUCCESS (0.000s)
[378.902521] [116/133] (643s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-onoff)
[379.003629] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-onoff
[379.007746] Subtest fbcpsr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[379.107949] [117/133] (643s left) gem_softpin (reverse)
[379.180096] Starting subtest: reverse
[379.185413] Subtest reverse: SUCCESS (0.005s)
[379.307395] [118/133] (643s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-sf)
[379.407662] Starting subtest: fbc-pr-overlay-plane-move-continuous-sf
[379.411957] Subtest fbc-pr-overlay-plane-move-continuous-sf: SKIP (0.000s)
[379.479045] [119/133] (643s left) gem_mmap_gtt (hang-user)
[379.528558] Subtest hang-user: SKIP (0.000s)
[379.585926] [120/133] (643s left) gem_ctx_persistence (legacy-engines-persistence)
[379.652225] Starting subtest: legacy-engines-persistence
[379.654374] Starting dynamic subtest: render
[380.441934] Dynamic subtest render: SUCCESS (0.791s)
[380.454676] Starting dynamic subtest: bsd1
[381.199793] Dynamic subtest bsd1: SUCCESS (0.755s)
[381.214430] Starting dynamic subtest: bsd2
[381.972072] Dynamic subtest bsd2: SUCCESS (0.769s)
[381.984167] Starting dynamic subtest: blt
[382.715851] Dynamic subtest blt: SUCCESS (0.741s)
[382.727211] Starting dynamic subtest: vebox
[383.485170] Dynamic subtest vebox: SUCCESS (0.767s)
[383.487665] Subtest legacy-engines-persistence: SUCCESS (3.836s)
[383.636707] [121/133] (639s left) gem_exec_fence (syncobj-unused-fence)
[384.112615] Starting subtest: syncobj-unused-fence
[384.117575] Subtest syncobj-unused-fence: SUCCESS (0.008s)
[386.003529] [122/133] (636s left) kms_plane_scaling (planes-upscale-20x20)
[386.107537] Starting subtest: planes-upscale-20x20
[386.110210] Starting dynamic subtest: pipe-A
[386.166519] Dynamic subtest pipe-A: SUCCESS (0.062s)
[386.176562] Starting dynamic subtest: pipe-B
[387.276685] Dynamic subtest pipe-B: SUCCESS (1.109s)
[387.288341] Starting dynamic subtest: pipe-C
[388.381118] Dynamic subtest pipe-C: SUCCESS (1.103s)
[388.391394] Starting dynamic subtest: pipe-D
[389.509716] Dynamic subtest pipe-D: SUCCESS (1.128s)
[389.512060] Subtest planes-upscale-20x20: SUCCESS (3.407s)
[390.668788] [123/133] (632s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-blt)
[390.774664] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-blt
[390.778775] Subtest psr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[390.876784] [124/133] (632s left) kms_async_flips (alternate-sync-async-flip-atomic)
[390.969979] Starting subtest: alternate-sync-async-flip-atomic
[391.347960] Starting dynamic subtest: pipe-A-eDP-1
[394.156038] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.808s)
[394.546915] Starting dynamic subtest: pipe-B-eDP-1
[397.293153] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.754s)
[397.674120] Starting dynamic subtest: pipe-C-eDP-1
[400.426075] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.759s)
[400.794658] Starting dynamic subtest: pipe-D-eDP-1
[403.552998] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.766s)
[403.555028] Subtest alternate-sync-async-flip-atomic: SUCCESS (12.586s)
[404.743471] [125/133] (618s left) kms_cursor_crc (cursor-onscreen-256x85)
[405.026761] Starting subtest: cursor-onscreen-256x85
[405.073099] Subtest cursor-onscreen-256x85: SKIP (0.040s)
[405.250768] [126/133] (617s left) gem_render_copy (y-tiled-ccs-to-y-tiled-mc-ccs)
[405.304731] Starting subtest: y-tiled-ccs-to-y-tiled-mc-ccs
[405.309267] Subtest y-tiled-ccs-to-y-tiled-mc-ccs: SKIP (0.000s)
[405.489952] [127/133] (617s left) gem_userptr_blits (unsync-unmap)
[405.570923] Subtest unsync-unmap: SKIP (0.000s)
[405.701986] [128/133] (617s left) kms_cursor_legacy (basic-busy-flip-before-cursor-varying-size)
[405.822703] Starting subtest: basic-busy-flip-before-cursor-varying-size
[405.827342] Subtest basic-busy-flip-before-cursor-varying-size: SKIP (0.000s)
[405.981762] [129/133] (617s left) gem_wait (busy)
[406.048660] Starting subtest: busy
[406.051304] Starting dynamic subtest: all-engines
[407.894182] Dynamic subtest all-engines: SUCCESS (1.843s)
[407.907314] Starting dynamic subtest: rcs0
[408.436527] Dynamic subtest rcs0: SUCCESS (0.541s)
[408.449834] Starting dynamic subtest: bcs0
[408.977636] Dynamic subtest bcs0: SUCCESS (0.540s)
[408.988969] Starting dynamic subtest: vcs0
[410.901791] Dynamic subtest vcs0: SUCCESS (1.920s)
[410.913502] Starting dynamic subtest: vcs1
[412.886646] Dynamic subtest vcs1: SUCCESS (1.982s)
[412.898941] Starting dynamic subtest: vecs0
[414.933735] Dynamic subtest vecs0: SUCCESS (2.044s)
[414.946865] Starting dynamic subtest: ccs0
[415.475656] Dynamic subtest ccs0: SUCCESS (0.540s)
[415.479042] Subtest busy: SUCCESS (9.427s)
[415.690270] [130/133] (607s left) kms_content_protection (content-type-change)
[415.833907] Starting subtest: content-type-change
[415.838573] Subtest content-type-change: SKIP (0.000s)
[415.951778] [131/133] (607s left) i915_pm_freq_api (freq-reset-multiple)
[416.022481] Starting subtest: freq-reset-multiple
[416.024895] Starting dynamic subtest: gt0
[424.711900] Dynamic subtest gt0: SUCCESS (8.686s)
[424.721628] Starting dynamic subtest: gt1
[432.155306] Dynamic subtest gt1: SUCCESS (7.443s)
[432.158588] Subtest freq-reset-multiple: SUCCESS (16.132s)
[432.249807] [132/133] (590s left) perf (low-oa-exponent-permissions)
[432.362101] Starting subtest: low-oa-exponent-permissions
[432.396593] Subtest low-oa-exponent-permissions: SUCCESS (0.037s)
[432.446792] [133/133] (590s left) kms_frontbuffer_tracking (fbc-tiling-4)
[432.552478] Starting subtest: fbc-tiling-4
[436.689558] Subtest fbc-tiling-4: SUCCESS (4.140s)
[437.812191] Closing watchdogs
results: parsing output: 0/ for test: i915_drm_fdinfo
results: parsing output: 1/ for test: gem_exec_params
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: api_intel_allocator
results: parsing output: 4/ for test: gem_partial_pwrite_pread
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: gen7_exec_parse
results: parsing output: 7/ for test: syncobj_wait
results: parsing output: 8/ for test: gem_exec_whisper
results: parsing output: 9/ for test: kms_universal_plane
results: parsing output: 10/ for test: kms_chamelium_color
results: parsing output: 11/ for test: gem_mmap_gtt
results: parsing output: 12/ for test: gem_exec_balancer
results: parsing output: 13/ for test: kms_frontbuffer_tracking
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: gem_exec_fence
results: parsing output: 17/ for test: kms_vblank
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: kms_addfb_basic
results: parsing output: 20/ for test: kms_psr2_sf
results: parsing output: 21/ for test: gem_exec_schedule
results: parsing output: 22/ for test: kms_chamelium_color
results: parsing output: 23/ for test: kms_prop_blob
results: parsing output: 24/ for test: kms_draw_crc
results: parsing output: 25/ for test: syncobj_timeline
results: parsing output: 26/ for test: kms_cursor_crc
results: parsing output: 27/ for test: sysfs_timeslice_duration
results: parsing output: 28/ for test: gem_create
results: parsing output: 29/ for test: kms_flip_scaled_crc
results: parsing output: 30/ for test: gem_mmap_gtt
results: parsing output: 31/ for test: i915_pm_rpm
results: parsing output: 32/ for test: core_debugfs
results: parsing output: 33/ for test: gem_render_copy
results: parsing output: 34/ for test: kms_color
results: parsing output: 35/ for test: kms_big_fb
results: parsing output: 36/ for test: kms_pipe_crc_basic
results: parsing output: 37/ for test: kms_psr
results: parsing output: 38/ for test: kms_pm_dc
results: parsing output: 39/ for test: syncobj_wait
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: kms_cursor_legacy
results: parsing output: 42/ for test: prime_vgem
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: kms_cursor_legacy
results: parsing output: 45/ for test: kms_plane
results: parsing output: 46/ for test: syncobj_wait
results: parsing output: 47/ for test: perf_pmu
results: parsing output: 48/ for test: kms_psr
results: parsing output: 49/ for test: kms_big_fb
results: parsing output: 50/ for test: gem_caching
results: parsing output: 51/ for test: kms_big_fb
results: parsing output: 52/ for test: kms_flip
results: parsing output: 53/ for test: kms_ccs
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_psr
results: parsing output: 56/ for test: gem_exec_gttfill
results: parsing output: 57/ for test: kms_flip_scaled_crc
results: parsing output: 58/ for test: kms_psr
results: parsing output: 59/ for test: gem_sync
results: parsing output: 60/ for test: gem_lmem_swapping
results: parsing output: 61/ for test: fbdev
results: parsing output: 62/ for test: kms_addfb_basic
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: kms_flip
results: parsing output: 66/ for test: syncobj_wait
results: parsing output: 67/ for test: dmabuf_sync_file
results: parsing output: 68/ for test: kms_panel_fitting
results: parsing output: 69/ for test: kms_chamelium_hpd
results: parsing output: 70/ for test: kms_invalid_mode
results: parsing output: 71/ for test: sw_sync
results: parsing output: 72/ for test: perf_pmu
results: parsing output: 73/ for test: gem_ctx_isolation
results: parsing output: 74/ for test: prime_busy
results: parsing output: 75/ for test: kms_async_flips
results: parsing output: 76/ for test: kms_cursor_legacy
results: parsing output: 77/ for test: kms_plane
results: parsing output: 78/ for test: kms_big_fb
results: parsing output: 79/ for test: gem_exec_capture
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: kms_ccs
results: parsing output: 82/ for test: kms_dither
results: parsing output: 83/ for test: kms_big_fb
results: parsing output: 84/ for test: gem_ctx_sseu
results: parsing output: 85/ for test: kms_psr
results: parsing output: 86/ for test: syncobj_wait
results: parsing output: 87/ for test: gem_pwrite
results: parsing output: 88/ for test: syncobj_timeline
results: parsing output: 89/ for test: gem_userptr_blits
results: parsing output: 90/ for test: gem_tiled_pread_pwrite
results: parsing output: 91/ for test: kms_legacy_colorkey
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_big_fb
results: parsing output: 94/ for test: syncobj_eventfd
results: parsing output: 95/ for test: kms_big_fb
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_cursor_legacy
results: parsing output: 98/ for test: gem_exec_schedule
results: parsing output: 99/ for test: syncobj_timeline
results: parsing output: 100/ for test: kms_plane
results: parsing output: 101/ for test: kms_getfb
results: parsing output: 102/ for test: kms_psr2_sf
results: parsing output: 103/ for test: i915_query
results: parsing output: 104/ for test: kms_ccs
results: parsing output: 105/ for test: i915_query
results: parsing output: 106/ for test: perf
results: parsing output: 107/ for test: gem_set_tiling_vs_gtt
results: parsing output: 108/ for test: gem_userptr_blits
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: gem_exec_reloc
results: parsing output: 111/ for test: kms_addfb_basic
results: parsing output: 112/ for test: gem_ppgtt
results: parsing output: 113/ for test: kms_ccs
results: parsing output: 114/ for test: syncobj_timeline
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: gem_softpin
results: parsing output: 117/ for test: kms_psr2_sf
results: parsing output: 118/ for test: gem_mmap_gtt
results: parsing output: 119/ for test: gem_ctx_persistence
results: parsing output: 120/ for test: gem_exec_fence
results: parsing output: 121/ for test: kms_plane_scaling
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: kms_async_flips
results: parsing output: 124/ for test: kms_cursor_crc
results: parsing output: 125/ for test: gem_render_copy
results: parsing output: 126/ for test: gem_userptr_blits
results: parsing output: 127/ for test: kms_cursor_legacy
results: parsing output: 128/ for test: gem_wait
results: parsing output: 129/ for test: kms_content_protection
results: parsing output: 130/ for test: i915_pm_freq_api
results: parsing output: 131/ for test: perf
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.