[60.890471] Initializing watchdogs
[60.890517]   /dev/watchdog0
[60.905491] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[60.910466] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[60.912662] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.914413] [001/133] (960s left) perf_pmu (busy-idle-no-semaphores)
[60.958415] Starting subtest: busy-idle-no-semaphores
[60.959363] Starting dynamic subtest: rcs0
[61.633325] Dynamic subtest rcs0: SUCCESS (0.666s)
[61.642065] Starting dynamic subtest: bcs0
[62.290255] Dynamic subtest bcs0: SUCCESS (0.655s)
[62.298851] Starting dynamic subtest: vcs0
[62.944267] Dynamic subtest vcs0: SUCCESS (0.653s)
[62.951275] Starting dynamic subtest: vcs1
[64.519408] Dynamic subtest vcs1: SUCCESS (1.574s)
[64.527630] Starting dynamic subtest: vecs0
[66.504983] Dynamic subtest vecs0: SUCCESS (1.985s)
[66.513541] Starting dynamic subtest: ccs0
[68.549743] Dynamic subtest ccs0: SUCCESS (2.045s)
[68.550958] Subtest busy-idle-no-semaphores: SUCCESS (7.586s)
[68.652846] [002/133] (952s left) kms_chamelium_frames (dp-crc-multiple)
[69.046912] Subtest dp-crc-multiple: SKIP (0.000s)
[69.830345] [003/133] (951s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-msflip-blt)
[69.926864] Starting subtest: fbcpsr-2p-primscrn-indfb-msflip-blt
[69.928552] Subtest fbcpsr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[70.035795] [004/133] (951s left) gem_create (create-clear)
[70.086130] Starting subtest: create-clear
[70.087145] Starting dynamic subtest: smem0
[103.024160] Dynamic subtest smem0: SUCCESS (32.942s)
[103.025134] Subtest create-clear: SUCCESS (32.942s)
[103.208066] [005/133] (918s left) kms_cursor_legacy (flip-vs-cursor-busy-crc-legacy)
[103.331922] Starting subtest: flip-vs-cursor-busy-crc-legacy
[104.204126] Subtest flip-vs-cursor-busy-crc-legacy: SUCCESS (0.872s)
[104.997409] [006/133] (916s left) kms_chamelium_audio (dp-audio-edid)
[105.378193] Subtest dp-audio-edid: SKIP (0.000s)
[106.201162] [007/133] (915s left) kms_cursor_crc (cursor-random-256x85)
[106.434648] Starting subtest: cursor-random-256x85
[106.481809] Subtest cursor-random-256x85: SKIP (0.046s)
[106.649507] [008/133] (914s left) kms_flip (nonexisting-fb)
[106.731073] Starting subtest: nonexisting-fb
[106.738210] Starting dynamic subtest: A-eDP1
[107.937494] Dynamic subtest A-eDP1: SUCCESS (1.205s)
[107.948251] Starting dynamic subtest: B-eDP1
[109.064326] Dynamic subtest B-eDP1: SUCCESS (1.126s)
[109.072112] Starting dynamic subtest: C-eDP1
[110.190359] Dynamic subtest C-eDP1: SUCCESS (1.125s)
[110.196698] Starting dynamic subtest: D-eDP1
[111.323642] Dynamic subtest D-eDP1: SUCCESS (1.132s)
[111.326552] Subtest nonexisting-fb: SUCCESS (4.596s)
[112.492059] [009/133] (909s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping)
[112.582827] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping
[112.584765] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s)
[112.660472] [010/133] (909s left) gem_exec_alignment (many)
[112.708903] Starting subtest: many
[137.104619] Subtest many: SUCCESS (24.349s)
[140.157673] [011/133] (881s left) gem_ccs (block-copy-compressed)
[140.255851] Starting subtest: block-copy-compressed
[140.257781] Subtest block-copy-compressed: SKIP (0.000s)
[140.358726] [012/133] (881s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-fully-sf)
[140.470719] Starting subtest: psr2-cursor-plane-move-continuous-exceed-fully-sf
[140.472349] Starting dynamic subtest: pipe-A-eDP-1
[151.489337] Dynamic subtest pipe-A-eDP-1: SUCCESS (11.016s)
[151.496857] Starting dynamic subtest: pipe-B-eDP-1
[163.200546] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.710s)
[163.201466] Subtest psr2-cursor-plane-move-continuous-exceed-fully-sf: SUCCESS (22.730s)
[164.052387] [013/133] (857s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[164.160381] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[164.996937] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SUCCESS (0.837s)
[165.161632] [014/133] (856s left) api_intel_allocator (two-level-inception-interruptible)
[165.213961] Starting subtest: two-level-inception-interruptible
[170.630231] Subtest two-level-inception-interruptible: SUCCESS (5.408s)
[170.759586] [015/133] (851s left) kms_atomic (crtc-invalid-params-fence)
[170.882905] Starting subtest: crtc-invalid-params-fence
[170.883856] Starting dynamic subtest: pipe-A-eDP-1
[171.294596] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.411s)
[171.295489] Subtest crtc-invalid-params-fence: SUCCESS (0.412s)
[172.089085] [016/133] (849s left) syncobj_timeline (etime-multi-wait-submitted)
[172.152484] Starting subtest: etime-multi-wait-submitted
[172.257316] Subtest etime-multi-wait-submitted: SUCCESS (0.104s)
[172.358699] [017/133] (849s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[172.458408] Starting subtest: addfb25-yf-tiled-legacy
[172.459476] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[172.564324] [018/133] (849s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[172.675143] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip
[172.676837] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[172.800096] [019/133] (849s left) gem_lmem_swapping (basic)
[172.854991] Subtest basic: SKIP (0.000s)
[172.894106] [020/133] (849s left) kms_pm_dc (dc6-psr)
[174.006685] Starting subtest: dc6-psr
[176.901906] Subtest dc6-psr: SUCCESS (2.895s)
[177.729353] [021/133] (844s left) gem_partial_pwrite_pread (reads)
[177.786951] Subtest reads: SKIP (0.000s)
[177.856180] [022/133] (844s left) gem_mmap_wc (pf-nonblock)
[177.903897] Subtest pf-nonblock: SKIP (0.000s)
[177.953227] [023/133] (844s left) gem_exec_reloc (basic-wc-noreloc)
[178.007046] Subtest basic-wc-noreloc: SKIP (0.000s)
[178.059516] [024/133] (844s left) perf (create-destroy-userspace-config)
[178.174662] Starting subtest: create-destroy-userspace-config
[178.192917] Subtest create-destroy-userspace-config: SUCCESS (0.019s)
[178.223476] [025/133] (843s left) gem_exec_flush (basic-uc-rw-default)
[178.275284] Starting subtest: basic-uc-rw-default
[183.729124] Subtest basic-uc-rw-default: SUCCESS (5.454s)
[183.904725] [026/133] (838s left) kms_prop_blob (blob-multiple)
[183.957012] Starting subtest: blob-multiple
[183.961898] Subtest blob-multiple: SUCCESS (0.005s)
[184.058850] [027/133] (838s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs)
[184.155264] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs
[184.156188] Starting dynamic subtest: pipe-A-eDP-1
[185.015905] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.858s)
[185.023611] Starting dynamic subtest: pipe-B-eDP-1
[186.555837] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.539s)
[186.564489] Starting dynamic subtest: pipe-C-eDP-1
[188.038388] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.482s)
[188.046025] Starting dynamic subtest: pipe-D-eDP-1
[189.574671] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.535s)
[189.575545] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs: SUCCESS (5.417s)
[190.747985] [028/133] (831s left) kms_fbcon_fbt (psr-suspend)
[190.802846] Starting subtest: psr-suspend
[241.833739] Subtest psr-suspend: SUCCESS (20.644s)
[242.878679] [029/133] (780s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt)
[242.975284] Starting subtest: psr-rgb565-draw-mmap-gtt
[242.976917] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[243.058641] [030/133] (780s left) gem_exec_fence (syncobj-timeline-unused-fence)
[243.645746] Starting subtest: syncobj-timeline-unused-fence
[243.647399] Subtest syncobj-timeline-unused-fence: SUCCESS (0.006s)
[245.299126] [FACT gem_exec_fence (syncobj-timeline-unused-fence)] new: kernel.kmod_is_loaded.vgem: true
[245.301198] [031/133] (778s left) gem_exec_reloc (basic-gtt-read)
[245.357295] Subtest basic-gtt-read: SKIP (0.000s)
[245.418846] [032/133] (778s left) gem_exec_whisper (basic-forked)
[245.471595] Starting subtest: basic-forked
[253.443476] Subtest basic-forked: SUCCESS (7.976s)
[253.623971] [033/133] (769s left) gem_exec_params (secure-non-root)
[253.681721] Starting subtest: secure-non-root
[253.683562] Subtest secure-non-root: SKIP (0.000s)
[253.772445] [034/133] (769s left) kms_psr2_sf (psr2-overlay-primary-update-sf-dmg-area)
[253.874884] Starting subtest: psr2-overlay-primary-update-sf-dmg-area
[253.875802] Starting dynamic subtest: pipe-A-eDP-1
[259.839876] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.968s)
[259.848492] Starting dynamic subtest: pipe-B-eDP-1
[266.502842] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.664s)
[266.503733] Subtest psr2-overlay-primary-update-sf-dmg-area: SUCCESS (12.634s)
[267.383569] [035/133] (756s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-render)
[267.474280] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-render
[274.406065] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-render: SUCCESS (6.923s)
[274.540961] [036/133] (749s left) gem_exec_reloc (basic-cpu-gtt-noreloc)
[274.602243] Subtest basic-cpu-gtt-noreloc: SKIP (0.000s)
[274.671561] [037/133] (748s left) kms_plane (pixel-format-x-tiled-modifier)
[274.762556] Starting subtest: pixel-format-x-tiled-modifier
[274.790226] Starting dynamic subtest: pipe-A-plane-0
[275.478817] Dynamic subtest pipe-A-plane-0: SUCCESS (0.689s)
[275.488589] Starting dynamic subtest: pipe-A-plane-3
[275.878739] Dynamic subtest pipe-A-plane-3: SUCCESS (0.399s)
[275.888494] Starting dynamic subtest: pipe-A-plane-5
[275.890294] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[276.993978] Starting dynamic subtest: pipe-B-plane-0
[277.630649] Dynamic subtest pipe-B-plane-0: SUCCESS (0.644s)
[277.639211] Starting dynamic subtest: pipe-B-plane-3
[278.030685] Dynamic subtest pipe-B-plane-3: SUCCESS (0.399s)
[278.039025] Starting dynamic subtest: pipe-B-plane-5
[278.040707] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[278.340076] Subtest pixel-format-x-tiled-modifier: SUCCESS (3.576s)
[279.164788] [038/133] (744s left) kms_psr_stress_test (flip-primary-invalidate-overlay)
[279.261511] Starting subtest: flip-primary-invalidate-overlay
[290.836471] Subtest flip-primary-invalidate-overlay: SUCCESS (11.573s)
[290.957971] [039/133] (732s left) syncobj_timeline (invalid-transfer-non-existent-point)
[291.011136] Starting subtest: invalid-transfer-non-existent-point
[291.011968] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[291.096142] [040/133] (732s left) gem_exec_balancer (bonded-semaphore)
[291.142580] Starting subtest: bonded-semaphore
[291.144318] Subtest bonded-semaphore: SKIP (0.000s)
[291.442396] [041/133] (732s left) gem_exec_fence (basic-wait-all)
[291.486786] Starting subtest: basic-wait-all
[291.578035] Subtest basic-wait-all: SUCCESS (0.091s)
[293.360745] [042/133] (730s left) kms_flip (plain-flip-ts-check-interruptible)
[293.452840] Starting subtest: plain-flip-ts-check-interruptible
[293.455034] Starting dynamic subtest: A-eDP1
[302.307076] Dynamic subtest A-eDP1: SUCCESS (8.828s)
[302.315570] Starting dynamic subtest: B-eDP1
[311.134481] Dynamic subtest B-eDP1: SUCCESS (8.825s)
[311.143806] Starting dynamic subtest: C-eDP1
[319.966683] Dynamic subtest C-eDP1: SUCCESS (8.824s)
[319.977291] Starting dynamic subtest: D-eDP1
[328.762158] Dynamic subtest D-eDP1: SUCCESS (8.828s)
[328.763694] Subtest plain-flip-ts-check-interruptible: SUCCESS (35.316s)
[329.917079] [043/133] (693s left) gem_mmap (short-mmap)
[329.966372] Subtest short-mmap: SKIP (0.000s)
[330.030896] [044/133] (693s left) syncobj_timeline (multi-wait-all-signaled)
[330.083379] Starting subtest: multi-wait-all-signaled
[330.084180] Subtest multi-wait-all-signaled: SUCCESS (0.001s)
[330.190359] [045/133] (693s left) kms_explicit_fence (multiplane-atomic-fence-wait)
[330.323811] Starting subtest: multiplane-atomic-fence-wait
[330.640796] Subtest multiplane-atomic-fence-wait: SUCCESS (0.317s)
[331.750264] [046/133] (692s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc)
[331.831066] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc
[331.831978] Starting dynamic subtest: pipe-A-eDP-1
[332.685464] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.851s)
[332.693907] Starting dynamic subtest: pipe-B-eDP-1
[334.347821] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.659s)
[334.356310] Starting dynamic subtest: pipe-C-eDP-1
[335.877084] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.531s)
[335.885354] Starting dynamic subtest: pipe-D-eDP-1
[337.412981] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.535s)
[337.413948] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.580s)
[338.591887] [047/133] (685s left) dmabuf_sync_file (export-wait-after-attach)
[338.637863] Starting subtest: export-wait-after-attach
[338.638750] Subtest export-wait-after-attach: SUCCESS (0.001s)
[338.692204] [048/133] (685s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[338.798700] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[338.800589] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[338.883116] [049/133] (685s left) gem_ctx_param (invalid-get-engines)
[338.927129] Starting subtest: invalid-get-engines
[338.928162] Subtest invalid-get-engines: SUCCESS (0.001s)
[339.020126] [050/133] (685s left) kms_color (invalid-gamma-lut-sizes)
[339.123649] Starting subtest: invalid-gamma-lut-sizes
[339.124610] Starting dynamic subtest: pipe-A
[339.421701] Dynamic subtest pipe-A: SUCCESS (0.298s)
[339.439043] Starting dynamic subtest: pipe-B
[339.439976] Dynamic subtest pipe-B: SUCCESS (0.001s)
[339.447630] Starting dynamic subtest: pipe-C
[339.448540] Dynamic subtest pipe-C: SUCCESS (0.000s)
[339.456341] Starting dynamic subtest: pipe-D
[339.457171] Dynamic subtest pipe-D: SUCCESS (0.000s)
[339.458119] Subtest invalid-gamma-lut-sizes: SUCCESS (0.304s)
[340.220749] [051/133] (683s left) kms_prime (basic-crc-vgem)
[340.317996] Starting subtest: basic-crc-vgem
[340.318820] Starting dynamic subtest: second-to-first
[341.323755] Dynamic subtest second-to-first: SUCCESS (1.006s)
[341.325868] Subtest basic-crc-vgem: SUCCESS (1.008s)
[341.427566] [052/133] (682s left) gem_render_copy (yf-tiled-to-vebox-y-tiled)
[341.512447] Starting subtest: yf-tiled-to-vebox-y-tiled
[341.514695] Subtest yf-tiled-to-vebox-y-tiled: SKIP (0.000s)
[341.694212] [053/133] (682s left) prime_vgem (basic-fence-mmap)
[341.757011] Starting subtest: basic-fence-mmap
[341.759105] Subtest basic-fence-mmap: SKIP (0.000s)
[341.870415] [054/133] (682s left) kms_rmfb (close-fd)
[341.976641] Starting subtest: close-fd
[341.977548] Starting dynamic subtest: pipe-A-eDP-1
[342.084883] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.107s)
[342.093983] Starting dynamic subtest: pipe-B-eDP-1
[343.295266] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.209s)
[343.305083] Starting dynamic subtest: pipe-C-eDP-1
[344.513468] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.217s)
[344.521902] Starting dynamic subtest: pipe-D-eDP-1
[345.644321] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.129s)
[345.645152] Subtest close-fd: SUCCESS (3.667s)
[346.859949] [055/133] (677s left) kms_cursor_crc (cursor-offscreen-512x512)
[347.126109] Starting subtest: cursor-offscreen-512x512
[347.127640] Subtest cursor-offscreen-512x512: SKIP (0.001s)
[347.270862] [056/133] (676s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[347.360527] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc
[347.362296] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[347.457210] [057/133] (676s left) kms_flip (2x-plain-flip-interruptible)
[347.554277] Starting subtest: 2x-plain-flip-interruptible
[347.564934] Subtest 2x-plain-flip-interruptible: SKIP (0.011s)
[347.637647] [058/133] (676s left) kms_psr (fbc-psr-sprite-plane-move)
[347.730602] Starting subtest: fbc-psr-sprite-plane-move
[347.731592] Starting dynamic subtest: eDP-1
[347.733470] Dynamic subtest eDP-1: SKIP (0.000s)
[347.735281] Subtest fbc-psr-sprite-plane-move: SKIP (0.001s)
[347.837255] [059/133] (676s left) gen9_exec_parse (bb-start-out)
[347.899510] Subtest bb-start-out: SKIP (0.000s)
[347.951187] [060/133] (676s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-pwrite)
[348.039545] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-pwrite
[348.041253] Subtest fbc-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[348.127987] [061/133] (676s left) kms_frontbuffer_tracking (fbcpsr-shrfb-scaledprimary)
[348.215576] Starting subtest: fbcpsr-shrfb-scaledprimary
[354.016671] Subtest fbcpsr-shrfb-scaledprimary: SUCCESS (5.800s)
[354.161609] [062/133] (670s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[354.249761] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[354.250701] Starting dynamic subtest: pipe-A-default-mode
[356.937687] Dynamic subtest pipe-A-default-mode: SUCCESS (2.686s)
[356.938567] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (2.688s)
[357.807208] [063/133] (666s left) gem_partial_pwrite_pread (writes-after-reads-snoop)
[357.864962] Subtest writes-after-reads-snoop: SKIP (0.000s)
[357.938984] [064/133] (666s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary)
[358.027123] Starting subtest: psr-shrfb-scaledprimary
[363.802513] Subtest psr-shrfb-scaledprimary: SUCCESS (5.775s)
[363.921160] [065/133] (660s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-plflip-blt)
[364.011660] Starting subtest: psr-2p-primscrn-indfb-plflip-blt
[364.013406] Subtest psr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[364.109122] [066/133] (660s left) kms_addfb_basic (invalid-set-prop-any)
[364.154357] Starting subtest: invalid-set-prop-any
[364.155273] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[364.287294] [067/133] (660s left) kms_psr (psr2-sprite-render)
[364.368915] Starting subtest: psr2-sprite-render
[364.369888] Starting dynamic subtest: eDP-1
[366.058699] Dynamic subtest eDP-1: SUCCESS (1.689s)
[366.059603] Subtest psr2-sprite-render: SUCCESS (1.690s)
[366.927322] [068/133] (657s left) sysfs_heartbeat_interval (invalid)
[366.980725] Starting subtest: invalid
[366.981754] Starting dynamic subtest: vecs0
[366.982898] Dynamic subtest vecs0: SUCCESS (0.000s)
[366.992719] Starting dynamic subtest: ccs0
[366.993645] Dynamic subtest ccs0: SUCCESS (0.000s)
[367.002155] Starting dynamic subtest: vcs0
[367.003038] Dynamic subtest vcs0: SUCCESS (0.000s)
[367.011018] Starting dynamic subtest: bcs0
[367.011955] Dynamic subtest bcs0: SUCCESS (0.000s)
[367.019933] Starting dynamic subtest: rcs0
[367.021140] Dynamic subtest rcs0: SUCCESS (0.000s)
[367.030101] Starting dynamic subtest: vcs1
[367.031095] Dynamic subtest vcs1: SUCCESS (0.000s)
[367.032079] Subtest invalid: SUCCESS (0.006s)
[367.062967] [069/133] (657s left) gem_mmap_gtt (cpuset-basic-small-copy-odd)
[367.114552] Subtest cpuset-basic-small-copy-odd: SKIP (0.000s)
[367.167186] [070/133] (657s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-blt)
[367.288331] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-blt
[371.053021] Subtest fbc-1p-primscrn-spr-indfb-draw-blt: SUCCESS (3.765s)
[372.245184] [071/133] (652s left) gem_userptr_blits (stress-mm-invalidate-close)
[372.303681] Starting subtest: stress-mm-invalidate-close
[374.498927] Subtest stress-mm-invalidate-close: SUCCESS (2.148s)
[374.573801] [072/133] (650s left) gem_eio (in-flight-contexts-immediate)
[374.827617] Starting subtest: in-flight-contexts-immediate
[388.285143] Subtest in-flight-contexts-immediate: SUCCESS (13.458s)
[388.446857] [073/133] (636s left) gem_mmap_gtt (basic-write-read)
[388.497967] Subtest basic-write-read: SKIP (0.000s)
[388.562638] [074/133] (636s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[388.656687] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip
[388.658433] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[388.748130] [075/133] (636s left) kms_dp_link_training (non-uhbr-sst)
[388.835506] Starting subtest: non-uhbr-sst
[388.838895] Subtest non-uhbr-sst: SKIP (0.000s)
[388.904912] [076/133] (636s left) kms_multipipe_modeset (basic-max-pipe-crc-check)
[389.006578] Starting subtest: basic-max-pipe-crc-check
[389.008304] Subtest basic-max-pipe-crc-check: SKIP (0.000s)
[389.050098] [077/133] (635s left) gem_exec_schedule (submit-golden-slice)
[389.104264] Starting subtest: submit-golden-slice
[389.105181] Starting dynamic subtest: rcs0
[389.146278] Dynamic subtest rcs0: SUCCESS (0.043s)
[389.155577] Starting dynamic subtest: bcs0
[389.183720] Dynamic subtest bcs0: SUCCESS (0.037s)
[389.193319] Starting dynamic subtest: vcs0
[389.219908] Dynamic subtest vcs0: SUCCESS (0.035s)
[389.229071] Starting dynamic subtest: vcs1
[389.256765] Dynamic subtest vcs1: SUCCESS (0.036s)
[389.272610] Starting dynamic subtest: vecs0
[389.294480] Dynamic subtest vecs0: SUCCESS (0.037s)
[389.305126] Starting dynamic subtest: ccs0
[389.333571] Dynamic subtest ccs0: SUCCESS (0.039s)
[389.334444] Subtest submit-golden-slice: SUCCESS (0.231s)
[390.325061] [078/133] (634s left) i915_query (test-query-geometry-subslices)
[390.372798] Starting subtest: test-query-geometry-subslices
[390.373683] Subtest test-query-geometry-subslices: SUCCESS (0.000s)
[390.461232] [079/133] (634s left) gem_mmap_gtt (basic-small-copy-xy)
[390.511085] Subtest basic-small-copy-XY: SKIP (0.000s)
[390.563314] [080/133] (634s left) kms_big_fb (linear-16bpp-rotate-180)
[390.661607] Starting subtest: linear-16bpp-rotate-180
[392.017609] Subtest linear-16bpp-rotate-180: SUCCESS (1.356s)
[392.126274] [081/133] (633s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render)
[392.214373] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render
[392.215929] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[392.304921] [082/133] (632s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[392.391701] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu
[398.997342] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.607s)
[399.119821] [083/133] (626s left) kms_plane (plane-panning-bottom-right)
[399.210685] Starting subtest: plane-panning-bottom-right
[399.211764] Starting dynamic subtest: pipe-A
[400.945901] Dynamic subtest pipe-A: SUCCESS (1.734s)
[400.957147] Starting dynamic subtest: pipe-B
[403.294379] Dynamic subtest pipe-B: SUCCESS (2.348s)
[403.295431] Subtest plane-panning-bottom-right: SUCCESS (4.086s)
[404.122628] [084/133] (621s left) kms_plane_scaling (planes-upscale-factor-0-25-downscale-factor-0-75)
[404.229446] Starting subtest: planes-upscale-factor-0-25-downscale-factor-0-75
[404.230286] Starting dynamic subtest: pipe-A
[404.250014] Dynamic subtest pipe-A: SKIP (0.018s)
[404.259973] Starting dynamic subtest: pipe-B
[404.281002] Dynamic subtest pipe-B: SKIP (0.031s)
[404.289731] Starting dynamic subtest: pipe-C
[404.314288] Dynamic subtest pipe-C: SKIP (0.032s)
[404.322922] Starting dynamic subtest: pipe-D
[404.346656] Dynamic subtest pipe-D: SKIP (0.032s)
[404.348139] Subtest planes-upscale-factor-0-25-downscale-factor-0-75: SKIP (0.116s)
[404.460589] [085/133] (620s left) syncobj_basic (test-valid-cycle)
[404.517191] Starting subtest: test-valid-cycle
[404.518195] Subtest test-valid-cycle: SUCCESS (0.000s)
[404.620649] [086/133] (620s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-pwrite)
[404.712054] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-pwrite
[412.107502] Subtest fbc-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (7.396s)
[413.243673] [087/133] (612s left) i915_drm_fdinfo (virtual-busy-all)
[413.279894] Starting subtest: virtual-busy-all
[413.281760] Subtest virtual-busy-all: SKIP (0.000s)
[413.350315] [088/133] (612s left) gem_userptr_blits (stress-purge)
[413.415044] Starting subtest: stress-purge
[418.809459] Subtest stress-purge: SUCCESS (5.394s)
[418.932558] [089/133] (606s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-submi
[419.037843] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-submitted
[419.141592] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-submitted: SUCCESS (0.103s)
[419.223375] [090/133] (606s left) sriov_basic (enable-vfs-autoprobe-on)
[419.277627] Starting subtest: enable-vfs-autoprobe-on
[419.278715] Starting dynamic subtest: numvfs-1
[419.312363] Dynamic subtest numvfs-1: FAIL (0.015s)
[419.322438] Starting dynamic subtest: numvfs-2
[419.347822] Dynamic subtest numvfs-2: FAIL (0.004s)
[419.356722] Starting dynamic subtest: numvfs-3
[419.382590] Dynamic subtest numvfs-3: FAIL (0.004s)
[419.391147] Starting dynamic subtest: numvfs-4
[419.417115] Dynamic subtest numvfs-4: FAIL (0.004s)
[419.425743] Starting dynamic subtest: numvfs-5
[419.452140] Dynamic subtest numvfs-5: FAIL (0.004s)
[419.460354] Starting dynamic subtest: numvfs-6
[419.486151] Dynamic subtest numvfs-6: FAIL (0.004s)
[419.494390] Starting dynamic subtest: numvfs-7
[419.528598] Dynamic subtest numvfs-7: FAIL (0.004s)
[419.536987] Starting dynamic subtest: numvfs-random
[419.562654] Dynamic subtest numvfs-random: FAIL (0.004s)
[419.570802] Starting dynamic subtest: numvfs-all
[419.596580] Dynamic subtest numvfs-all: FAIL (0.004s)
[419.597401] Subtest enable-vfs-autoprobe-on: FAIL (0.050s)
[419.627755] [091/133] (605s left) kms_vblank (ts-continuation-suspend)
[419.718257] Starting subtest: ts-continuation-suspend
[419.719133] Starting dynamic subtest: pipe-A-eDP-1
[437.050723] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.948s)
[437.062848] Starting dynamic subtest: pipe-D-eDP-1
[455.058175] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.581s)
[455.059424] Subtest ts-continuation-suspend: SUCCESS (4.532s)
[461.903449] [092/133] (569s left) gem_pxp (reject-modify-context-protection-on)
[462.054251] Starting subtest: reject-modify-context-protection-on
[462.055582] Subtest reject-modify-context-protection-on: SUCCESS (0.002s)
[462.156644] [093/133] (569s left) kms_cursor_legacy (cursor-vs-flip-varying-size)
[462.269569] Starting subtest: cursor-vs-flip-varying-size
[493.770915] Subtest cursor-vs-flip-varying-size: SUCCESS (31.527s)
[494.566280] [094/133] (537s left) kms_big_fb (x-tiled-64bpp-rotate-270)
[494.673590] Starting subtest: x-tiled-64bpp-rotate-270
[494.692914] Subtest x-tiled-64bpp-rotate-270: SKIP (0.019s)
[494.797826] [095/133] (536s left) kms_atomic_interruptible (legacy-cursor)
[494.890596] Starting subtest: legacy-cursor
[494.892039] Starting dynamic subtest: pipe-A-eDP-1
[502.297401] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.403s)
[502.298864] Subtest legacy-cursor: SUCCESS (7.404s)
[503.157141] [096/133] (528s left) gem_userptr_blits (unsync-unmap-after-close)
[503.208692] Subtest unsync-unmap-after-close: SKIP (0.000s)
[503.322036] [097/133] (528s left) kms_content_protection (dp-mst-type-0-suspend-resume)
[503.457541] Starting subtest: dp-mst-type-0-suspend-resume
[503.460082] Subtest dp-mst-type-0-suspend-resume: SKIP (0.000s)
[503.561578] [098/133] (528s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs-cc)
[503.643403] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs-cc
[503.644669] Starting dynamic subtest: pipe-A-eDP-1
[503.654416] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[503.665922] Starting dynamic subtest: pipe-B-eDP-1
[503.675902] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[503.684568] Starting dynamic subtest: pipe-C-eDP-1
[503.694103] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[503.703112] Starting dynamic subtest: pipe-D-eDP-1
[503.713113] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[503.714965] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.005s)
[505.905502] [099/133] (525s left) kms_ccs (missing-ccs-buffer-yf-tiled-ccs)
[506.000723] Starting subtest: missing-ccs-buffer-yf-tiled-ccs
[506.002159] Starting dynamic subtest: pipe-A-eDP-1
[506.012078] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[506.021434] Starting dynamic subtest: pipe-B-eDP-1
[506.031701] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[506.040801] Starting dynamic subtest: pipe-C-eDP-1
[506.049710] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[506.058293] Starting dynamic subtest: pipe-D-eDP-1
[506.068132] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[506.069992] Subtest missing-ccs-buffer-yf-tiled-ccs: SKIP (0.004s)
[508.208957] [100/133] (523s left) gem_exec_balancer (parallel-dmabuf-import-out-fence)
[508.469368] Starting subtest: parallel-dmabuf-import-out-fence
[509.845802] Subtest parallel-dmabuf-import-out-fence: SUCCESS (1.376s)
[509.938454] [101/133] (521s left) gem_render_copy_redux (flink)
[510.003222] Starting subtest: flink
[510.913866] Subtest flink: SUCCESS (0.910s)
[511.023997] [102/133] (520s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt)
[511.116180] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt
[511.118128] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[511.195015] [103/133] (520s left) kms_big_fb (4-tiled-addfb-size-offset-overflow)
[511.289238] Starting subtest: 4-tiled-addfb-size-offset-overflow
[511.290428] Subtest 4-tiled-addfb-size-offset-overflow: SUCCESS (0.000s)
[511.394523] [104/133] (520s left) i915_pm_rpm (gem-idle)
[513.227357] Starting subtest: gem-idle
[519.423251] Subtest gem-idle: SUCCESS (6.197s)
[519.756932] [105/133] (512s left) gem_exec_schedule (pi-distinct-iova)
[521.118919] Starting subtest: pi-distinct-iova
[521.120163] Starting dynamic subtest: rcs0
[521.212436] Dynamic subtest rcs0: SUCCESS (0.094s)
[521.222230] Starting dynamic subtest: vcs0
[521.273295] Dynamic subtest vcs0: SUCCESS (0.060s)
[521.285979] Starting dynamic subtest: vcs1
[521.325711] Dynamic subtest vcs1: SUCCESS (0.052s)
[521.338884] Starting dynamic subtest: vecs0
[521.383169] Dynamic subtest vecs0: SUCCESS (0.057s)
[521.396213] Starting dynamic subtest: ccs0
[521.445040] Dynamic subtest ccs0: SUCCESS (0.060s)
[521.446380] Subtest pi-distinct-iova: SUCCESS (0.328s)
[523.168500] [106/133] (508s left) gem_ctx_param (get-priority-new-ctx)
[523.222539] Starting subtest: get-priority-new-ctx
[523.225547] Subtest get-priority-new-ctx: SUCCESS (0.002s)
[523.318561] [107/133] (508s left) kms_addfb_basic (invalid-get-prop)
[523.368323] Starting subtest: invalid-get-prop
[523.369708] Subtest invalid-get-prop: SUCCESS (0.000s)
[523.489058] [108/133] (508s left) gem_exec_params (no-blt)
[523.543360] Starting subtest: no-blt
[523.547090] Subtest no-blt: SUCCESS (0.003s)
[523.654676] [109/133] (508s left) gem_mmap_offset (bad-flags)
[523.700097] Starting subtest: bad-flags
[523.701466] Subtest bad-flags: SUCCESS (0.000s)
[523.779909] [110/133] (508s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions)
[523.888068] Starting subtest: flip-vs-cursor-atomic-transitions
[531.872955] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (7.987s)
[532.691592] [111/133] (499s left) kms_flip (absolute-wf_vblank-interruptible)
[532.790796] Starting subtest: absolute-wf_vblank-interruptible
[532.793421] Starting dynamic subtest: A-eDP1
[541.582193] Dynamic subtest A-eDP1: SUCCESS (8.764s)
[541.596557] Starting dynamic subtest: B-eDP1
[550.305985] Dynamic subtest B-eDP1: SUCCESS (8.722s)
[550.317337] Starting dynamic subtest: C-eDP1
[559.039419] Dynamic subtest C-eDP1: SUCCESS (8.723s)
[559.050228] Starting dynamic subtest: D-eDP1
[567.737296] Dynamic subtest D-eDP1: SUCCESS (8.729s)
[567.741036] Subtest absolute-wf_vblank-interruptible: SUCCESS (34.950s)
[568.954144] [112/133] (463s left) gem_spin_batch (legacy)
[569.015286] Starting subtest: legacy
[569.024877] Starting dynamic subtest: default
[572.264260] Dynamic subtest default: SUCCESS (3.236s)
[572.277450] Starting dynamic subtest: render
[575.539871] Dynamic subtest render: SUCCESS (3.234s)
[575.551796] Starting dynamic subtest: bsd
[578.780432] Dynamic subtest bsd: SUCCESS (3.237s)
[578.792824] Starting dynamic subtest: bsd1
[582.013717] Dynamic subtest bsd1: SUCCESS (3.229s)
[582.025801] Starting dynamic subtest: bsd2
[585.253292] Dynamic subtest bsd2: SUCCESS (3.236s)
[585.265540] Starting dynamic subtest: blt
[588.493593] Dynamic subtest blt: SUCCESS (3.237s)
[588.505790] Starting dynamic subtest: vebox
[591.727300] Dynamic subtest vebox: SUCCESS (3.230s)
[591.729163] Subtest legacy: SUCCESS (22.662s)
[592.156592] [113/133] (440s left) api_intel_bb (offset-control)
[592.216467] Starting subtest: offset-control
[592.228145] Subtest offset-control: SUCCESS (0.013s)
[592.318051] [114/133] (440s left) kms_atomic_transition (plane-all-modeset-transition-fencing)
[592.427284] Starting subtest: plane-all-modeset-transition-fencing
[592.429324] Subtest plane-all-modeset-transition-fencing: SKIP (0.000s)
[592.507939] [115/133] (439s left) i915_hangman (engine-engine-error)
[592.570570] Starting subtest: engine-engine-error
[592.572153] Starting dynamic subtest: rcs0
[594.027013] Dynamic subtest rcs0: SUCCESS (1.447s)
[594.039857] Starting dynamic subtest: bcs0
[596.073838] Dynamic subtest bcs0: SUCCESS (2.044s)
[596.083421] Starting dynamic subtest: vcs0
[597.993200] Dynamic subtest vcs0: SUCCESS (1.916s)
[598.005345] Starting dynamic subtest: vcs1
[599.080946] Dynamic subtest vcs1: SUCCESS (1.084s)
[599.093269] Starting dynamic subtest: vecs0
[601.064987] Dynamic subtest vecs0: SUCCESS (1.981s)
[601.077417] Starting dynamic subtest: ccs0
[603.050102] Dynamic subtest ccs0: SUCCESS (1.982s)
[603.051436] Subtest engine-engine-error: SUCCESS (10.473s)
[603.146815] [116/133] (429s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-blt)
[603.241819] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-blt
[603.243805] Subtest fbc-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s)
[603.349486] [117/133] (429s left) syncobj_wait (invalid-signal-bad-pad)
[603.403228] Starting subtest: invalid-signal-bad-pad
[603.404463] Subtest invalid-signal-bad-pad: SUCCESS (0.000s)
[603.500428] [118/133] (429s left) syncobj_timeline (single-wait-all-available-submitted)
[603.545185] Starting subtest: single-wait-all-available-submitted
[603.546570] Subtest single-wait-all-available-submitted: SUCCESS (0.000s)
[603.641054] [119/133] (428s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[603.723101] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[611.056564] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.335s)
[611.177389] [120/133] (421s left) kms_cursor_crc (cursor-tearing-position-change)
[611.291314] Starting subtest: cursor-tearing-position-change
[611.292585] Starting dynamic subtest: pipe-A-eDP-1
[611.882235] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.591s)
[611.896914] Starting dynamic subtest: pipe-D-eDP-1
[613.131502] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.247s)
[613.133378] Subtest cursor-tearing-position-change: SUCCESS (1.840s)
[613.968784] [121/133] (418s left) kms_sequence (get-forked)
[614.062029] Starting subtest: get-forked
[614.063180] Starting dynamic subtest: pipe-A-eDP-1
[615.943090] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.881s)
[615.958288] Starting dynamic subtest: pipe-B-eDP-1
[618.561571] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.618s)
[618.571595] Starting dynamic subtest: pipe-C-eDP-1
[621.115867] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.553s)
[621.125213] Starting dynamic subtest: pipe-D-eDP-1
[623.642668] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.525s)
[623.643993] Subtest get-forked: SUCCESS (9.583s)
[624.477879] [122/133] (408s left) perf (gen12-group-concurrent-oa-buffer-read)
[624.580236] Starting subtest: gen12-group-concurrent-oa-buffer-read
[634.634456] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.049s)
[634.676653] [123/133] (398s left) kms_frontbuffer_tracking (fbc-1p-rte)
[634.775841] Starting subtest: fbc-1p-rte
[640.291544] Subtest fbc-1p-rte: SUCCESS (5.518s)
[641.492941] [124/133] (391s left) gem_exec_reloc (basic-wc-read)
[641.546756] Subtest basic-wc-read: SKIP (0.000s)
[641.617947] [125/133] (391s left) kms_chamelium_hpd (hdmi-hpd-fast)
[641.992173] Subtest hdmi-hpd-fast: SKIP (0.000s)
[642.786938] [126/133] (390s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-downscaling)
[642.875430] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-downscaling
[642.876479] Starting dynamic subtest: pipe-A-default-mode
[644.069413] Dynamic subtest pipe-A-default-mode: SKIP (1.192s)
[644.071801] Subtest flip-32bpp-xtile-to-64bpp-xtile-downscaling: SKIP (1.193s)
[644.212280] [127/133] (388s left) kms_lease (empty-lease)
[644.312719] Starting subtest: empty-lease
[644.313561] Starting dynamic subtest: pipe-A-eDP-1
[644.314374] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[644.325210] Starting dynamic subtest: pipe-B-eDP-1
[644.326194] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[644.334953] Starting dynamic subtest: pipe-C-eDP-1
[644.335984] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[644.344852] Starting dynamic subtest: pipe-D-eDP-1
[644.345761] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[644.346645] Subtest empty-lease: SUCCESS (0.009s)
[644.422784] [128/133] (388s left) kms_psr (pr-dpms)
[644.512429] Starting subtest: pr-dpms
[644.514728] Subtest pr-dpms: SKIP (0.000s)
[644.595555] [129/133] (388s left) kms_getfb (getfb2-accept-nv12)
[644.686349] Starting subtest: getfb2-accept-nv12
[644.687375] Subtest getfb2-accept-nv12: SUCCESS (0.001s)
[644.798449] [130/133] (388s left) kms_psr (fbc-pr-sprite-plane-onoff)
[644.886340] Starting subtest: fbc-pr-sprite-plane-onoff
[644.888264] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s)
[644.959676] [131/133] (388s left) gem_exec_fence (keep-in-fence)
[645.125528] Starting subtest: keep-in-fence
[645.127161] Starting dynamic subtest: rcs0
[645.181456] Dynamic subtest rcs0: SUCCESS (0.055s)
[645.195288] Starting dynamic subtest: bcs0
[645.237186] Dynamic subtest bcs0: SUCCESS (0.053s)
[645.254742] Starting dynamic subtest: vcs0
[647.052041] Dynamic subtest vcs0: SUCCESS (1.804s)
[647.064302] Starting dynamic subtest: vcs1
[649.099714] Dynamic subtest vcs1: SUCCESS (2.045s)
[649.111110] Starting dynamic subtest: vecs0
[651.083730] Dynamic subtest vecs0: SUCCESS (1.982s)
[651.096065] Starting dynamic subtest: ccs0
[651.298675] Dynamic subtest ccs0: SUCCESS (0.221s)
[651.300318] Subtest keep-in-fence: SUCCESS (6.176s)
[653.149196] [132/133] (379s left) kms_invalid_mode (bad-hsync-start)
[653.245168] Starting subtest: bad-hsync-start
[653.246584] Starting dynamic subtest: pipe-A-eDP-1
[653.528893] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s)
[653.540405] Starting dynamic subtest: pipe-B-eDP-1
[653.541658] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[653.550950] Starting dynamic subtest: pipe-C-eDP-1
[653.551937] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[653.561069] Starting dynamic subtest: pipe-D-eDP-1
[653.562158] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[653.563187] Subtest bad-hsync-start: SUCCESS (0.291s)
[654.354312] [133/133] (378s left) gem_ctx_persistence (heartbeat-hang)
[654.413951] Starting subtest: heartbeat-hang
[654.416718] Subtest heartbeat-hang: SKIP (0.000s)
[654.513984] Closing watchdogs
results: parsing output: 0/ for test: perf_pmu
results: parsing output: 1/ for test: kms_chamelium_frames
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: gem_create
results: parsing output: 4/ for test: kms_cursor_legacy
results: parsing output: 5/ for test: kms_chamelium_audio
results: parsing output: 6/ for test: kms_cursor_crc
results: parsing output: 7/ for test: kms_flip
results: parsing output: 8/ for test: kms_plane
results: parsing output: 9/ for test: gem_exec_alignment
results: parsing output: 10/ for test: gem_ccs
results: parsing output: 11/ for test: kms_psr2_sf
results: parsing output: 12/ for test: kms_big_fb
results: parsing output: 13/ for test: api_intel_allocator
results: parsing output: 14/ for test: kms_atomic
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: kms_addfb_basic
results: parsing output: 17/ for test: kms_big_fb
results: parsing output: 18/ for test: gem_lmem_swapping
results: parsing output: 19/ for test: kms_pm_dc
results: parsing output: 20/ for test: gem_partial_pwrite_pread
results: parsing output: 21/ for test: gem_mmap_wc
results: parsing output: 22/ for test: gem_exec_reloc
results: parsing output: 23/ for test: perf
results: parsing output: 24/ for test: gem_exec_flush
results: parsing output: 25/ for test: kms_prop_blob
results: parsing output: 26/ for test: kms_ccs
results: parsing output: 27/ for test: kms_fbcon_fbt
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: gem_exec_fence
results: parsing output: 30/ for test: gem_exec_reloc
results: parsing output: 31/ for test: gem_exec_whisper
results: parsing output: 32/ for test: gem_exec_params
results: parsing output: 33/ for test: kms_psr2_sf
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: gem_exec_reloc
results: parsing output: 36/ for test: kms_plane
results: parsing output: 37/ for test: kms_psr_stress_test
results: parsing output: 38/ for test: syncobj_timeline
results: parsing output: 39/ for test: gem_exec_balancer
results: parsing output: 40/ for test: gem_exec_fence
results: parsing output: 41/ for test: kms_flip
results: parsing output: 42/ for test: gem_mmap
results: parsing output: 43/ for test: syncobj_timeline
results: parsing output: 44/ for test: kms_explicit_fence
results: parsing output: 45/ for test: kms_ccs
results: parsing output: 46/ for test: dmabuf_sync_file
results: parsing output: 47/ for test: kms_big_fb
results: parsing output: 48/ for test: gem_ctx_param
results: parsing output: 49/ for test: kms_color
results: parsing output: 50/ for test: kms_prime
results: parsing output: 51/ for test: gem_render_copy
results: parsing output: 52/ for test: prime_vgem
results: parsing output: 53/ for test: kms_rmfb
results: parsing output: 54/ for test: kms_cursor_crc
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: kms_flip
results: parsing output: 57/ for test: kms_psr
results: parsing output: 58/ for test: gen9_exec_parse
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: kms_flip_scaled_crc
results: parsing output: 62/ for test: gem_partial_pwrite_pread
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_addfb_basic
results: parsing output: 66/ for test: kms_psr
results: parsing output: 67/ for test: sysfs_heartbeat_interval
results: parsing output: 68/ for test: gem_mmap_gtt
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: gem_userptr_blits
results: parsing output: 71/ for test: gem_eio
results: parsing output: 72/ for test: gem_mmap_gtt
results: parsing output: 73/ for test: kms_big_fb
results: parsing output: 74/ for test: kms_dp_link_training
results: parsing output: 75/ for test: kms_multipipe_modeset
results: parsing output: 76/ for test: gem_exec_schedule
results: parsing output: 77/ for test: i915_query
results: parsing output: 78/ for test: gem_mmap_gtt
results: parsing output: 79/ for test: kms_big_fb
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_plane
results: parsing output: 83/ for test: kms_plane_scaling
results: parsing output: 84/ for test: syncobj_basic
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: i915_drm_fdinfo
results: parsing output: 87/ for test: gem_userptr_blits
results: parsing output: 88/ for test: syncobj_timeline
results: parsing output: 89/ for test: sriov_basic
results: parsing output: 90/ for test: kms_vblank
results: parsing output: 91/ for test: gem_pxp
results: parsing output: 92/ for test: kms_cursor_legacy
results: parsing output: 93/ for test: kms_big_fb
results: parsing output: 94/ for test: kms_atomic_interruptible
results: parsing output: 95/ for test: gem_userptr_blits
results: parsing output: 96/ for test: kms_content_protection
results: parsing output: 97/ for test: kms_ccs
results: parsing output: 98/ for test: kms_ccs
results: parsing output: 99/ for test: gem_exec_balancer
results: parsing output: 100/ for test: gem_render_copy_redux
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_big_fb
results: parsing output: 103/ for test: i915_pm_rpm
results: parsing output: 104/ for test: gem_exec_schedule
results: parsing output: 105/ for test: gem_ctx_param
results: parsing output: 106/ for test: kms_addfb_basic
results: parsing output: 107/ for test: gem_exec_params
results: parsing output: 108/ for test: gem_mmap_offset
results: parsing output: 109/ for test: kms_cursor_legacy
results: parsing output: 110/ for test: kms_flip
results: parsing output: 111/ for test: gem_spin_batch
results: parsing output: 112/ for test: api_intel_bb
results: parsing output: 113/ for test: kms_atomic_transition
results: parsing output: 114/ for test: i915_hangman
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: syncobj_wait
results: parsing output: 117/ for test: syncobj_timeline
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_cursor_crc
results: parsing output: 120/ for test: kms_sequence
results: parsing output: 121/ for test: perf
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: gem_exec_reloc
results: parsing output: 124/ for test: kms_chamelium_hpd
results: parsing output: 125/ for test: kms_flip_scaled_crc
results: parsing output: 126/ for test: kms_lease
results: parsing output: 127/ for test: kms_psr
results: parsing output: 128/ for test: kms_getfb
results: parsing output: 129/ for test: kms_psr
results: parsing output: 130/ for test: gem_exec_fence
results: parsing output: 131/ for test: kms_invalid_mode
results: parsing output: 132/ for test: gem_ctx_persistence
Done.