[57.754377] Initializing watchdogs
[57.754420]   /dev/watchdog0
[57.769214] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7dd5 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Graphics]
[57.773251] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.775390] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.778794] [001/133] (960s left) gem_exec_whisper (basic-sync-all)
[57.855743] Starting subtest: basic-sync-all
[65.291281] Subtest basic-sync-all: SUCCESS (7.433s)
[65.485181] [002/133] (952s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-fullscreen)
[65.596690] Starting subtest: fbc-2p-primscrn-spr-indfb-fullscreen
[65.600841] Subtest fbc-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[65.698859] [003/133] (952s left) kms_flip (plain-flip-interruptible)
[65.778998] Starting subtest: plain-flip-interruptible
[65.781292] Starting dynamic subtest: A-eDP1
[67.500854] Dynamic subtest A-eDP1: SUCCESS (1.721s)
[67.509079] Starting dynamic subtest: B-eDP1
[69.227077] Dynamic subtest B-eDP1: SUCCESS (1.724s)
[69.236916] Starting dynamic subtest: C-eDP1
[70.845049] Dynamic subtest C-eDP1: SUCCESS (1.617s)
[70.854406] Starting dynamic subtest: D-eDP1
[72.473568] Dynamic subtest D-eDP1: SUCCESS (1.627s)
[72.478417] Subtest plain-flip-interruptible: SUCCESS (6.699s)
[73.667208] [004/133] (944s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-fully-sf)
[73.760032] Starting subtest: fbc-pr-cursor-plane-move-continuous-exceed-fully-sf
[73.764358] Subtest fbc-pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[73.837056] [005/133] (944s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-blt)
[73.918850] Starting subtest: fbcpsr-rgb565-draw-blt
[81.023499] Subtest fbcpsr-rgb565-draw-blt: SUCCESS (7.106s)
[81.186664] [006/133] (937s left) kms_rotation_crc (bad-tiling)
[81.263830] Starting subtest: bad-tiling
[81.267993] Subtest bad-tiling: SKIP (0.001s)
[81.343655] [007/133] (937s left) api_intel_allocator (two-level-inception)
[81.397906] Starting subtest: two-level-inception
[86.796583] Subtest two-level-inception: SUCCESS (5.399s)
[86.943826] [008/133] (931s left) gem_exec_reloc (basic-wc-gtt-active)
[87.041542] Subtest basic-wc-gtt-active: SKIP (0.000s)
[87.147919] [009/133] (931s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[87.245754] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[87.249826] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[87.376638] [010/133] (931s left) gem_mmap_gtt (cpuset-basic-small-copy-odd)
[87.457404] Subtest cpuset-basic-small-copy-odd: SKIP (0.000s)
[87.546012] [011/133] (931s left) gem_mmap_wc (pf-nonblock)
[87.627124] Subtest pf-nonblock: SKIP (0.000s)
[87.697029] [012/133] (931s left) gem_exec_create (legacy)
[87.771681] Starting subtest: legacy
[87.773932] Starting dynamic subtest: smem
[90.841494] Dynamic subtest smem: SUCCESS (3.070s)
[90.843908] Subtest legacy: SUCCESS (3.071s)
[91.031073] [013/133] (927s left) kms_dither (fb-8bpc-vs-panel-6bpc)
[91.116881] Starting subtest: fb-8bpc-vs-panel-6bpc
[91.119182] Starting dynamic subtest: pipe-A-eDP-1
[92.499336] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.381s)
[92.501646] Subtest fb-8bpc-vs-panel-6bpc: SUCCESS (1.382s)
[93.390706] [014/133] (925s left) kms_big_fb (x-tiled-8bpp-rotate-0)
[93.469701] Starting subtest: x-tiled-8bpp-rotate-0
[94.649409] Subtest x-tiled-8bpp-rotate-0: SUCCESS (1.180s)
[94.776982] [015/133] (924s left) kms_cursor_crc (cursor-onscreen-128x42)
[94.984057] Starting subtest: cursor-onscreen-128x42
[95.027070] Subtest cursor-onscreen-128x42: SKIP (0.038s)
[95.226326] [016/133] (923s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[95.294022] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[95.395580] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.101s)
[95.494852] [017/133] (923s left) syncobj_wait (wait-all-interrupted)
[95.556708] Starting subtest: wait-all-interrupted
[95.658294] Subtest wait-all-interrupted: SUCCESS (0.102s)
[95.757204] [018/133] (923s left) kms_busy (extended-modeset-hang-newfb)
[95.843389] Starting subtest: extended-modeset-hang-newfb
[95.845491] Starting dynamic subtest: pipe-A
[130.774602] Dynamic subtest pipe-A: SUCCESS (34.928s)
[130.790988] Starting dynamic subtest: pipe-D
[153.829241] Dynamic subtest pipe-D: SUCCESS (23.054s)
[153.831853] Subtest extended-modeset-hang-newfb: SUCCESS (57.988s)
[154.636924] [019/133] (864s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)
[154.707112] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-cpu
[154.711381] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[154.806256] [020/133] (864s left) syncobj_timeline (reset-multiple-signaled)
[154.859888] Starting subtest: reset-multiple-signaled
[154.862430] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[154.962923] [021/133] (864s left) gem_exec_schedule (wide)
[155.144789] Starting subtest: wide
[155.147237] Starting dynamic subtest: rcs0
[165.734821] Dynamic subtest rcs0: SUCCESS (10.587s)
[165.744379] Starting dynamic subtest: vcs0
[176.751581] Dynamic subtest vcs0: SUCCESS (11.016s)
[176.763040] Starting dynamic subtest: vcs1
[187.583690] Dynamic subtest vcs1: SUCCESS (10.832s)
[187.595792] Starting dynamic subtest: vecs0
[198.410530] Dynamic subtest vecs0: SUCCESS (10.826s)
[198.420480] Starting dynamic subtest: ccs0
[212.837388] Dynamic subtest ccs0: SUCCESS (14.426s)
[212.839909] Subtest wide: SUCCESS (57.689s)
[216.399582] [FACT gem_exec_schedule (wide)] new: kernel.kmod_is_loaded.vgem: true
[216.402831] [022/133] (802s left) gem_ctx_engines (none)
[216.477921] Starting subtest: none
[216.480257] Subtest none: SUCCESS (0.001s)
[216.675054] [023/133] (802s left) gen7_exec_parse (batch-without-end)
[216.743658] Subtest batch-without-end: SKIP (0.000s)
[216.823668] [024/133] (802s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[216.906538] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[216.910851] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[217.002702] [025/133] (802s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[217.087084] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt
[217.091197] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[217.209992] [026/133] (802s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-submi
[217.276776] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-submitted
[217.381342] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-submitted: SUCCESS (0.104s)
[217.465028] [027/133] (801s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[217.535741] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[217.540087] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[217.656083] [028/133] (801s left) gem_exec_schedule (promotion)
[217.731047] Starting subtest: promotion
[217.733079] Starting dynamic subtest: rcs0
[217.830542] Dynamic subtest rcs0: SUCCESS (0.106s)
[217.841974] Starting dynamic subtest: vcs0
[217.912463] Dynamic subtest vcs0: SUCCESS (0.083s)
[217.923616] Starting dynamic subtest: vcs1
[217.991700] Dynamic subtest vcs1: SUCCESS (0.079s)
[218.002578] Starting dynamic subtest: vecs0
[218.069504] Dynamic subtest vecs0: SUCCESS (0.077s)
[218.080065] Starting dynamic subtest: ccs0
[218.152994] Dynamic subtest ccs0: SUCCESS (0.084s)
[218.155477] Subtest promotion: SUCCESS (0.430s)
[219.972487] [029/133] (799s left) gem_exec_schedule (independent)
[220.044064] Starting subtest: independent
[220.046185] Starting dynamic subtest: rcs0
[221.848786] Dynamic subtest rcs0: SUCCESS (1.813s)
[221.859823] Starting dynamic subtest: vcs0
[223.854621] Dynamic subtest vcs0: SUCCESS (2.004s)
[223.865298] Starting dynamic subtest: vcs1
[225.856936] Dynamic subtest vcs1: SUCCESS (2.001s)
[225.867525] Starting dynamic subtest: vecs0
[227.890579] Dynamic subtest vecs0: SUCCESS (2.032s)
[227.901048] Starting dynamic subtest: ccs0
[229.848496] Dynamic subtest ccs0: SUCCESS (1.956s)
[229.850888] Subtest independent: SUCCESS (9.813s)
[230.156165] [030/133] (789s left) prime_self_import (basic-llseek-size)
[230.204067] Starting subtest: basic-llseek-size
[230.229707] Subtest basic-llseek-size: SUCCESS (0.024s)
[230.355266] [031/133] (789s left) gem_exec_reloc (basic-gtt-wc)
[230.424446] Subtest basic-gtt-wc: SKIP (0.000s)
[230.502256] [032/133] (789s left) i915_hangman (engine-error-state-capture)
[230.568536] Starting subtest: engine-error-state-capture
[230.570947] Starting dynamic subtest: rcs0
[233.783365] Dynamic subtest rcs0: SUCCESS (3.213s)
[233.795020] Starting dynamic subtest: bcs0
[239.799447] Dynamic subtest bcs0: SUCCESS (6.015s)
[239.810857] Starting dynamic subtest: vcs0
[244.790392] Dynamic subtest vcs0: SUCCESS (4.990s)
[244.801815] Starting dynamic subtest: vcs1
[250.806555] Dynamic subtest vcs1: SUCCESS (6.015s)
[250.817979] Starting dynamic subtest: vecs0
[255.798692] Dynamic subtest vecs0: SUCCESS (4.991s)
[255.809881] Starting dynamic subtest: ccs0
[261.815726] Dynamic subtest ccs0: SUCCESS (6.015s)
[261.819273] Subtest engine-error-state-capture: SUCCESS (31.246s)
[261.907688] [033/133] (757s left) kms_plane_cursor (overlay)
[261.982914] Starting subtest: overlay
[261.987468] Starting dynamic subtest: pipe-A-eDP-1-size-64
[264.422065] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.440s)
[264.481938] Starting dynamic subtest: pipe-A-eDP-1-size-128
[266.857460] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.383s)
[266.916174] Starting dynamic subtest: pipe-A-eDP-1-size-256
[269.324155] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.416s)
[269.670931] Starting dynamic subtest: pipe-B-eDP-1-size-64
[272.802962] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.141s)
[272.862783] Starting dynamic subtest: pipe-B-eDP-1-size-128
[275.250120] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.394s)
[275.308598] Starting dynamic subtest: pipe-B-eDP-1-size-256
[277.683575] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.383s)
[278.037660] Starting dynamic subtest: pipe-C-eDP-1-size-64
[280.808185] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.780s)
[280.845789] Starting dynamic subtest: pipe-C-eDP-1-size-128
[282.875063] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.036s)
[282.912549] Starting dynamic subtest: pipe-C-eDP-1-size-256
[284.975389] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.069s)
[285.301660] Starting dynamic subtest: pipe-D-eDP-1-size-64
[288.066674] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.773s)
[288.104279] Starting dynamic subtest: pipe-D-eDP-1-size-128
[290.145899] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.047s)
[290.185282] Starting dynamic subtest: pipe-D-eDP-1-size-256
[292.234364] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.058s)
[292.557437] Subtest overlay: SUCCESS (30.571s)
[293.354047] [034/133] (726s left) sysfs_timeslice_duration (timeout)
[293.419970] Starting subtest: timeout
[293.422271] Starting dynamic subtest: vecs0
[302.814063] Dynamic subtest vecs0: SUCCESS (9.392s)
[302.825256] Starting dynamic subtest: ccs0
[304.205865] Dynamic subtest ccs0: SUCCESS (1.388s)
[304.216814] Starting dynamic subtest: vcs0
[313.875824] Dynamic subtest vcs0: SUCCESS (9.668s)
[313.886593] Starting dynamic subtest: bcs0
[314.701043] Dynamic subtest bcs0: SUCCESS (0.822s)
[314.711109] Starting dynamic subtest: rcs0
[316.152990] Dynamic subtest rcs0: SUCCESS (1.449s)
[316.163602] Starting dynamic subtest: vcs1
[325.869144] Dynamic subtest vcs1: SUCCESS (9.712s)
[325.871699] Subtest timeout: SUCCESS (32.444s)
[325.960988] [035/133] (693s left) dumb_buffer (invalid-bpp)
[326.022952] Starting subtest: invalid-bpp
[326.025322] Subtest invalid-bpp: SUCCESS (0.000s)
[326.153956] [036/133] (693s left) gem_exec_nop (basic-parallel)
[326.215395] Starting subtest: basic-parallel
[342.873477] Subtest basic-parallel: SUCCESS (16.667s)
[343.126078] [037/133] (676s left) kms_addfb_basic (bad-pitch-256)
[343.180990] Starting subtest: bad-pitch-256
[343.184313] Subtest bad-pitch-256: SUCCESS (0.000s)
[343.327161] [038/133] (676s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-cpu)
[343.403327] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-cpu
[347.719684] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (4.319s)
[348.866123] [039/133] (670s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-fullscreen)
[348.942681] Starting subtest: psr-2p-scndscrn-spr-indfb-fullscreen
[348.946837] Subtest psr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[349.065713] [040/133] (670s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-pwrite)
[349.154466] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-pwrite
[349.158619] Subtest fbc-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[349.284088] [041/133] (670s left) gem_exec_balancer (bonded-sync)
[349.357425] Starting subtest: bonded-sync
[349.361841] Subtest bonded-sync: SKIP (0.000s)
[349.673898] [042/133] (670s left) i915_drm_fdinfo (busy)
[349.716667] Starting subtest: busy
[349.718576] Starting dynamic subtest: rcs0
[349.743287] Dynamic subtest rcs0: SKIP (0.028s)
[349.754983] Starting dynamic subtest: bcs0
[349.759366] Dynamic subtest bcs0: SKIP (0.000s)
[349.767481] Starting dynamic subtest: vcs0
[349.772212] Dynamic subtest vcs0: SKIP (0.000s)
[349.781504] Starting dynamic subtest: vcs1
[349.785434] Dynamic subtest vcs1: SKIP (0.000s)
[349.793224] Starting dynamic subtest: vecs0
[349.797154] Dynamic subtest vecs0: SKIP (0.000s)
[349.804856] Starting dynamic subtest: ccs0
[349.808669] Dynamic subtest ccs0: SKIP (0.000s)
[349.812599] Subtest busy: SKIP (0.033s)
[349.848851] [043/133] (670s left) gem_exec_create (forked)
[349.916593] Starting subtest: forked
[349.918964] Starting dynamic subtest: smem
[371.865164] Dynamic subtest smem: SUCCESS (21.948s)
[371.867887] Subtest forked: SUCCESS (21.950s)
[372.067639] [044/133] (647s left) kms_pm_rpm (modeset-non-lpsp)
[373.980423] Starting subtest: modeset-non-lpsp
[375.122644] Subtest modeset-non-lpsp: SKIP (1.141s)
[375.495647] [045/133] (644s left) gem_render_copy (yf-tiled-ccs-to-x-tiled)
[375.568069] Starting subtest: yf-tiled-ccs-to-x-tiled
[375.572404] Subtest yf-tiled-ccs-to-x-tiled: SKIP (0.000s)
[375.759123] [046/133] (644s left) gem_userptr_blits (nohangcheck)
[375.828909] Starting subtest: nohangcheck
[376.106106] Subtest nohangcheck: SUCCESS (0.274s)
[376.247950] [047/133] (643s left) gem_spin_batch (legacy)
[376.317522] Starting subtest: legacy
[376.319817] Starting dynamic subtest: default
[379.554300] Dynamic subtest default: SUCCESS (3.234s)
[379.565459] Starting dynamic subtest: render
[382.788681] Dynamic subtest render: SUCCESS (3.231s)
[382.799200] Starting dynamic subtest: bsd
[386.025552] Dynamic subtest bsd: SUCCESS (3.233s)
[386.035855] Starting dynamic subtest: bsd1
[389.260249] Dynamic subtest bsd1: SUCCESS (3.232s)
[389.271170] Starting dynamic subtest: bsd2
[392.494232] Dynamic subtest bsd2: SUCCESS (3.231s)
[392.504828] Starting dynamic subtest: blt
[395.729638] Dynamic subtest blt: SUCCESS (3.232s)
[395.740207] Starting dynamic subtest: vebox
[398.963914] Dynamic subtest vebox: SUCCESS (3.232s)
[398.966396] Subtest legacy: SUCCESS (22.645s)
[400.927197] [048/133] (619s left) kms_content_protection (dp-mst-lic-type-0)
[401.048223] Starting subtest: dp-mst-lic-type-0
[401.052807] Subtest dp-mst-lic-type-0: SKIP (0.000s)
[401.202129] [049/133] (618s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc)
[401.273084] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc
[408.195491] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (6.925s)
[408.332580] [050/133] (611s left) kms_plane (pixel-format-y-tiled-modifier)
[408.408049] Starting subtest: pixel-format-y-tiled-modifier
[408.421070] Subtest pixel-format-y-tiled-modifier: SKIP (0.000s)
[408.493039] [051/133] (611s left) prime_vgem (fence-flip-hang)
[408.572688] Subtest fence-flip-hang: SKIP (0.000s)
[408.693809] [052/133] (611s left) syncobj_basic (bad-fd-to-handle)
[408.750758] Starting subtest: bad-fd-to-handle
[408.753072] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[408.871052] [053/133] (611s left) kms_chamelium_hpd (vga-hpd)
[409.233864] Subtest vga-hpd: SKIP (0.000s)
[410.004190] [054/133] (610s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[410.097791] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu
[410.101772] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[410.194589] [055/133] (610s left) kms_selftest (drm_dp_mst_helper)
[410.230143] Starting subtest: drm_dp_mst_helper
[410.274986] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode
[410.407253] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.133s)
[410.416614] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_div
[410.555626] Dynamic subtest drm_test_dp_mst_calc_pbn_div: SUCCESS (0.149s)
[410.563605] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode
[410.733636] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.177s)
[410.735566] Subtest drm_dp_mst_helper: SUCCESS (0.504s)
[410.924612] [056/133] (609s left) prime_self_import (reimport-vs-gem_close-race)
[410.955824] Starting subtest: reimport-vs-gem_close-race
[416.064681] Subtest reimport-vs-gem_close-race: SUCCESS (5.107s)
[416.165126] [057/133] (604s left) kms_flip (blocking-absolute-wf_vblank)
[416.252170] Starting subtest: blocking-absolute-wf_vblank
[416.254491] Starting dynamic subtest: A-eDP1
[424.983501] Dynamic subtest A-eDP1: SUCCESS (8.733s)
[424.993609] Starting dynamic subtest: B-eDP1
[433.708170] Dynamic subtest B-eDP1: SUCCESS (8.723s)
[433.717829] Starting dynamic subtest: C-eDP1
[442.435161] Dynamic subtest C-eDP1: SUCCESS (8.725s)
[442.446875] Starting dynamic subtest: D-eDP1
[451.169821] Dynamic subtest D-eDP1: SUCCESS (8.733s)
[451.172115] Subtest blocking-absolute-wf_vblank: SUCCESS (34.922s)
[452.390102] [058/133] (568s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-submitted)
[452.459338] Starting subtest: multi-wait-all-for-submit-unsubmitted-submitted
[452.565365] Subtest multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.105s)
[452.663255] [059/133] (567s left) gem_reg_read (timestamp-monotonic)
[452.730995] Starting subtest: timestamp-monotonic
[456.822197] Subtest timestamp-monotonic: SUCCESS (4.090s)
[456.911965] [060/133] (563s left) gem_ctx_param (invalid-set-ringsize)
[456.974584] Starting subtest: invalid-set-ringsize
[456.977085] Subtest invalid-set-ringsize: SUCCESS (0.000s)
[457.058698] [061/133] (563s left) kms_chamelium_color (ctm-blue-to-red)
[457.141115] Subtest ctm-blue-to-red: SKIP (0.000s)
[457.185020] [062/133] (563s left) gem_ctx_param (invalid-size-get)
[457.237895] Starting subtest: invalid-size-get
[457.240312] Subtest invalid-size-get: SUCCESS (0.001s)
[457.357191] [063/133] (563s left) perf_pmu (busy-idle-no-semaphores)
[457.397984] Starting subtest: busy-idle-no-semaphores
[457.400433] Starting dynamic subtest: rcs0
[458.082062] Dynamic subtest rcs0: SUCCESS (0.684s)
[458.092923] Starting dynamic subtest: bcs0
[458.734665] Dynamic subtest bcs0: SUCCESS (0.649s)
[458.746599] Starting dynamic subtest: vcs0
[459.384788] Dynamic subtest vcs0: SUCCESS (0.648s)
[459.396732] Starting dynamic subtest: vcs1
[460.481324] Dynamic subtest vcs1: SUCCESS (1.093s)
[460.493208] Starting dynamic subtest: vecs0
[462.466931] Dynamic subtest vecs0: SUCCESS (1.982s)
[462.477257] Starting dynamic subtest: ccs0
[464.450760] Dynamic subtest ccs0: SUCCESS (1.981s)
[464.454038] Subtest busy-idle-no-semaphores: SUCCESS (7.054s)
[464.606881] [064/133] (556s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[464.695255] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[464.699558] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[464.813134] [065/133] (556s left) gem_exec_async (forked-writes)
[464.882490] Starting subtest: forked-writes
[464.884470] Starting dynamic subtest: rcs0
[464.909129] Dynamic subtest rcs0: SUCCESS (0.029s)
[464.917914] Starting dynamic subtest: bcs0
[464.936994] Dynamic subtest bcs0: SUCCESS (0.026s)
[464.945690] Starting dynamic subtest: vcs0
[464.958530] Dynamic subtest vcs0: SUCCESS (0.022s)
[464.967907] Starting dynamic subtest: vcs1
[464.980599] Dynamic subtest vcs1: SUCCESS (0.021s)
[464.989606] Starting dynamic subtest: vecs0
[465.003115] Dynamic subtest vecs0: SUCCESS (0.022s)
[465.012633] Starting dynamic subtest: ccs0
[465.026388] Dynamic subtest ccs0: SUCCESS (0.022s)
[465.028745] Subtest forked-writes: SUCCESS (0.147s)
[465.287908] [066/133] (555s left) kms_psr (fbc-pr-basic)
[465.359551] Starting subtest: fbc-pr-basic
[465.363664] Subtest fbc-pr-basic: SKIP (0.000s)
[465.445306] [067/133] (555s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[465.540411] Starting subtest: basic-flip-before-cursor-varying-size
[466.474784] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.934s)
[467.319697] [068/133] (553s left) kms_addfb_basic (invalid-set-prop-any)
[467.392798] Starting subtest: invalid-set-prop-any
[467.394892] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[467.532836] [069/133] (553s left) kms_psr (fbc-psr2-cursor-plane-move)
[467.626907] Starting subtest: fbc-psr2-cursor-plane-move
[467.629628] Starting dynamic subtest: eDP-1
[467.633778] Dynamic subtest eDP-1: SKIP (0.000s)
[467.637929] Subtest fbc-psr2-cursor-plane-move: SKIP (0.001s)
[467.722321] [070/133] (553s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers)
[467.793045] Starting subtest: plane-upscale-factor-0-25-with-modifiers
[467.795415] Starting dynamic subtest: pipe-A
[468.129384] Dynamic subtest pipe-A: SUCCESS (0.338s)
[468.137850] Starting dynamic subtest: pipe-B
[469.511449] Dynamic subtest pipe-B: SUCCESS (1.381s)
[469.519818] Starting dynamic subtest: pipe-C
[470.934222] Dynamic subtest pipe-C: SUCCESS (1.421s)
[470.942948] Starting dynamic subtest: pipe-D
[472.362371] Dynamic subtest pipe-D: SUCCESS (1.426s)
[472.364659] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (4.571s)
[473.549774] [071/133] (547s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-plflip-blt)
[473.637164] Starting subtest: fbc-1p-primscrn-shrfb-plflip-blt
[478.242503] Subtest fbc-1p-primscrn-shrfb-plflip-blt: SUCCESS (4.610s)
[479.458949] [072/133] (541s left) gem_render_copy (yf-tiled-ccs-to-y-tiled-ccs)
[479.522855] Starting subtest: yf-tiled-ccs-to-y-tiled-ccs
[479.527649] Subtest yf-tiled-ccs-to-y-tiled-ccs: SKIP (0.000s)
[479.714656] [073/133] (541s left) kms_hdr (bpc-switch)
[479.799478] Starting subtest: bpc-switch
[480.895265] Starting dynamic subtest: pipe-A-eDP-1
[484.387167] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.491s)
[484.389482] Subtest bpc-switch: SUCCESS (4.590s)
[484.544650] [074/133] (536s left) gem_tiled_wb
[484.687784] [075/133] (536s left) gem_workarounds (basic-read-context)
[484.752747] Starting subtest: basic-read-context
[484.763313] Subtest basic-read-context: SUCCESS (0.009s)
[484.920726] [076/133] (536s left) prime_vgem (basic-blt)
[485.018090] Starting subtest: basic-blt
[485.044989] Subtest basic-blt: SUCCESS (0.027s)
[485.196247] [077/133] (536s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt)
[485.273453] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt
[492.618738] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.348s)
[492.757436] [078/133] (528s left) kms_big_fb (y-tiled-8bpp-rotate-180)
[492.842415] Starting subtest: y-tiled-8bpp-rotate-180
[492.846476] Subtest y-tiled-8bpp-rotate-180: SKIP (0.000s)
[492.980418] [079/133] (528s left) i915_pm_rpm (reg-read-ioctl)
[495.073712] Starting subtest: reg-read-ioctl
[497.346285] Subtest reg-read-ioctl: SUCCESS (2.277s)
[497.721460] [080/133] (523s left) gem_exec_alignment (single)
[497.792331] Starting subtest: single
[497.794723] Subtest single: SUCCESS (0.002s)
[497.923072] [081/133] (523s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs)
[497.998967] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-mc-ccs
[498.001166] Starting dynamic subtest: pipe-A-eDP-1
[498.236093] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.204s)
[498.247050] Starting dynamic subtest: pipe-B-eDP-1
[499.467534] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.232s)
[499.477287] Starting dynamic subtest: pipe-C-eDP-1
[500.695164] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.225s)
[500.706044] Starting dynamic subtest: pipe-D-eDP-1
[501.904955] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.210s)
[501.906895] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SUCCESS (3.876s)
[503.139418] [082/133] (518s left) gem_userptr_blits (unsync-overlap)
[503.209582] Subtest unsync-overlap: SKIP (0.000s)
[503.356419] [083/133] (518s left) kms_psr (psr-sprite-mmap-gtt)
[503.446327] Starting subtest: psr-sprite-mmap-gtt
[503.448511] Starting dynamic subtest: eDP-1
[504.859028] Dynamic subtest eDP-1: SKIP (1.408s)
[504.863524] Subtest psr-sprite-mmap-gtt: SKIP (1.410s)
[505.027165] [084/133] (516s left) kms_atomic_interruptible (legacy-cursor)
[505.118985] Starting subtest: legacy-cursor
[505.121138] Starting dynamic subtest: pipe-A-eDP-1
[512.512804] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.392s)
[512.515099] Subtest legacy-cursor: SUCCESS (7.393s)
[513.364434] [085/133] (508s left) kms_psr (fbc-psr-primary-page-flip)
[513.448152] Starting subtest: fbc-psr-primary-page-flip
[513.450450] Starting dynamic subtest: eDP-1
[513.454823] Dynamic subtest eDP-1: SKIP (0.000s)
[513.459229] Subtest fbc-psr-primary-page-flip: SKIP (0.001s)
[513.537896] [086/133] (508s left) kms_addfb_basic (invalid-smem-bo-on-discrete)
[513.590291] Starting subtest: invalid-smem-bo-on-discrete
[513.594668] Subtest invalid-smem-bo-on-discrete: SKIP (0.000s)
[513.729647] [087/133] (508s left) gem_busy (close-race)
[513.801654] Starting subtest: close-race
[539.865363] Subtest close-race: SUCCESS (26.060s)
[540.272624] [088/133] (481s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible)
[540.396331] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible
[540.406126] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SKIP (0.008s)
[540.541201] [089/133] (481s left) kms_color (degamma)
[540.626795] Starting subtest: degamma
[540.629061] Starting dynamic subtest: pipe-A-eDP-1
[541.351261] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.725s)
[541.360702] Starting dynamic subtest: pipe-B-eDP-1
[542.790453] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.435s)
[542.799894] Starting dynamic subtest: pipe-C-eDP-1
[544.139257] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.349s)
[544.148355] Starting dynamic subtest: pipe-D-eDP-1
[545.466166] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.327s)
[545.468350] Subtest degamma: SUCCESS (4.839s)
[546.291655] [090/133] (475s left) perf_pmu (all-busy-idle-check-all)
[546.342286] Starting subtest: all-busy-idle-check-all
[547.864726] Subtest all-busy-idle-check-all: SUCCESS (1.522s)
[547.970562] [091/133] (473s left) perf (gen12-mi-rpc)
[548.128200] Starting subtest: gen12-mi-rpc
[548.130088] Starting dynamic subtest: rcs0
[548.147860] Dynamic subtest rcs0: SUCCESS (0.019s)
[548.150118] Subtest gen12-mi-rpc: SUCCESS (0.020s)
[548.195507] [092/133] (473s left) kms_dsc (dsc-with-output-formats)
[548.319832] Starting subtest: dsc-with-output-formats
[548.341606] Subtest dsc-with-output-formats: SKIP (0.000s)
[548.406619] [093/133] (473s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier)
[548.479877] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier
[548.492972] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier: SKIP (0.000s)
[548.559733] [094/133] (473s left) gem_exec_fence (syncobj-timeline-wait)
[549.125275] Starting subtest: syncobj-timeline-wait
[550.923931] Subtest syncobj-timeline-wait: SUCCESS (1.798s)
[552.977336] [095/133] (469s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[553.063344] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[553.067479] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[553.148092] [096/133] (468s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc)
[553.224023] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc
[553.226290] Starting dynamic subtest: pipe-A-eDP-1
[553.249130] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[553.260531] Starting dynamic subtest: pipe-B-eDP-1
[553.282426] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[553.291669] Starting dynamic subtest: pipe-C-eDP-1
[553.313754] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[553.322695] Starting dynamic subtest: pipe-D-eDP-1
[553.346796] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[553.350884] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[555.457904] [097/133] (466s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-onoff)
[555.547537] Starting subtest: fbc-1p-primscrn-spr-indfb-onoff
[559.546246] Subtest fbc-1p-primscrn-spr-indfb-onoff: SUCCESS (4.002s)
[560.748391] [098/133] (461s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-mc-ccs)
[560.833272] Starting subtest: ccs-on-another-bo-y-tiled-gen12-mc-ccs
[560.835581] Starting dynamic subtest: pipe-A-eDP-1
[560.857452] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[560.866973] Starting dynamic subtest: pipe-B-eDP-1
[560.888593] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[560.897482] Starting dynamic subtest: pipe-C-eDP-1
[560.919106] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[560.927250] Starting dynamic subtest: pipe-D-eDP-1
[560.948904] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[560.953303] Subtest ccs-on-another-bo-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[563.089900] [099/133] (459s left) kms_psr2_sf (pr-cursor-plane-update-sf)
[563.171760] Starting subtest: pr-cursor-plane-update-sf
[563.176171] Subtest pr-cursor-plane-update-sf: SKIP (0.000s)
[563.240487] [100/133] (459s left) i915_suspend (sysfs-reader)
[563.288948] Starting subtest: sysfs-reader
[581.396861] Subtest sysfs-reader: SUCCESS (3.223s)
[581.476734] [101/133] (440s left) kms_lease (lease-revoke)
[581.576819] Starting subtest: lease-revoke
[581.578665] Starting dynamic subtest: pipe-A-eDP-1
[581.609890] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.032s)
[581.625833] Starting dynamic subtest: pipe-B-eDP-1
[581.655028] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.042s)
[581.670449] Starting dynamic subtest: pipe-C-eDP-1
[581.683830] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.028s)
[581.698457] Starting dynamic subtest: pipe-D-eDP-1
[581.708875] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.026s)
[581.710831] Subtest lease-revoke: SUCCESS (0.134s)
[581.856799] [102/133] (440s left) kms_invalid_mode (bad-hsync-start)
[581.942196] Starting subtest: bad-hsync-start
[581.944135] Starting dynamic subtest: pipe-A-eDP-1
[582.243195] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.296s)
[582.253767] Starting dynamic subtest: pipe-B-eDP-1
[582.255937] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[582.265578] Starting dynamic subtest: pipe-C-eDP-1
[582.267449] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[582.276719] Starting dynamic subtest: pipe-D-eDP-1
[582.278563] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[582.280431] Subtest bad-hsync-start: SUCCESS (0.302s)
[583.117919] [103/133] (439s left) kms_psr (psr2-sprite-plane-onoff)
[583.204873] Starting subtest: psr2-sprite-plane-onoff
[583.207070] Starting dynamic subtest: eDP-1
[584.905079] Dynamic subtest eDP-1: SUCCESS (1.698s)
[584.907407] Subtest psr2-sprite-plane-onoff: SUCCESS (1.699s)
[585.780804] [104/133] (436s left) vgem_slow (nohang)
[585.821458] Starting subtest: nohang
[596.058793] Subtest nohang: SUCCESS (10.230s)
[596.136756] [105/133] (426s left) syncobj_timeline (single-wait-all-for-submit-available-submitted)
[596.196313] Starting subtest: single-wait-all-for-submit-available-submitted
[596.198902] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.000s)
[596.332985] [106/133] (426s left) gem_exec_reloc (basic-gtt)
[596.385601] Subtest basic-gtt: SKIP (0.000s)
[596.458073] [107/133] (426s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[596.547434] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip
[596.551917] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[596.680717] [108/133] (425s left) syncobj_wait (invalid-signal-one-illegal-handle)
[596.748940] Starting subtest: invalid-signal-one-illegal-handle
[596.751243] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[596.869859] [109/133] (425s left) kms_atomic (atomic-invalid-params)
[596.941254] Starting subtest: atomic-invalid-params
[596.943509] Starting dynamic subtest: pipe-A-eDP-1
[597.343223] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.400s)
[597.345525] Subtest atomic-invalid-params: SUCCESS (0.402s)
[598.231933] [110/133] (424s left) kms_cursor_crc (cursor-sliding-128x42)
[598.448240] Starting subtest: cursor-sliding-128x42
[598.491769] Subtest cursor-sliding-128x42: SKIP (0.038s)
[598.716504] [111/133] (424s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-blt)
[598.799125] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-blt
[605.532784] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-blt: SUCCESS (6.735s)
[605.679361] [112/133] (417s left) kms_vblank (crtc-id)
[605.753362] Starting subtest: crtc-id
[605.755671] Starting dynamic subtest: pipe-A-eDP-1
[606.199764] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.445s)
[606.217655] Starting dynamic subtest: pipe-D-eDP-1
[607.339746] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.138s)
[607.341977] Subtest crtc-id: SUCCESS (1.587s)
[608.184367] [113/133] (414s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[608.277572] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[608.281738] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[608.406457] [114/133] (414s left) kms_plane_cursor (primary)
[608.499325] Starting subtest: primary
[608.504035] Starting dynamic subtest: pipe-A-eDP-1-size-64
[611.076372] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.576s)
[611.100741] Starting dynamic subtest: pipe-A-eDP-1-size-128
[613.622065] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.527s)
[613.647774] Starting dynamic subtest: pipe-A-eDP-1-size-256
[616.169659] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.527s)
[616.487030] Starting dynamic subtest: pipe-B-eDP-1-size-64
[619.774253] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.297s)
[619.800174] Starting dynamic subtest: pipe-B-eDP-1-size-128
[622.410860] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.616s)
[622.435594] Starting dynamic subtest: pipe-B-eDP-1-size-256
[624.977512] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.549s)
[625.297848] Starting dynamic subtest: pipe-C-eDP-1-size-64
[628.178926] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.891s)
[628.209280] Starting dynamic subtest: pipe-C-eDP-1-size-128
[630.379841] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.181s)
[630.407557] Starting dynamic subtest: pipe-C-eDP-1-size-256
[632.569850] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.169s)
[632.894657] Starting dynamic subtest: pipe-D-eDP-1-size-64
[635.747762] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.864s)
[635.775855] Starting dynamic subtest: pipe-D-eDP-1-size-128
[637.915574] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.147s)
[637.943321] Starting dynamic subtest: pipe-D-eDP-1-size-256
[640.160808] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.224s)
[640.468954] Subtest primary: SUCCESS (31.958s)
[641.311082] [115/133] (381s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[641.395438] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[641.399657] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s)
[641.481792] [116/133] (381s left) kms_big_fb (linear-16bpp-rotate-180)
[641.579651] Starting subtest: linear-16bpp-rotate-180
[642.825482] Subtest linear-16bpp-rotate-180: SUCCESS (1.244s)
[642.983768] [117/133] (380s left) kms_vrr (flip-basic)
[643.063508] Starting subtest: flip-basic
[643.069115] Subtest flip-basic: SKIP (0.000s)
[643.153593] [118/133] (379s left) kms_chamelium_edid (vga-edid-read)
[643.521900] Subtest vga-edid-read: SKIP (0.000s)
[644.315464] [119/133] (378s left) kms_pm_dc (dc5-dpms-negative)
[645.399180] Starting subtest: dc5-dpms-negative
[645.403312] Subtest dc5-dpms-negative: SKIP (0.000s)
[645.486966] [120/133] (377s left) kms_cursor_crc (cursor-sliding-256x85)
[645.726646] Starting subtest: cursor-sliding-256x85
[645.769434] Subtest cursor-sliding-256x85: SKIP (0.040s)
[645.977932] [121/133] (377s left) gem_blits (basic)
[646.043712] Starting subtest: basic
[647.298031] Subtest basic: SUCCESS (1.255s)
[647.446869] [122/133] (375s left) gem_mmap_offset (blt-coherency)
[647.498021] Starting subtest: blt-coherency
[647.503293] Subtest blt-coherency: SUCCESS (0.008s)
[647.653488] [123/133] (375s left) syncobj_timeline (invalid-signal-bad-pad)
[647.708943] Starting subtest: invalid-signal-bad-pad
[647.711249] Subtest invalid-signal-bad-pad: SUCCESS (0.000s)
[647.819222] [124/133] (375s left) kms_ccs (bad-pixel-format-y-tiled-ccs)
[647.897422] Starting subtest: bad-pixel-format-y-tiled-ccs
[647.899681] Starting dynamic subtest: pipe-A-eDP-1
[647.922438] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[647.938896] Starting dynamic subtest: pipe-B-eDP-1
[647.960728] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[647.970340] Starting dynamic subtest: pipe-C-eDP-1
[647.992009] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[648.001310] Starting dynamic subtest: pipe-D-eDP-1
[648.022823] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[648.026895] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.004s)
[650.237488] [125/133] (373s left) gem_exec_fence (syncobj-channel)
[650.683325] Starting subtest: syncobj-channel
[651.704187] Subtest syncobj-channel: SUCCESS (1.017s)
[652.009517] [126/133] (371s left) gem_userptr_blits (forbidden-operations)
[652.085990] Starting subtest: forbidden-operations
[652.090125] Subtest forbidden-operations: SKIP (0.000s)
[652.238931] [127/133] (371s left) gem_flink_basic (double-flink)
[652.304119] Starting subtest: double-flink
[652.306137] Subtest double-flink: SUCCESS (0.000s)
[652.452809] [128/133] (371s left) gem_ctx_persistence (heartbeat-hang)
[652.508452] Starting subtest: heartbeat-hang
[652.513074] Subtest heartbeat-hang: SKIP (0.000s)
[652.647165] [129/133] (370s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[652.748073] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[653.816018] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.067s)
[653.983212] [130/133] (369s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[654.078100] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[654.714446] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.637s)
[654.920188] [131/133] (368s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[655.030980] Starting subtest: basic-flip-before-cursor-legacy
[655.951316] Subtest basic-flip-before-cursor-legacy: SUCCESS (0.920s)
[656.751485] [132/133] (366s left) api_intel_bb (reset-flags)
[656.815279] Starting subtest: reset-flags
[656.831549] Subtest reset-flags: SUCCESS (0.016s)
[656.970060] [133/133] (366s left) kms_psr (pr-sprite-render)
[657.046331] Starting subtest: pr-sprite-render
[657.050541] Subtest pr-sprite-render: SKIP (0.000s)
[657.131116] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_whisper
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_flip
results: parsing output: 3/ for test: kms_psr2_sf
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_rotation_crc
results: parsing output: 6/ for test: api_intel_allocator
results: parsing output: 7/ for test: gem_exec_reloc
results: parsing output: 8/ for test: kms_frontbuffer_tracking
results: parsing output: 9/ for test: gem_mmap_gtt
results: parsing output: 10/ for test: gem_mmap_wc
results: parsing output: 11/ for test: gem_exec_create
results: parsing output: 12/ for test: kms_dither
results: parsing output: 13/ for test: kms_big_fb
results: parsing output: 14/ for test: kms_cursor_crc
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: syncobj_wait
results: parsing output: 17/ for test: kms_busy
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: syncobj_timeline
results: parsing output: 20/ for test: gem_exec_schedule
results: parsing output: 21/ for test: gem_ctx_engines
results: parsing output: 22/ for test: gen7_exec_parse
results: parsing output: 23/ for test: kms_flip_scaled_crc
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: syncobj_timeline
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: gem_exec_schedule
results: parsing output: 28/ for test: gem_exec_schedule
results: parsing output: 29/ for test: prime_self_import
results: parsing output: 30/ for test: gem_exec_reloc
results: parsing output: 31/ for test: i915_hangman
results: parsing output: 32/ for test: kms_plane_cursor
results: parsing output: 33/ for test: sysfs_timeslice_duration
results: parsing output: 34/ for test: dumb_buffer
results: parsing output: 35/ for test: gem_exec_nop
results: parsing output: 36/ for test: kms_addfb_basic
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: gem_exec_balancer
results: parsing output: 41/ for test: i915_drm_fdinfo
results: parsing output: 42/ for test: gem_exec_create
results: parsing output: 43/ for test: kms_pm_rpm
results: parsing output: 44/ for test: gem_render_copy
results: parsing output: 45/ for test: gem_userptr_blits
results: parsing output: 46/ for test: gem_spin_batch
results: parsing output: 47/ for test: kms_content_protection
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_plane
results: parsing output: 50/ for test: prime_vgem
results: parsing output: 51/ for test: syncobj_basic
results: parsing output: 52/ for test: kms_chamelium_hpd
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_selftest
results: parsing output: 55/ for test: prime_self_import
results: parsing output: 56/ for test: kms_flip
results: parsing output: 57/ for test: syncobj_wait
results: parsing output: 58/ for test: gem_reg_read
results: parsing output: 59/ for test: gem_ctx_param
results: parsing output: 60/ for test: kms_chamelium_color
results: parsing output: 61/ for test: gem_ctx_param
results: parsing output: 62/ for test: perf_pmu
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: gem_exec_async
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: kms_cursor_legacy
results: parsing output: 67/ for test: kms_addfb_basic
results: parsing output: 68/ for test: kms_psr
results: parsing output: 69/ for test: kms_plane_scaling
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: gem_render_copy
results: parsing output: 72/ for test: kms_hdr
results: parsing output: 73/ for test: gem_tiled_wb
results: parsing output: 74/ for test: gem_workarounds
results: parsing output: 75/ for test: prime_vgem
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_big_fb
results: parsing output: 78/ for test: i915_pm_rpm
results: parsing output: 79/ for test: gem_exec_alignment
results: parsing output: 80/ for test: kms_ccs
results: parsing output: 81/ for test: gem_userptr_blits
results: parsing output: 82/ for test: kms_psr
results: parsing output: 83/ for test: kms_atomic_interruptible
results: parsing output: 84/ for test: kms_psr
results: parsing output: 85/ for test: kms_addfb_basic
results: parsing output: 86/ for test: gem_busy
results: parsing output: 87/ for test: kms_flip
results: parsing output: 88/ for test: kms_color
results: parsing output: 89/ for test: perf_pmu
results: parsing output: 90/ for test: perf
results: parsing output: 91/ for test: kms_dsc
results: parsing output: 92/ for test: kms_plane
results: parsing output: 93/ for test: gem_exec_fence
results: parsing output: 94/ for test: kms_flip_scaled_crc
results: parsing output: 95/ for test: kms_ccs
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_ccs
results: parsing output: 98/ for test: kms_psr2_sf
results: parsing output: 99/ for test: i915_suspend
results: parsing output: 100/ for test: kms_lease
results: parsing output: 101/ for test: kms_invalid_mode
results: parsing output: 102/ for test: kms_psr
results: parsing output: 103/ for test: vgem_slow
results: parsing output: 104/ for test: syncobj_timeline
results: parsing output: 105/ for test: gem_exec_reloc
results: parsing output: 106/ for test: kms_big_fb
results: parsing output: 107/ for test: syncobj_wait
results: parsing output: 108/ for test: kms_atomic
results: parsing output: 109/ for test: kms_cursor_crc
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_vblank
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_plane_cursor
results: parsing output: 114/ for test: kms_flip_scaled_crc
results: parsing output: 115/ for test: kms_big_fb
results: parsing output: 116/ for test: kms_vrr
results: parsing output: 117/ for test: kms_chamelium_edid
results: parsing output: 118/ for test: kms_pm_dc
results: parsing output: 119/ for test: kms_cursor_crc
results: parsing output: 120/ for test: gem_blits
results: parsing output: 121/ for test: gem_mmap_offset
results: parsing output: 122/ for test: syncobj_timeline
results: parsing output: 123/ for test: kms_ccs
results: parsing output: 124/ for test: gem_exec_fence
results: parsing output: 125/ for test: gem_userptr_blits
results: parsing output: 126/ for test: gem_flink_basic
results: parsing output: 127/ for test: gem_ctx_persistence
results: parsing output: 128/ for test: kms_big_fb
results: parsing output: 129/ for test: kms_big_fb
results: parsing output: 130/ for test: kms_cursor_legacy
results: parsing output: 131/ for test: api_intel_bb
results: parsing output: 132/ for test: kms_psr
Done.