[59.157911] Initializing watchdogs
[59.157960]   /dev/watchdog0
[59.183327] [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]
[59.187815] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.190033] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.192201] [001/131] (960s left) kms_ccs (missing-ccs-buffer-yf-tiled-ccs)
[59.299127] Starting subtest: missing-ccs-buffer-yf-tiled-ccs
[59.300232] Starting dynamic subtest: pipe-A-eDP-1
[59.310100] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[59.317153] Starting dynamic subtest: pipe-B-eDP-1
[59.325885] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[59.331101] Starting dynamic subtest: pipe-C-eDP-1
[59.339536] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[59.344628] Starting dynamic subtest: pipe-D-eDP-1
[59.352816] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[59.354515] Subtest missing-ccs-buffer-yf-tiled-ccs: SKIP (0.003s)
[61.570815] [002/131] (958s left) kms_content_protection (dp-mst-suspend-resume)
[61.707534] Starting subtest: dp-mst-suspend-resume
[61.709607] Subtest dp-mst-suspend-resume: SKIP (0.000s)
[61.861645] [003/131] (957s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[61.955984] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu
[68.638882] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (6.689s)
[68.780989] [004/131] (951s left) gem_exec_params (invalid-bsd2-flag-on-blt)
[68.835852] Starting subtest: invalid-bsd2-flag-on-blt
[68.836880] Subtest invalid-bsd2-flag-on-blt: SUCCESS (0.000s)
[68.962577] [005/131] (950s left) gem_spin_batch (resubmit-new)
[69.019243] Starting subtest: resubmit-new
[69.020319] Starting dynamic subtest: rcs0
[69.026217] Dynamic subtest rcs0: SUCCESS (0.008s)
[69.033878] Starting dynamic subtest: bcs0
[69.034813] Dynamic subtest bcs0: SUCCESS (0.004s)
[69.040485] Starting dynamic subtest: vcs0
[69.041424] Dynamic subtest vcs0: SUCCESS (0.005s)
[69.047034] Starting dynamic subtest: vcs1
[69.048088] Dynamic subtest vcs1: SUCCESS (0.004s)
[69.053624] Starting dynamic subtest: vecs0
[69.054540] Dynamic subtest vecs0: SUCCESS (0.004s)
[69.059966] Starting dynamic subtest: ccs0
[69.060932] Dynamic subtest ccs0: SUCCESS (0.003s)
[69.061864] Subtest resubmit-new: SUCCESS (0.029s)
[70.986235] [006/131] (948s left) gem_exec_balancer (individual)
[71.046367] Starting subtest: individual
[72.903828] Subtest individual: SUCCESS (1.855s)
[73.264055] [007/131] (946s left) gem_eio (context-create)
[73.432159] Starting subtest: context-create
[73.657040] Subtest context-create: SUCCESS (0.225s)
[73.838916] [008/131] (946s left) kms_frontbuffer_tracking (fbcpsr-2p-indfb-fliptrack-mmap-gtt)
[73.933763] Starting subtest: fbcpsr-2p-indfb-fliptrack-mmap-gtt
[73.935543] Subtest fbcpsr-2p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[74.077736] [009/131] (945s left) kms_flip (2x-plain-flip-fb-recreate-interruptible)
[74.168711] Starting subtest: 2x-plain-flip-fb-recreate-interruptible
[74.180627] Subtest 2x-plain-flip-fb-recreate-interruptible: SKIP (0.011s)
[74.283947] [010/131] (945s left) i915_drm_fdinfo (memory-info-active)
[74.320083] Starting subtest: memory-info-active
[74.321173] Starting dynamic subtest: smem0
[76.795085] Dynamic subtest smem0: SUCCESS (2.475s)
[76.796365] Subtest memory-info-active: SUCCESS (2.476s)
[76.882783] [011/131] (943s left) gem_exec_params (invalid-bsd1-flag-on-vebox)
[76.934210] Starting subtest: invalid-bsd1-flag-on-vebox
[76.935251] Subtest invalid-bsd1-flag-on-vebox: SUCCESS (0.000s)
[77.070320] [012/131] (942s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-wc)
[77.168656] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-wc
[77.170420] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[77.293915] [013/131] (942s left) kms_lease (multimaster-lease)
[77.377147] Starting subtest: multimaster-lease
[77.380605] Subtest multimaster-lease: SUCCESS (0.004s)
[77.512593] [014/131] (942s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-cpu)
[77.611349] Starting subtest: psr-rgb101010-draw-mmap-cpu
[84.763518] Subtest psr-rgb101010-draw-mmap-cpu: SUCCESS (7.154s)
[84.904540] [015/131] (935s left) kms_cursor_legacy (single-move)
[85.023404] Starting subtest: single-move
[85.024275] Starting dynamic subtest: pipe-A
[90.405601] Dynamic subtest pipe-A: SUCCESS (5.379s)
[90.412137] Starting dynamic subtest: pipe-B
[95.788968] Dynamic subtest pipe-B: SUCCESS (5.382s)
[95.795422] Starting dynamic subtest: pipe-C
[101.171408] Dynamic subtest pipe-C: SUCCESS (5.381s)
[101.178420] Starting dynamic subtest: pipe-D
[106.552842] Dynamic subtest pipe-D: SUCCESS (5.380s)
[106.559883] Starting dynamic subtest: all-pipes
[111.940793] Dynamic subtest all-pipes: SUCCESS (5.387s)
[111.941835] Subtest single-move: SUCCESS (26.914s)
[112.098845] [016/131] (908s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render)
[112.205213] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render
[116.689382] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (4.485s)
[117.835754] [017/131] (902s left) gem_mmap_gtt (big-copy-odd)
[117.880436] Subtest big-copy-odd: SKIP (0.000s)
[117.927924] [018/131] (902s left) gem_ctx_param (basic-default)
[117.972314] Starting subtest: basic-default
[117.973309] Subtest basic-default: SUCCESS (0.000s)
[118.057916] [019/131] (902s left) gem_mmap_gtt (hang-busy)
[118.114086] Subtest hang-busy: SKIP (0.000s)
[118.181143] [020/131] (902s left) drm_read (invalid-buffer)
[118.331763] Starting subtest: invalid-buffer
[118.332920] Subtest invalid-buffer: SUCCESS (0.000s)
[118.483930] [021/131] (901s left) kms_psr (fbc-pr-dpms)
[118.565165] Starting subtest: fbc-pr-dpms
[118.567223] Subtest fbc-pr-dpms: SKIP (0.000s)
[118.655330] [022/131] (901s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-yf-tiled)
[118.710605] Starting subtest: yf-tiled-mc-ccs-to-vebox-yf-tiled
[118.712466] Subtest yf-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[118.910378] [023/131] (901s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling)
[119.001725] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling
[119.002797] Starting dynamic subtest: pipe-A-default-mode
[119.313058] Dynamic subtest pipe-A-default-mode: SKIP (0.308s)
[119.315379] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SKIP (0.309s)
[120.157260] [024/131] (900s left) syncobj_timeline (multi-wait-signaled)
[120.208490] Starting subtest: multi-wait-signaled
[120.209626] Subtest multi-wait-signaled: SUCCESS (0.001s)
[120.324879] [025/131] (900s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff)
[120.407172] Starting subtest: psr-2p-primscrn-spr-indfb-onoff
[120.408932] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[120.522634] [026/131] (899s left) kms_psr (psr-sprite-mmap-cpu)
[120.619102] Starting subtest: psr-sprite-mmap-cpu
[120.620040] Starting dynamic subtest: eDP-1
[122.356301] Dynamic subtest eDP-1: SUCCESS (1.737s)
[122.357148] Subtest psr-sprite-mmap-cpu: SUCCESS (1.737s)
[123.226532] [027/131] (897s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[123.326221] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[130.645419] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.320s)
[130.794884] [028/131] (889s left) gem_mmap_gtt (basic-write-read)
[130.860348] Subtest basic-write-read: SKIP (0.000s)
[130.921166] [029/131] (889s left) kms_addfb_basic (bad-pitch-63)
[130.985055] Starting subtest: bad-pitch-63
[130.985980] Subtest bad-pitch-63: SUCCESS (0.000s)
[131.167746] [030/131] (889s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area-big-fb)
[136.186177] Starting subtest: psr2-primary-plane-update-sf-dmg-area-big-fb
[136.187085] Starting dynamic subtest: pipe-A-eDP-1
[143.051403] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.864s)
[143.066247] Starting dynamic subtest: pipe-B-eDP-1
[150.121518] Dynamic subtest pipe-B-eDP-1: SUCCESS (7.067s)
[150.122356] Subtest psr2-primary-plane-update-sf-dmg-area-big-fb: SUCCESS (13.935s)
[150.994278] [031/131] (869s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[151.103066] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc
[151.105922] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[151.233681] [032/131] (869s left) gem_tiled_partial_pwrite_pread (writes-after-reads)
[151.301284] Subtest writes-after-reads: SKIP (0.000s)
[151.364867] [033/131] (869s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[151.416970] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[151.417960] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[151.524304] [034/131] (869s left) syncobj_wait (multi-wait-for-submit-signaled)
[151.583753] Starting subtest: multi-wait-for-submit-signaled
[151.584776] Subtest multi-wait-for-submit-signaled: SUCCESS (0.000s)
[151.699313] [035/131] (869s left) gen9_exec_parse (bb-chained)
[151.750639] Subtest bb-chained: SKIP (0.000s)
[151.814621] [036/131] (868s left) gem_mmap_gtt (medium-copy-xy)
[151.872204] Subtest medium-copy-XY: SKIP (0.000s)
[151.935352] [037/131] (868s left) gem_exec_schedule (deep)
[152.101457] Starting subtest: deep
[152.102663] Starting dynamic subtest: rcs0
[157.949462] Dynamic subtest rcs0: SKIP (5.846s)
[157.958039] Starting dynamic subtest: vcs0
[168.991063] Dynamic subtest vcs0: SUCCESS (11.039s)
[168.999635] Starting dynamic subtest: vcs1
[181.144273] Dynamic subtest vcs1: SUCCESS (12.152s)
[181.155644] Starting dynamic subtest: vecs0
[193.112501] Dynamic subtest vecs0: SUCCESS (11.967s)
[193.125860] Starting dynamic subtest: ccs0
[205.895199] Dynamic subtest ccs0: SUCCESS (12.782s)
[205.896217] Subtest deep: SUCCESS (53.789s)
[207.622919] [FACT gem_exec_schedule (deep)] new: kernel.kmod_is_loaded.vgem: true
[207.625911] [038/131] (813s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted)
[207.683178] Starting subtest: multi-wait-all-for-submit-unsubmitted
[207.786538] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.102s)
[207.887244] [039/131] (812s left) perf_pmu (all-busy-check-all)
[207.916994] Starting subtest: all-busy-check-all
[209.943550] Subtest all-busy-check-all: SUCCESS (2.024s)
[210.072758] [040/131] (810s left) kms_psr (psr2-sprite-blt)
[210.171082] Starting subtest: psr2-sprite-blt
[210.171985] Starting dynamic subtest: eDP-1
[211.871062] Dynamic subtest eDP-1: SUCCESS (1.699s)
[211.872050] Subtest psr2-sprite-blt: SUCCESS (1.700s)
[212.764217] [041/131] (808s left) gem_exec_schedule (implicit-write-read)
[212.810996] Starting subtest: implicit-write-read
[212.811987] Starting dynamic subtest: rcs0
[212.916181] Dynamic subtest rcs0: SUCCESS (0.104s)
[212.926601] Starting dynamic subtest: vcs0
[213.009405] Dynamic subtest vcs0: SUCCESS (0.093s)
[213.018058] Starting dynamic subtest: vcs1
[213.088480] Dynamic subtest vcs1: SUCCESS (0.078s)
[213.097659] Starting dynamic subtest: vecs0
[213.163873] Dynamic subtest vecs0: SUCCESS (0.075s)
[213.172885] Starting dynamic subtest: ccs0
[213.254266] Dynamic subtest ccs0: SUCCESS (0.090s)
[213.255409] Subtest implicit-write-read: SUCCESS (0.443s)
[214.052624] [042/131] (806s left) kms_dsc (dsc-basic)
[214.138902] Starting subtest: dsc-basic
[214.144142] Subtest dsc-basic: SKIP (0.000s)
[214.232035] [043/131] (806s left) kms_plane_cursor (overlay)
[214.325068] Starting subtest: overlay
[214.326731] Starting dynamic subtest: pipe-A-eDP-1-size-64
[216.824197] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.498s)
[216.884553] Starting dynamic subtest: pipe-A-eDP-1-size-128
[219.391591] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.515s)
[219.451867] Starting dynamic subtest: pipe-A-eDP-1-size-256
[221.959344] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.515s)
[222.325856] Starting dynamic subtest: pipe-B-eDP-1-size-64
[225.620387] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.302s)
[225.680911] Starting dynamic subtest: pipe-B-eDP-1-size-128
[228.176622] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.504s)
[228.238412] Starting dynamic subtest: pipe-B-eDP-1-size-256
[230.744528] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.515s)
[231.092945] Starting dynamic subtest: pipe-C-eDP-1-size-64
[233.888543] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.804s)
[233.926902] Starting dynamic subtest: pipe-C-eDP-1-size-128
[236.077363] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.157s)
[236.115220] Starting dynamic subtest: pipe-C-eDP-1-size-256
[238.255312] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.147s)
[238.580728] Starting dynamic subtest: pipe-D-eDP-1-size-64
[241.487582] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.913s)
[241.525261] Starting dynamic subtest: pipe-D-eDP-1-size-128
[243.631884] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.113s)
[243.668955] Starting dynamic subtest: pipe-D-eDP-1-size-256
[245.798630] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.135s)
[246.117044] Subtest overlay: SUCCESS (31.790s)
[246.995428] [044/131] (774s left) kms_cursor_crc (cursor-random-128x42)
[247.204514] Starting subtest: cursor-random-128x42
[247.246847] Subtest cursor-random-128x42: SKIP (0.041s)
[247.481922] [045/131] (773s left) kms_hdr (brightness-with-hdr)
[247.573599] Starting subtest: brightness-with-hdr
[247.576066] Subtest brightness-with-hdr: SKIP (0.000s)
[247.664343] [046/131] (773s left) kms_addfb_basic (basic-y-tiled-legacy)
[247.705595] Starting subtest: basic-y-tiled-legacy
[247.707481] Subtest basic-y-tiled-legacy: SKIP (0.000s)
[247.868959] [047/131] (773s left) kms_rotation_crc (primary-rotation-180)
[247.958067] Starting subtest: primary-rotation-180
[254.869265] Subtest primary-rotation-180: SUCCESS (6.911s)
[256.070232] [048/131] (765s left) kms_color (legacy-gamma-reset)
[256.166089] Starting subtest: legacy-gamma-reset
[256.166996] Starting dynamic subtest: pipe-A-eDP-1
[256.528339] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.363s)
[256.535059] Starting dynamic subtest: pipe-B-eDP-1
[256.539975] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.011s)
[256.546388] Starting dynamic subtest: pipe-C-eDP-1
[256.552261] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.012s)
[256.558550] Starting dynamic subtest: pipe-D-eDP-1
[256.564595] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.012s)
[256.565432] Subtest legacy-gamma-reset: SUCCESS (0.400s)
[257.412168] [049/131] (763s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[257.511065] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[258.170486] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.660s)
[258.387731] [050/131] (762s left) syncobj_timeline (etime-multi-wait-for-submit-available-unsubmitted)
[258.441479] Starting subtest: etime-multi-wait-for-submit-available-unsubmitted
[258.547857] Subtest etime-multi-wait-for-submit-available-unsubmitted: SUCCESS (0.105s)
[258.637234] [051/131] (762s left) gem_exec_whisper (basic-fds)
[258.692322] Starting subtest: basic-fds
[265.908180] Subtest basic-fds: SUCCESS (7.215s)
[266.109605] [052/131] (755s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[266.231278] Starting subtest: cursorA-vs-flipA-toggle
[277.357078] Subtest cursorA-vs-flipA-toggle: SUCCESS (11.125s)
[278.244457] [053/131] (743s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[278.345261] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip
[278.347086] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[278.465818] [054/131] (742s left) kms_big_fb (x-tiled-8bpp-rotate-270)
[278.559837] Starting subtest: x-tiled-8bpp-rotate-270
[278.581922] Subtest x-tiled-8bpp-rotate-270: SKIP (0.022s)
[278.725929] [055/131] (742s left) gem_busy (close-race)
[278.787869] Starting subtest: close-race
[303.896385] Subtest close-race: SUCCESS (25.104s)
[304.307323] [056/131] (717s left) kms_scaling_modes (scaling-mode-full)
[304.433618] Starting subtest: scaling-mode-full
[304.435214] Starting dynamic subtest: pipe-A-eDP-1
[304.536312] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.101s)
[304.545695] Starting dynamic subtest: pipe-B-eDP-1
[305.743808] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.204s)
[305.753934] Starting dynamic subtest: pipe-C-eDP-1
[306.859192] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.114s)
[306.868058] Starting dynamic subtest: pipe-D-eDP-1
[307.992422] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.132s)
[307.993270] Subtest scaling-mode-full: SUCCESS (3.559s)
[309.170916] [057/131] (712s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[309.408775] Starting subtest: cursor-rapid-movement-256x256
[309.412303] Starting dynamic subtest: pipe-A-eDP-1
[309.954606] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.542s)
[309.981887] Starting dynamic subtest: pipe-D-eDP-1
[311.149058] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.174s)
[311.150481] Subtest cursor-rapid-movement-256x256: SUCCESS (1.741s)
[312.028521] [058/131] (709s left) kms_pm_rpm (pc8-residency)
[314.051300] Starting subtest: pc8-residency
[314.053940] Subtest pc8-residency: SKIP (0.000s)
[314.452447] [059/131] (707s left) api_intel_bb (reset-bb)
[314.508311] Starting subtest: reset-bb
[314.510582] Subtest reset-bb: SUCCESS (0.003s)
[314.656899] [060/131] (706s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[314.744878] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[314.745685] Starting dynamic subtest: pipe-A-eDP-1
[314.748872] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[314.756222] Starting dynamic subtest: pipe-B-eDP-1
[314.759472] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[314.766705] Starting dynamic subtest: pipe-C-eDP-1
[314.769919] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[314.777055] Starting dynamic subtest: pipe-D-eDP-1
[314.780813] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[314.782464] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[316.995710] [061/131] (704s left) i915_pm_rc6_residency (rc6-fence)
[317.046438] Starting subtest: rc6-fence
[317.070622] Starting dynamic subtest: gt0
[329.392034] Dynamic subtest gt0: SUCCESS (12.321s)
[329.403409] Starting dynamic subtest: gt1
[343.833082] Dynamic subtest gt1: SUCCESS (14.435s)
[343.834740] Subtest rc6-fence: SUCCESS (26.785s)
[343.927425] [062/131] (677s left) kms_addfb_basic (too-wide)
[344.048377] Starting subtest: too-wide
[344.049297] Subtest too-wide: SUCCESS (0.000s)
[344.174939] [063/131] (677s left) gem_ctx_engines (none)
[344.243619] Starting subtest: none
[344.245922] Subtest none: SUCCESS (0.001s)
[344.444587] [064/131] (677s left) gem_exec_reloc (basic-write-read-noreloc)
[344.510441] Subtest basic-write-read-noreloc: SKIP (0.000s)
[344.588292] [065/131] (677s left) gem_ctx_persistence (heartbeat-stop)
[344.645789] Starting subtest: heartbeat-stop
[344.647578] Subtest heartbeat-stop: SKIP (0.000s)
[344.784744] [066/131] (676s left) gen3_mixed_blits
[344.896477] [067/131] (676s left) gem_watchdog (default-virtual)
[344.956752] Starting subtest: default-virtual
[351.250938] Subtest default-virtual: SUCCESS (6.291s)
[351.362095] [068/131] (670s left) kms_feature_discovery (display)
[351.485536] Starting subtest: display
[351.486418] Subtest display: SUCCESS (0.000s)
[351.580055] [069/131] (670s left) gem_ctx_persistence (engines-mixed-process)
[351.644204] Starting subtest: engines-mixed-process
[351.645072] Starting dynamic subtest: rcs0
[352.938967] Dynamic subtest rcs0: SUCCESS (1.294s)
[352.950246] Starting dynamic subtest: bcs0
[354.918939] Dynamic subtest bcs0: SUCCESS (1.978s)
[354.929634] Starting dynamic subtest: vcs0
[356.890616] Dynamic subtest vcs0: SUCCESS (1.970s)
[356.901102] Starting dynamic subtest: vcs1
[358.963795] Dynamic subtest vcs1: SUCCESS (2.071s)
[358.974500] Starting dynamic subtest: vecs0
[360.873596] Dynamic subtest vecs0: SUCCESS (1.908s)
[360.884285] Starting dynamic subtest: ccs0
[362.886194] Dynamic subtest ccs0: SUCCESS (2.010s)
[362.887057] Subtest engines-mixed-process: SUCCESS (11.242s)
[362.983690] [070/131] (658s left) i915_hangman (gt-engine-error)
[363.051293] Starting subtest: gt-engine-error
[363.052131] Starting dynamic subtest: rcs0
[364.854426] Dynamic subtest rcs0: SUCCESS (1.799s)
[364.864041] Starting dynamic subtest: bcs0
[366.901983] Dynamic subtest bcs0: SUCCESS (2.045s)
[366.912051] Starting dynamic subtest: vcs0
[368.885823] Dynamic subtest vcs0: SUCCESS (1.980s)
[368.895987] Starting dynamic subtest: vcs1
[370.869608] Dynamic subtest vcs1: SUCCESS (1.981s)
[370.880207] Starting dynamic subtest: vecs0
[372.853665] Dynamic subtest vecs0: SUCCESS (1.981s)
[372.863833] Starting dynamic subtest: ccs0
[374.837844] Dynamic subtest ccs0: SUCCESS (1.981s)
[374.839338] Subtest gt-engine-error: SUCCESS (11.785s)
[374.939966] [071/131] (646s left) gem_exec_whisper (basic-sync)
[375.007803] Starting subtest: basic-sync
[384.632296] Subtest basic-sync: SUCCESS (9.623s)
[384.832996] [072/131] (637s left) kms_big_fb (yf-tiled-16bpp-rotate-90)
[384.937379] Starting subtest: yf-tiled-16bpp-rotate-90
[384.939242] Subtest yf-tiled-16bpp-rotate-90: SKIP (0.000s)
[385.069937] [073/131] (636s left) perf (i915-ref-count)
[385.156065] Starting subtest: i915-ref-count
[385.225951] Subtest i915-ref-count: SUCCESS (0.069s)
[385.275053] [074/131] (636s left) syncobj_wait (multi-wait-all-submitted)
[385.335288] Starting subtest: multi-wait-all-submitted
[385.444156] Subtest multi-wait-all-submitted: SUCCESS (0.107s)
[385.535628] [075/131] (636s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-blt)
[385.633399] Starting subtest: psr-2p-primscrn-spr-indfb-draw-blt
[385.635276] Subtest psr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[385.801591] [076/131] (636s left) gem_exec_params (rel-constants-invalid-rel-gen5)
[385.857231] Starting subtest: rel-constants-invalid-rel-gen5
[385.858277] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s)
[385.997438] [077/131] (636s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-wc)
[386.090141] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-wc
[386.091872] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[386.215055] [078/131] (635s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu)
[386.321689] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu
[390.458047] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (4.137s)
[391.587901] [079/131] (630s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-render)
[391.689801] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-render
[399.206241] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-render: SUCCESS (7.518s)
[399.374652] [080/131] (622s left) kms_vblank (ts-continuation-suspend)
[399.469527] Starting subtest: ts-continuation-suspend
[399.470499] Starting dynamic subtest: pipe-A-eDP-1
[416.981839] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.712s)
[416.992585] Starting dynamic subtest: pipe-D-eDP-1
[434.978685] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.562s)
[434.979726] Subtest ts-continuation-suspend: SUCCESS (8.278s)
[441.816522] [081/131] (586s left) kms_flip (2x-nonexisting-fb)
[441.911850] Starting subtest: 2x-nonexisting-fb
[441.922786] Subtest 2x-nonexisting-fb: SKIP (0.011s)
[442.023867] [082/131] (586s left) syncobj_timeline (wait-all-for-submit-snapshot)
[442.079568] Starting subtest: wait-all-for-submit-snapshot
[442.161795] Subtest wait-all-for-submit-snapshot: SUCCESS (0.081s)
[442.254409] [083/131] (586s left) gem_exec_fence (syncobj-signal)
[442.695404] Starting subtest: syncobj-signal
[442.700160] Subtest syncobj-signal: SUCCESS (0.005s)
[444.230880] [084/131] (584s left) i915_suspend (basic-s3-without-i915)
[444.265687] Starting subtest: basic-s3-without-i915
[447.714389] Subtest basic-s3-without-i915: SKIP (3.477s)
[449.266671] [085/131] (579s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs)
[449.366501] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs
[449.367364] Starting dynamic subtest: pipe-A-eDP-1
[449.374936] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[449.382219] Starting dynamic subtest: pipe-B-eDP-1
[449.389746] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[449.396565] Starting dynamic subtest: pipe-C-eDP-1
[449.404230] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[449.411152] Starting dynamic subtest: pipe-D-eDP-1
[449.418560] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[449.419397] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs: SUCCESS (0.008s)
[451.580728] [086/131] (576s left) core_sysfs (read-all-entries)
[451.640799] Starting subtest: read-all-entries
[451.643153] Subtest read-all-entries: SUCCESS (0.003s)
[451.772991] [087/131] (576s left) gem_exec_fence (concurrent)
[451.969978] Starting subtest: concurrent
[451.972404] Subtest concurrent: SKIP (0.000s)
[454.265026] [088/131] (574s left) gem_exec_schedule (u-fairslice)
[454.330510] Starting subtest: u-fairslice
[454.331346] Starting dynamic subtest: rcs0
[456.367787] Dynamic subtest rcs0: SUCCESS (2.042s)
[456.377973] Starting dynamic subtest: bcs0
[458.395490] Dynamic subtest bcs0: SUCCESS (2.031s)
[458.404589] Starting dynamic subtest: vcs0
[460.418299] Dynamic subtest vcs0: SUCCESS (2.026s)
[460.425596] Starting dynamic subtest: vcs1
[462.439031] Dynamic subtest vcs1: SUCCESS (2.023s)
[462.447563] Starting dynamic subtest: vecs0
[464.458396] Dynamic subtest vecs0: SUCCESS (2.020s)
[464.466417] Starting dynamic subtest: ccs0
[466.477553] Dynamic subtest ccs0: SUCCESS (2.021s)
[466.478507] Subtest u-fairslice: SUCCESS (12.169s)
[466.798916] [089/131] (561s left) kms_chamelium_hpd (dp-hpd-for-each-pipe)
[467.198977] Subtest dp-hpd-for-each-pipe: SKIP (0.000s)
[468.040829] [090/131] (560s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs-cc)
[468.129598] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs-cc
[468.130489] Starting dynamic subtest: pipe-A-eDP-1
[468.276115] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.143s)
[468.284369] Starting dynamic subtest: pipe-B-eDP-1
[468.291884] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.010s)
[468.299447] Starting dynamic subtest: pipe-C-eDP-1
[468.306879] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.011s)
[468.314240] Starting dynamic subtest: pipe-D-eDP-1
[468.321799] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.010s)
[468.322636] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.179s)
[470.552292] [091/131] (558s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-sf)
[475.541973] Starting subtest: fbc-psr2-cursor-plane-move-continuous-sf
[475.543985] Starting dynamic subtest: pipe-A-eDP-1
[476.324655] Dynamic subtest pipe-A-eDP-1: SKIP (0.780s)
[476.333899] Starting dynamic subtest: pipe-B-eDP-1
[477.461843] Dynamic subtest pipe-B-eDP-1: SKIP (1.135s)
[477.463495] Subtest fbc-psr2-cursor-plane-move-continuous-sf: SKIP (1.920s)
[478.690203] [092/131] (550s left) gem_ctx_param (set-priority-invalid-size)
[478.750621] Starting subtest: set-priority-invalid-size
[478.751557] Subtest set-priority-invalid-size: SUCCESS (0.000s)
[478.854291] [093/131] (549s left) kms_atomic_transition (plane-all-transition-fencing)
[478.935722] Starting subtest: plane-all-transition-fencing
[478.936579] Starting dynamic subtest: pipe-A-eDP-1
[481.430198] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.494s)
[481.744439] Starting dynamic subtest: pipe-B-eDP-1
[484.981417] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.244s)
[485.267021] Subtest plane-all-transition-fencing: SUCCESS (6.332s)
[486.125627] [094/131] (542s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[486.228415] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[486.230185] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[486.360151] [095/131] (542s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-render)
[486.454164] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-render
[486.455825] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[486.583579] [096/131] (542s left) kms_pipe_b_c_ivb (pipe-b-double-modeset-then-modeset-pipe-c)
[486.640555] Subtest pipe-B-double-modeset-then-modeset-pipe-C: SKIP (0.000s)
[486.698030] [097/131] (542s left) kms_chamelium_frames (hdmi-aspect-ratio)
[487.078299] Subtest hdmi-aspect-ratio: SKIP (0.000s)
[487.896614] [098/131] (541s left) kms_psr (fbc-psr-dpms)
[487.985577] Starting subtest: fbc-psr-dpms
[487.986493] Starting dynamic subtest: eDP-1
[487.988373] Dynamic subtest eDP-1: SKIP (0.000s)
[487.990102] Subtest fbc-psr-dpms: SKIP (0.001s)
[488.065293] [099/131] (540s left) kms_cdclk (mode-transition-all-outputs)
[488.154746] Starting subtest: mode-transition-all-outputs
[488.444792] Subtest mode-transition-all-outputs: SKIP (0.291s)
[489.271928] [100/131] (539s left) gem_busy (busy)
[489.351314] Starting subtest: busy
[489.352331] Starting dynamic subtest: all-engines
[489.401262] Dynamic subtest all-engines: SUCCESS (0.051s)
[489.417062] Starting dynamic subtest: rcs0
[491.132603] Dynamic subtest rcs0: SUCCESS (1.730s)
[491.142078] Starting dynamic subtest: bcs0
[491.186148] Dynamic subtest bcs0: SUCCESS (0.053s)
[491.195645] Starting dynamic subtest: vcs0
[491.225934] Dynamic subtest vcs0: SUCCESS (0.038s)
[491.234952] Starting dynamic subtest: vcs1
[493.114450] Dynamic subtest vcs1: SUCCESS (1.884s)
[493.123110] Starting dynamic subtest: vecs0
[495.164780] Dynamic subtest vecs0: SUCCESS (2.049s)
[495.173732] Starting dynamic subtest: ccs0
[497.147969] Dynamic subtest ccs0: SUCCESS (1.982s)
[497.149188] Subtest busy: SUCCESS (7.798s)
[497.515488] [101/131] (531s left) prime_busy (after-wait)
[497.575524] Starting subtest: after-wait
[497.578040] Starting dynamic subtest: rcs0
[497.626287] Dynamic subtest rcs0: SUCCESS (0.048s)
[497.635695] Starting dynamic subtest: bcs0
[497.688211] Dynamic subtest bcs0: SUCCESS (0.061s)
[497.696571] Starting dynamic subtest: vcs0
[497.729210] Dynamic subtest vcs0: SUCCESS (0.040s)
[497.736990] Starting dynamic subtest: vcs1
[497.771686] Dynamic subtest vcs1: SUCCESS (0.042s)
[497.779494] Starting dynamic subtest: vecs0
[497.812863] Dynamic subtest vecs0: SUCCESS (0.040s)
[497.820626] Starting dynamic subtest: ccs0
[497.855505] Dynamic subtest ccs0: SUCCESS (0.042s)
[497.965218] Subtest after-wait: SUCCESS (0.389s)
[498.059182] [102/131] (531s left) sysfs_preempt_timeout (timeout)
[498.110217] Starting subtest: timeout
[498.111247] Starting dynamic subtest: vecs0
[508.177100] Dynamic subtest vecs0: SUCCESS (10.067s)
[508.187367] Starting dynamic subtest: ccs0
[509.681393] Dynamic subtest ccs0: SUCCESS (1.504s)
[509.690778] Starting dynamic subtest: vcs0
[519.165282] Dynamic subtest vcs0: SUCCESS (9.485s)
[519.175653] Starting dynamic subtest: bcs0
[520.628745] Dynamic subtest bcs0: SUCCESS (1.463s)
[520.639057] Starting dynamic subtest: rcs0
[522.011701] Dynamic subtest rcs0: SUCCESS (1.381s)
[522.021663] Starting dynamic subtest: vcs1
[531.149361] Dynamic subtest vcs1: SUCCESS (9.138s)
[531.150466] Subtest timeout: SUCCESS (33.050s)
[531.250779] [103/131] (497s left) gem_eio (in-flight-immediate)
[531.467880] Starting subtest: in-flight-immediate
[539.868045] Subtest in-flight-immediate: SUCCESS (8.401s)
[540.073734] [104/131] (489s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-render)
[540.173777] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-render
[546.904577] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-render: SUCCESS (6.728s)
[547.104510] [105/131] (482s left) kms_pm_dc (dc5-psr)
[548.205490] Starting subtest: dc5-psr
[551.082083] Subtest dc5-psr: SUCCESS (2.875s)
[551.936829] [106/131] (477s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted)
[551.987906] Starting subtest: etime-multi-wait-all-for-submit-submitted
[552.098374] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.108s)
[552.188618] [107/131] (477s left) kms_prime (basic-modeset-hybrid)
[552.274978] Subtest basic-modeset-hybrid: SKIP (0.000s)
[552.385635] [108/131] (476s left) gem_pxp (hw-rejects-pxp-buffer)
[552.497074] Starting subtest: hw-rejects-pxp-buffer
[552.499696] Subtest hw-rejects-pxp-buffer: SKIP (0.000s)
[552.618820] [109/131] (476s left) kms_atomic (plane-invalid-params-fence)
[552.722418] Starting subtest: plane-invalid-params-fence
[552.724966] Starting dynamic subtest: pipe-A-eDP-1
[553.106679] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.381s)
[553.107547] Subtest plane-invalid-params-fence: SUCCESS (0.385s)
[553.971848] [110/131] (475s left) gem_userptr_blits (unsync-overlap)
[554.047155] Subtest unsync-overlap: SKIP (0.000s)
[554.213598] [111/131] (475s left) kms_plane_multiple (2x-tiling-yf)
[554.314638] Starting subtest: 2x-tiling-yf
[554.316278] Subtest 2x-tiling-yf: SKIP (0.000s)
[554.404978] [112/131] (475s left) kms_flip (2x-flip-vs-absolute-wf_vblank)
[554.505345] Starting subtest: 2x-flip-vs-absolute-wf_vblank
[554.516172] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.011s)
[554.656748] [113/131] (474s left) perf_pmu (multi-client)
[554.689946] Starting subtest: multi-client
[554.690796] Starting dynamic subtest: rcs0
[555.767700] Dynamic subtest rcs0: SUCCESS (1.074s)
[555.778749] Starting dynamic subtest: bcs0
[556.819479] Dynamic subtest bcs0: SUCCESS (1.048s)
[556.829683] Starting dynamic subtest: vcs0
[557.871707] Dynamic subtest vcs0: SUCCESS (1.049s)
[557.881695] Starting dynamic subtest: vcs1
[559.147742] Dynamic subtest vcs1: SUCCESS (1.273s)
[559.157204] Starting dynamic subtest: vecs0
[561.132920] Dynamic subtest vecs0: SUCCESS (1.982s)
[561.142496] Starting dynamic subtest: ccs0
[563.181188] Dynamic subtest ccs0: SUCCESS (2.046s)
[563.182346] Subtest multi-client: SUCCESS (8.489s)
[563.329448] [114/131] (466s left) kms_frontbuffer_tracking (fbcpsr-shrfb-scaledprimary)
[563.428404] Starting subtest: fbcpsr-shrfb-scaledprimary
[569.276048] Subtest fbcpsr-shrfb-scaledprimary: SUCCESS (5.848s)
[569.430337] [115/131] (460s left) kms_frontbuffer_tracking (fbc-2p-rte)
[569.518621] Starting subtest: fbc-2p-rte
[569.520488] Subtest fbc-2p-rte: SKIP (0.000s)
[569.641176] [116/131] (459s left) kms_setmode (invalid-clone-single-crtc)
[569.695739] Starting subtest: invalid-clone-single-crtc
[569.698184] Subtest invalid-clone-single-crtc: SKIP (0.000s)
[569.831240] [117/131] (459s left) kms_psr (pr-primary-mmap-cpu)
[569.930936] Starting subtest: pr-primary-mmap-cpu
[569.932781] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[570.022521] [118/131] (459s left) kms_big_fb (linear-16bpp-rotate-180)
[570.126596] Starting subtest: linear-16bpp-rotate-180
[571.428475] Subtest linear-16bpp-rotate-180: SUCCESS (1.302s)
[571.613899] [119/131] (458s left) perf (blocking-parameterized)
[571.730819] Starting subtest: blocking-parameterized
[591.755891] Subtest blocking-parameterized: SUCCESS (20.025s)
[591.798801] [120/131] (437s left) kms_big_fb (y-tiled-16bpp-rotate-180)
[591.892759] Starting subtest: y-tiled-16bpp-rotate-180
[591.894584] Subtest y-tiled-16bpp-rotate-180: SKIP (0.000s)
[592.002096] [121/131] (437s left) kms_invalid_mode (zero-clock)
[592.085832] Starting subtest: zero-clock
[592.086758] Starting dynamic subtest: pipe-A-eDP-1
[592.371018] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.283s)
[592.379499] Starting dynamic subtest: pipe-B-eDP-1
[592.380373] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[592.388053] Starting dynamic subtest: pipe-C-eDP-1
[592.388962] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[592.396938] Starting dynamic subtest: pipe-D-eDP-1
[592.397810] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[592.398721] Subtest zero-clock: SUCCESS (0.290s)
[593.250282] [122/131] (436s left) gem_pxp (create-regular-context-1)
[593.311225] Starting subtest: create-regular-context-1
[593.312072] Subtest create-regular-context-1: SUCCESS (0.001s)
[593.446171] [123/131] (436s left) gem_mmap_gtt (cpuset-medium-copy)
[593.502024] Subtest cpuset-medium-copy: SKIP (0.000s)
[593.567509] [124/131] (436s left) kms_atomic_transition (plane-use-after-nonblocking-unbind-fencing)
[593.659286] Starting subtest: plane-use-after-nonblocking-unbind-fencing
[593.660187] Starting dynamic subtest: pipe-A-eDP-1
[593.720856] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.062s)
[594.021460] Starting dynamic subtest: pipe-B-eDP-1
[594.833037] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.819s)
[595.119887] Subtest plane-use-after-nonblocking-unbind-fencing: SUCCESS (1.459s)
[596.007972] [125/131] (433s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-cpu)
[596.103960] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-cpu
[596.105557] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[596.243484] [126/131] (433s left) kms_flip (2x-plain-flip-interruptible)
[596.339685] Starting subtest: 2x-plain-flip-interruptible
[596.351533] Subtest 2x-plain-flip-interruptible: SKIP (0.011s)
[596.482425] [127/131] (433s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-pixel-formats)
[596.576567] Starting subtest: plane-scaler-with-clipping-clamping-pixel-formats
[596.577437] Starting dynamic subtest: pipe-A
[596.682799] Dynamic subtest pipe-A: SKIP (0.105s)
[596.693043] Starting dynamic subtest: pipe-B
[597.856997] Dynamic subtest pipe-B: SKIP (1.174s)
[597.865056] Starting dynamic subtest: pipe-C
[599.080795] Dynamic subtest pipe-C: SUCCESS (1.224s)
[599.097770] Starting dynamic subtest: pipe-D
[600.308571] Dynamic subtest pipe-D: SUCCESS (1.226s)
[600.309398] Subtest plane-scaler-with-clipping-clamping-pixel-formats: SUCCESS (3.735s)
[601.515990] [128/131] (428s left) gem_ctx_param (invalid-ctx-get)
[601.570835] Starting subtest: invalid-ctx-get
[601.571822] Subtest invalid-ctx-get: SUCCESS (0.000s)
[601.664767] [129/131] (428s left) kms_flip (2x-flip-vs-expired-vblank-interruptible)
[601.767592] Starting subtest: 2x-flip-vs-expired-vblank-interruptible
[601.779806] Subtest 2x-flip-vs-expired-vblank-interruptible: SKIP (0.011s)
[601.874778] [130/131] (428s left) api_intel_allocator (two-level-inception-interruptible)
[601.941162] Starting subtest: two-level-inception-interruptible
[607.347145] Subtest two-level-inception-interruptible: SUCCESS (5.406s)
[607.487759] [131/131] (422s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-gtt)
[607.579769] Starting subtest: fbcpsr-rgb101010-draw-mmap-gtt
[607.581408] Subtest fbcpsr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[607.723273] Closing watchdogs
results: parsing output: 0/ for test: kms_ccs
results: parsing output: 1/ for test: kms_content_protection
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: gem_exec_params
results: parsing output: 4/ for test: gem_spin_batch
results: parsing output: 5/ for test: gem_exec_balancer
results: parsing output: 6/ for test: gem_eio
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: kms_flip
results: parsing output: 9/ for test: i915_drm_fdinfo
results: parsing output: 10/ for test: gem_exec_params
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: kms_lease
results: parsing output: 13/ for test: kms_frontbuffer_tracking
results: parsing output: 14/ for test: kms_cursor_legacy
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: gem_mmap_gtt
results: parsing output: 17/ for test: gem_ctx_param
results: parsing output: 18/ for test: gem_mmap_gtt
results: parsing output: 19/ for test: drm_read
results: parsing output: 20/ for test: kms_psr
results: parsing output: 21/ for test: gem_render_copy
results: parsing output: 22/ for test: kms_flip_scaled_crc
results: parsing output: 23/ for test: syncobj_timeline
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: kms_psr
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: gem_mmap_gtt
results: parsing output: 28/ for test: kms_addfb_basic
results: parsing output: 29/ for test: kms_psr2_sf
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 32/ for test: syncobj_timeline
results: parsing output: 33/ for test: syncobj_wait
results: parsing output: 34/ for test: gen9_exec_parse
results: parsing output: 35/ for test: gem_mmap_gtt
results: parsing output: 36/ for test: gem_exec_schedule
results: parsing output: 37/ for test: syncobj_wait
results: parsing output: 38/ for test: perf_pmu
results: parsing output: 39/ for test: kms_psr
results: parsing output: 40/ for test: gem_exec_schedule
results: parsing output: 41/ for test: kms_dsc
results: parsing output: 42/ for test: kms_plane_cursor
results: parsing output: 43/ for test: kms_cursor_crc
results: parsing output: 44/ for test: kms_hdr
results: parsing output: 45/ for test: kms_addfb_basic
results: parsing output: 46/ for test: kms_rotation_crc
results: parsing output: 47/ for test: kms_color
results: parsing output: 48/ for test: kms_big_fb
results: parsing output: 49/ for test: syncobj_timeline
results: parsing output: 50/ for test: gem_exec_whisper
results: parsing output: 51/ for test: kms_cursor_legacy
results: parsing output: 52/ for test: kms_big_fb
results: parsing output: 53/ for test: kms_big_fb
results: parsing output: 54/ for test: gem_busy
results: parsing output: 55/ for test: kms_scaling_modes
results: parsing output: 56/ for test: kms_cursor_crc
results: parsing output: 57/ for test: kms_pm_rpm
results: parsing output: 58/ for test: api_intel_bb
results: parsing output: 59/ for test: kms_ccs
results: parsing output: 60/ for test: i915_pm_rc6_residency
results: parsing output: 61/ for test: kms_addfb_basic
results: parsing output: 62/ for test: gem_ctx_engines
results: parsing output: 63/ for test: gem_exec_reloc
results: parsing output: 64/ for test: gem_ctx_persistence
results: parsing output: 65/ for test: gen3_mixed_blits
results: parsing output: 66/ for test: gem_watchdog
results: parsing output: 67/ for test: kms_feature_discovery
results: parsing output: 68/ for test: gem_ctx_persistence
results: parsing output: 69/ for test: i915_hangman
results: parsing output: 70/ for test: gem_exec_whisper
results: parsing output: 71/ for test: kms_big_fb
results: parsing output: 72/ for test: perf
results: parsing output: 73/ for test: syncobj_wait
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: gem_exec_params
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_vblank
results: parsing output: 80/ for test: kms_flip
results: parsing output: 81/ for test: syncobj_timeline
results: parsing output: 82/ for test: gem_exec_fence
results: parsing output: 83/ for test: i915_suspend
results: parsing output: 84/ for test: kms_ccs
results: parsing output: 85/ for test: core_sysfs
results: parsing output: 86/ for test: gem_exec_fence
results: parsing output: 87/ for test: gem_exec_schedule
results: parsing output: 88/ for test: kms_chamelium_hpd
results: parsing output: 89/ for test: kms_ccs
results: parsing output: 90/ for test: kms_psr2_sf
results: parsing output: 91/ for test: gem_ctx_param
results: parsing output: 92/ for test: kms_atomic_transition
results: parsing output: 93/ for test: kms_big_fb
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_pipe_b_c_ivb
results: parsing output: 96/ for test: kms_chamelium_frames
results: parsing output: 97/ for test: kms_psr
results: parsing output: 98/ for test: kms_cdclk
results: parsing output: 99/ for test: gem_busy
results: parsing output: 100/ for test: prime_busy
results: parsing output: 101/ for test: sysfs_preempt_timeout
results: parsing output: 102/ for test: gem_eio
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: kms_pm_dc
results: parsing output: 105/ for test: syncobj_timeline
results: parsing output: 106/ for test: kms_prime
results: parsing output: 107/ for test: gem_pxp
results: parsing output: 108/ for test: kms_atomic
results: parsing output: 109/ for test: gem_userptr_blits
results: parsing output: 110/ for test: kms_plane_multiple
results: parsing output: 111/ for test: kms_flip
results: parsing output: 112/ for test: perf_pmu
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: kms_setmode
results: parsing output: 116/ for test: kms_psr
results: parsing output: 117/ for test: kms_big_fb
results: parsing output: 118/ for test: perf
results: parsing output: 119/ for test: kms_big_fb
results: parsing output: 120/ for test: kms_invalid_mode
results: parsing output: 121/ for test: gem_pxp
results: parsing output: 122/ for test: gem_mmap_gtt
results: parsing output: 123/ for test: kms_atomic_transition
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_flip
results: parsing output: 126/ for test: kms_plane_scaling
results: parsing output: 127/ for test: gem_ctx_param
results: parsing output: 128/ for test: kms_flip
results: parsing output: 129/ for test: api_intel_allocator
results: parsing output: 130/ for test: kms_frontbuffer_tracking
Done.