[57.434191] Initializing watchdogs
[57.434284]   /dev/watchdog0
[57.451187] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[57.455710] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.457994] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.461514] [001/133] (960s left) kms_color (invalid-ctm-matrix-sizes)
[57.582887] Starting subtest: invalid-ctm-matrix-sizes
[57.585255] Starting dynamic subtest: pipe-A
[57.587489] Dynamic subtest pipe-A: SUCCESS (0.003s)
[57.596592] Starting dynamic subtest: pipe-B
[57.598781] Dynamic subtest pipe-B: SUCCESS (0.003s)
[57.605795] Starting dynamic subtest: pipe-C
[57.607625] Dynamic subtest pipe-C: SUCCESS (0.007s)
[57.616038] Starting dynamic subtest: pipe-D
[57.618213] Dynamic subtest pipe-D: SUCCESS (0.005s)
[57.620349] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.019s)
[57.681629] [002/133] (960s left) gem_mmap_gtt (big-copy)
[57.757792] Subtest big-copy: SKIP (0.000s)
[57.808160] [003/133] (960s left) kms_psr (psr-primary-page-flip)
[57.894958] Starting subtest: psr-primary-page-flip
[57.897402] Starting dynamic subtest: eDP-1
[59.636504] Dynamic subtest eDP-1: SUCCESS (1.742s)
[59.638828] Subtest psr-primary-page-flip: SUCCESS (1.743s)
[60.495936] [004/133] (957s left) api_intel_bb (object-reloc-purge-cache)
[60.553571] Starting subtest: object-reloc-purge-cache
[60.558585] Subtest object-reloc-purge-cache: SKIP (0.003s)
[60.670843] [005/133] (957s left) kms_invalid_mode (overflow-vrefresh)
[60.766738] Starting subtest: overflow-vrefresh
[60.769217] Starting dynamic subtest: pipe-A-eDP-1
[61.047784] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[61.056526] Starting dynamic subtest: pipe-B-eDP-1
[61.058781] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[61.065740] Starting dynamic subtest: pipe-C-eDP-1
[61.068090] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[61.075126] Starting dynamic subtest: pipe-D-eDP-1
[61.077242] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[61.079215] Subtest overflow-vrefresh: SUCCESS (0.289s)
[61.923221] [006/133] (956s left) gem_mmap_offset (blt-coherency)
[61.979032] Starting subtest: blt-coherency
[61.987837] Subtest blt-coherency: SUCCESS (0.011s)
[62.095409] [007/133] (956s left) gem_pxp (reject-modify-context-protection-off-3)
[62.224582] Starting subtest: reject-modify-context-protection-off-3
[62.227083] Subtest reject-modify-context-protection-off-3: SUCCESS (0.002s)
[62.331353] [008/133] (955s left) syncobj_timeline (single-wait-for-submit-available-submitted)
[62.378396] Starting subtest: single-wait-for-submit-available-submitted
[62.380807] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.000s)
[62.465150] [009/133] (955s left) kms_atomic_transition (modeset-transition-nonblocking-fencing)
[62.561160] Starting subtest: modeset-transition-nonblocking-fencing
[62.563512] Starting dynamic subtest: 1x-outputs
[73.404041] Dynamic subtest 1x-outputs: SUCCESS (10.843s)
[73.406677] Subtest modeset-transition-nonblocking-fencing: SUCCESS (10.844s)
[74.259180] [010/133] (944s left) kms_big_fb (y-tiled-addfb-size-overflow)
[74.372817] Starting subtest: y-tiled-addfb-size-overflow
[74.377198] Subtest y-tiled-addfb-size-overflow: SKIP (0.000s)
[74.466575] [011/133] (943s left) gem_mmap (bad-size)
[74.530346] Subtest bad-size: SKIP (0.000s)
[74.598603] [012/133] (943s left) syncobj_wait (multi-wait-all-submitted-signaled)
[74.645610] Starting subtest: multi-wait-all-submitted-signaled
[74.754414] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.107s)
[74.826222] [013/133] (943s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-downscaling)
[74.918787] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-downscaling
[74.921336] Starting dynamic subtest: pipe-A-default-mode
[76.032965] Dynamic subtest pipe-A-default-mode: SKIP (1.114s)
[76.037173] Subtest flip-32bpp-4tile-to-64bpp-4tile-downscaling: SKIP (1.115s)
[76.185270] [014/133] (942s left) syncobj_timeline (reset-multiple-signaled)
[76.250082] Starting subtest: reset-multiple-signaled
[76.252555] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[76.354279] [015/133] (942s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[76.455575] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[77.090539] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.637s)
[77.274953] [016/133] (941s left) i915_hangman (engine-engine-error)
[77.344712] Starting subtest: engine-engine-error
[77.347049] Starting dynamic subtest: rcs0
[78.838089] Dynamic subtest rcs0: SUCCESS (1.494s)
[78.848778] Starting dynamic subtest: bcs0
[80.885103] Dynamic subtest bcs0: SUCCESS (2.045s)
[80.896222] Starting dynamic subtest: vcs0
[82.869394] Dynamic subtest vcs0: SUCCESS (1.983s)
[82.880563] Starting dynamic subtest: vcs1
[84.852529] Dynamic subtest vcs1: SUCCESS (1.982s)
[84.863236] Starting dynamic subtest: vecs0
[86.901249] Dynamic subtest vecs0: SUCCESS (2.047s)
[86.910400] Starting dynamic subtest: ccs0
[88.884448] Dynamic subtest ccs0: SUCCESS (1.982s)
[88.886939] Subtest engine-engine-error: SUCCESS (11.540s)
[89.004641] [017/133] (929s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-gtt)
[89.106650] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-gtt
[89.110901] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[89.200951] [018/133] (929s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-render)
[89.306841] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-render
[96.616676] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.314s)
[96.749059] [019/133] (921s left) kms_plane_alpha_blend (constant-alpha-max)
[96.844932] Starting subtest: constant-alpha-max
[97.132195] Starting dynamic subtest: pipe-A-eDP-1
[98.263820] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.131s)
[98.273584] Starting dynamic subtest: pipe-D-eDP-1
[99.831979] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.565s)
[99.834402] Subtest constant-alpha-max: SUCCESS (2.986s)
[100.690778] [020/133] (917s left) i915_pm_rpm (debugfs-read)
[102.229381] Starting subtest: debugfs-read
[103.391323] Subtest debugfs-read: SUCCESS (1.159s)
[103.770478] [021/133] (914s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c)
[103.822157] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s)
[103.882510] [022/133] (914s left) kms_atomic_interruptible (legacy-pageflip)
[103.970175] Starting subtest: legacy-pageflip
[103.972494] Starting dynamic subtest: pipe-A-eDP-1
[111.377493] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.406s)
[111.379421] Subtest legacy-pageflip: SUCCESS (7.407s)
[112.214105] [023/133] (906s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-pwrite)
[112.310679] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-pwrite
[121.833924] Subtest psr-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (9.526s)
[121.958751] [024/133] (896s left) kms_cursor_legacy (flip-vs-cursor-legacy)
[122.090615] Starting subtest: flip-vs-cursor-legacy
[129.627277] Subtest flip-vs-cursor-legacy: SUCCESS (7.535s)
[130.490310] [025/133] (888s left) i915_pm_sseu (full-enable)
[130.543157] Subtest full-enable: SKIP (0.000s)
[130.641739] [026/133] (888s left) syncobj_basic (test-valid-cycle)
[130.690948] Starting subtest: test-valid-cycle
[130.693274] Subtest test-valid-cycle: SUCCESS (0.000s)
[130.792192] [027/133] (888s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt)
[130.894801] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt
[138.268482] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.377s)
[138.392836] [028/133] (880s left) prime_busy (before)
[138.446644] Starting subtest: before
[138.451691] Starting dynamic subtest: rcs0
[138.481928] Dynamic subtest rcs0: SUCCESS (0.032s)
[138.491937] Starting dynamic subtest: bcs0
[138.522232] Dynamic subtest bcs0: SUCCESS (0.040s)
[138.531077] Starting dynamic subtest: vcs0
[138.562485] Dynamic subtest vcs0: SUCCESS (0.040s)
[138.571618] Starting dynamic subtest: vcs1
[138.604066] Dynamic subtest vcs1: SUCCESS (0.041s)
[138.613277] Starting dynamic subtest: vecs0
[138.646686] Dynamic subtest vecs0: SUCCESS (0.042s)
[138.657844] Starting dynamic subtest: ccs0
[138.688273] Dynamic subtest ccs0: SUCCESS (0.041s)
[138.797244] Subtest before: SUCCESS (0.349s)
[138.886608] [029/133] (880s left) kms_pm_rpm (modeset-non-lpsp-stress)
[141.114928] Starting subtest: modeset-non-lpsp-stress
[142.280225] Subtest modeset-non-lpsp-stress: SKIP (1.165s)
[142.654287] [030/133] (876s left) gem_render_copy (yf-tiled-to-vebox-x-tiled)
[142.715999] Starting subtest: yf-tiled-to-vebox-x-tiled
[142.720554] Subtest yf-tiled-to-vebox-x-tiled: SKIP (0.000s)
[142.897739] [031/133] (876s left) kms_flip (flip-vs-dpms-off-vs-modeset)
[142.997975] Starting subtest: flip-vs-dpms-off-vs-modeset
[143.000363] Starting dynamic subtest: A-eDP1
[146.573630] Dynamic subtest A-eDP1: SUCCESS (3.571s)
[146.583102] Starting dynamic subtest: B-eDP1
[149.787283] Dynamic subtest B-eDP1: SUCCESS (3.215s)
[149.795874] Starting dynamic subtest: C-eDP1
[152.905495] Dynamic subtest C-eDP1: SUCCESS (3.114s)
[152.914703] Starting dynamic subtest: D-eDP1
[156.118357] Dynamic subtest D-eDP1: SUCCESS (3.214s)
[156.120772] Subtest flip-vs-dpms-off-vs-modeset: SUCCESS (13.124s)
[156.947582] [032/133] (862s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[157.059599] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu
[161.283655] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (4.227s)
[162.441298] [033/133] (856s left) kms_psr (psr2-dpms)
[162.543402] Starting subtest: psr2-dpms
[162.545816] Starting dynamic subtest: eDP-1
[165.454964] Dynamic subtest eDP-1: SUCCESS (2.912s)
[165.457247] Subtest psr2-dpms: SUCCESS (2.912s)
[166.326922] [034/133] (852s left) kms_rotation_crc (bad-pixel-format)
[166.435076] Starting subtest: bad-pixel-format
[166.439488] Subtest bad-pixel-format: SKIP (0.001s)
[166.510373] [035/133] (852s left) gem_eio (in-flight-suspend)
[166.738510] Starting subtest: in-flight-suspend
[212.384485] Subtest in-flight-suspend: SUCCESS (16.503s)
[220.537693] [FACT gem_eio (in-flight-suspend)] new: kernel.kmod_is_loaded.vgem: true
[220.542362] [036/133] (806s left) kms_plane_scaling (plane-downscale-factor-0-5-with-modifiers)
[220.649927] Starting subtest: plane-downscale-factor-0-5-with-modifiers
[220.652208] Starting dynamic subtest: pipe-A
[220.670106] Dynamic subtest pipe-A: SKIP (0.017s)
[220.679678] Starting dynamic subtest: pipe-B
[220.700095] Dynamic subtest pipe-B: SKIP (0.029s)
[220.709391] Starting dynamic subtest: pipe-C
[220.729970] Dynamic subtest pipe-C: SKIP (0.031s)
[220.739108] Starting dynamic subtest: pipe-D
[220.767937] Dynamic subtest pipe-D: SKIP (0.036s)
[220.771604] Subtest plane-downscale-factor-0-5-with-modifiers: SKIP (0.114s)
[220.876762] [037/133] (806s left) i915_drm_fdinfo (virtual-busy)
[220.915084] Starting subtest: virtual-busy
[220.919226] Subtest virtual-busy: SKIP (0.000s)
[220.983187] [038/133] (806s left) kms_sequence (get-idle)
[221.082967] Starting subtest: get-idle
[221.087092] Starting dynamic subtest: pipe-A-eDP-1
[222.878323] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.799s)
[222.889366] Starting dynamic subtest: pipe-B-eDP-1
[225.332798] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.450s)
[225.342859] Starting dynamic subtest: pipe-C-eDP-1
[227.755572] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.420s)
[227.765867] Starting dynamic subtest: pipe-D-eDP-1
[230.190422] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.434s)
[230.192650] Subtest get-idle: SUCCESS (9.108s)
[230.994490] [039/133] (796s left) core_setmaster (master-drop-set-user)
[231.078535] Starting subtest: master-drop-set-user
[231.092893] Subtest master-drop-set-user: SUCCESS (0.014s)
[231.133545] [040/133] (796s left) kms_chamelium_color (ctm-green-to-red)
[231.225189] Subtest ctm-green-to-red: SKIP (0.000s)
[231.274928] [041/133] (796s left) gem_mmap_wc (set-cache-level)
[231.328971] Subtest set-cache-level: SKIP (0.000s)
[231.389613] [042/133] (796s left) gem_ctx_persistence (legacy-engines-persistence)
[231.449012] Starting subtest: legacy-engines-persistence
[231.451294] Starting dynamic subtest: render
[232.240814] Dynamic subtest render: SUCCESS (0.791s)
[232.252715] Starting dynamic subtest: bsd1
[233.008653] Dynamic subtest bsd1: SUCCESS (0.765s)
[233.020350] Starting dynamic subtest: bsd2
[233.772580] Dynamic subtest bsd2: SUCCESS (0.761s)
[233.784683] Starting dynamic subtest: blt
[234.516671] Dynamic subtest blt: SUCCESS (0.742s)
[234.528695] Starting dynamic subtest: vebox
[235.309549] Dynamic subtest vebox: SUCCESS (0.790s)
[235.312298] Subtest legacy-engines-persistence: SUCCESS (3.861s)
[235.395307] [043/133] (792s left) gem_ctx_isolation (preservation-s3)
[235.469645] Starting subtest: preservation-S3
[235.472416] Starting dynamic subtest: rcs0
[251.808865] Dynamic subtest rcs0: SUCCESS (1.334s)
[251.820442] Starting dynamic subtest: bcs0
[267.822766] Dynamic subtest bcs0: SUCCESS (1.329s)
[267.837615] Starting dynamic subtest: vcs0
[283.826775] Dynamic subtest vcs0: SUCCESS (2.996s)
[283.836435] Starting dynamic subtest: vcs1
[301.816534] Dynamic subtest vcs1: SUCCESS (4.955s)
[301.829584] Starting dynamic subtest: vecs0
[319.815585] Dynamic subtest vecs0: SUCCESS (5.006s)
[319.830135] Starting dynamic subtest: ccs0
[337.815491] Dynamic subtest ccs0: SUCCESS (3.154s)
[337.817851] Subtest preservation-S3: SUCCESS (18.781s)
[338.052770] [044/133] (689s left) kms_feature_discovery (psr1)
[338.152492] Starting subtest: psr1
[338.154833] Subtest psr1: SUCCESS (0.000s)
[338.229602] [045/133] (689s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-pgflip-blt)
[338.327772] Starting subtest: psr-2p-scndscrn-indfb-pgflip-blt
[338.331870] Subtest psr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[338.430460] [046/133] (689s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[338.518615] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[338.522647] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[338.613684] [047/133] (689s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[338.715506] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip
[339.821258] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip: FAIL (0.507s)
[339.863467] [048/133] (688s left) gem_ccs (ctrl-surf-copy-new-ctx)
[339.922436] Starting subtest: ctrl-surf-copy-new-ctx
[339.926558] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s)
[340.015926] [049/133] (687s left) gem_exec_suspend (basic-s0)
[340.077550] Starting subtest: basic-S0
[340.079745] Starting dynamic subtest: smem
[360.723002] Dynamic subtest smem: SUCCESS (6.543s)
[360.726148] Subtest basic-S0: SUCCESS (6.546s)
[360.913769] [050/133] (667s left) kms_prop_blob (invalid-set-prop)
[360.976474] Starting subtest: invalid-set-prop
[360.979367] Subtest invalid-set-prop: SUCCESS (0.000s)
[361.064699] [051/133] (666s left) gem_exec_balancer (bonded-false-hang)
[361.321300] Starting subtest: bonded-false-hang
[361.327382] Subtest bonded-false-hang: SKIP (0.000s)
[361.418180] [052/133] (666s left) sysfs_preempt_timeout (timeout)
[361.476485] Starting subtest: timeout
[361.478990] Starting dynamic subtest: vecs0
[370.702958] Dynamic subtest vecs0: SUCCESS (9.222s)
[370.721463] Starting dynamic subtest: ccs0
[371.971984] Dynamic subtest ccs0: SUCCESS (1.268s)
[371.985307] Starting dynamic subtest: vcs0
[381.716647] Dynamic subtest vcs0: SUCCESS (9.736s)
[381.726455] Starting dynamic subtest: bcs0
[383.014835] Dynamic subtest bcs0: SUCCESS (1.296s)
[383.024427] Starting dynamic subtest: rcs0
[384.245572] Dynamic subtest rcs0: SUCCESS (1.228s)
[384.257437] Starting dynamic subtest: vcs1
[393.675062] Dynamic subtest vcs1: SUCCESS (9.422s)
[393.678150] Subtest timeout: SUCCESS (32.187s)
[393.754006] [053/133] (634s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-wc)
[393.860139] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-wc
[398.130345] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (4.272s)
[399.344793] [054/133] (628s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-mc-ccs)
[399.458701] Starting subtest: crc-primary-suspend-4-tiled-dg2-mc-ccs
[399.461201] Starting dynamic subtest: pipe-A-eDP-1
[399.471675] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[399.485901] Starting dynamic subtest: pipe-B-eDP-1
[399.495593] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[399.504641] Starting dynamic subtest: pipe-C-eDP-1
[399.514389] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[399.523237] Starting dynamic subtest: pipe-D-eDP-1
[399.533084] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[399.537445] Subtest crc-primary-suspend-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[401.712847] [055/133] (626s left) syncobj_eventfd (invalid-bad-pad)
[401.771358] Starting subtest: invalid-bad-pad
[401.774071] Subtest invalid-bad-pad: SUCCESS (0.000s)
[401.853577] [056/133] (626s left) kms_plane (pixel-format-linear-modifier)
[401.951537] Starting subtest: pixel-format-linear-modifier
[401.977483] Starting dynamic subtest: pipe-A-plane-0
[405.613281] Dynamic subtest pipe-A-plane-0: SUCCESS (3.633s)
[405.622981] Starting dynamic subtest: pipe-A-plane-3
[407.347338] Dynamic subtest pipe-A-plane-3: SUCCESS (1.733s)
[407.358215] Starting dynamic subtest: pipe-A-plane-5
[407.557055] Dynamic subtest pipe-A-plane-5: SUCCESS (0.210s)
[408.699715] Starting dynamic subtest: pipe-B-plane-0
[412.305686] Dynamic subtest pipe-B-plane-0: SUCCESS (3.611s)
[412.315282] Starting dynamic subtest: pipe-B-plane-3
[413.994304] Dynamic subtest pipe-B-plane-3: SUCCESS (1.688s)
[414.003461] Starting dynamic subtest: pipe-B-plane-5
[414.205194] Dynamic subtest pipe-B-plane-5: SUCCESS (0.210s)
[414.517163] Subtest pixel-format-linear-modifier: SUCCESS (12.561s)
[415.373244] [057/133] (612s left) kms_psr2_sf (pr-overlay-plane-update-sf-dmg-area)
[415.476085] Starting subtest: pr-overlay-plane-update-sf-dmg-area
[415.480691] Subtest pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[415.544533] [058/133] (612s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc)
[415.629233] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc
[415.631662] Starting dynamic subtest: pipe-A-eDP-1
[415.691087] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[415.700008] Starting dynamic subtest: pipe-B-eDP-1
[415.759938] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[415.769222] Starting dynamic subtest: pipe-C-eDP-1
[415.829222] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[415.837970] Starting dynamic subtest: pipe-D-eDP-1
[415.901841] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[415.907053] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.009s)
[417.839958] [059/133] (610s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[417.947960] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu
[417.953273] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[418.052903] [060/133] (610s left) syncobj_timeline (multi-wait-all-available-signaled)
[418.111107] Starting subtest: multi-wait-all-available-signaled
[418.113489] Subtest multi-wait-all-available-signaled: SUCCESS (0.000s)
[418.198321] [061/133] (610s left) gem_exec_fence (syncobj-repeat)
[418.660334] Starting subtest: syncobj-repeat
[418.850516] Subtest syncobj-repeat: SUCCESS (0.189s)
[419.760337] [062/133] (608s left) kms_big_fb (x-tiled-8bpp-rotate-270)
[419.869464] Starting subtest: x-tiled-8bpp-rotate-270
[419.891724] Subtest x-tiled-8bpp-rotate-270: SKIP (0.022s)
[420.009840] [063/133] (608s left) kms_psr (fbc-psr2-primary-mmap-gtt)
[420.107705] Starting subtest: fbc-psr2-primary-mmap-gtt
[420.110227] Starting dynamic subtest: eDP-1
[420.114975] Dynamic subtest eDP-1: SKIP (0.000s)
[420.119482] Subtest fbc-psr2-primary-mmap-gtt: SKIP (0.001s)
[420.193941] [064/133] (608s left) kms_big_fb (yf-tiled-64bpp-rotate-0)
[420.299806] Starting subtest: yf-tiled-64bpp-rotate-0
[420.305148] Subtest yf-tiled-64bpp-rotate-0: SKIP (0.000s)
[420.405327] [065/133] (608s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-blt)
[420.501092] Starting subtest: psr-1p-primscrn-cur-indfb-draw-blt
[427.242446] Subtest psr-1p-primscrn-cur-indfb-draw-blt: SUCCESS (6.742s)
[427.366019] [066/133] (601s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier)
[427.464339] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier
[427.469728] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier: SKIP (0.000s)
[427.536820] [067/133] (601s left) kms_vblank (wait-busy)
[427.622482] Starting subtest: wait-busy
[427.624840] Starting dynamic subtest: pipe-A-eDP-1
[429.501727] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.877s)
[429.517610] Starting dynamic subtest: pipe-D-eDP-1
[432.046450] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.544s)
[432.049338] Subtest wait-busy: SUCCESS (4.425s)
[432.855309] [068/133] (595s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-blt)
[432.958948] Starting subtest: fbcpsr-rgb565-draw-blt
[440.069486] Subtest fbcpsr-rgb565-draw-blt: SUCCESS (7.111s)
[440.198612] [069/133] (588s left) kms_atomic_transition (plane-all-modeset-transition)
[440.297221] Starting subtest: plane-all-modeset-transition
[440.302218] Subtest plane-all-modeset-transition: SKIP (0.000s)
[440.371895] [070/133] (588s left) syncobj_basic (bad-pad-handle-to-fd)
[440.428640] Starting subtest: bad-pad-handle-to-fd
[440.431096] Subtest bad-pad-handle-to-fd: SUCCESS (0.000s)
[440.527665] [071/133] (588s left) kms_psr (fbc-pr-cursor-mmap-gtt)
[440.618385] Starting subtest: fbc-pr-cursor-mmap-gtt
[440.623899] Subtest fbc-pr-cursor-mmap-gtt: SKIP (0.000s)
[440.693264] [072/133] (588s left) gem_ctx_exec (basic-invalid-context)
[440.760386] Starting subtest: basic-invalid-context
[440.765596] Subtest basic-invalid-context: SUCCESS (0.006s)
[440.875514] [073/133] (588s left) prime_vgem (basic-read)
[440.957232] Starting subtest: basic-read
[440.970799] Subtest basic-read: SKIP (0.011s)
[441.056567] [074/133] (587s left) gem_lmem_evict (dontneed-evict-race)
[441.098126] Subtest dontneed-evict-race: SKIP (0.000s)
[441.150363] [075/133] (587s left) gem_ctx_shared (q-in-order)
[441.211953] Starting subtest: Q-in-order
[441.214049] Starting dynamic subtest: rcs0
[441.320361] Dynamic subtest rcs0: SUCCESS (0.107s)
[441.336832] Starting dynamic subtest: vcs0
[441.402106] Dynamic subtest vcs0: SUCCESS (0.081s)
[441.418055] Starting dynamic subtest: vcs1
[441.478811] Dynamic subtest vcs1: SUCCESS (0.076s)
[441.496431] Starting dynamic subtest: vecs0
[441.554391] Dynamic subtest vecs0: SUCCESS (0.075s)
[441.569128] Starting dynamic subtest: ccs0
[441.644101] Dynamic subtest ccs0: SUCCESS (0.088s)
[441.646818] Subtest Q-in-order: SUCCESS (0.432s)
[442.814556] [076/133] (586s left) kms_psr (pr-cursor-plane-move)
[442.914066] Starting subtest: pr-cursor-plane-move
[442.919302] Subtest pr-cursor-plane-move: SKIP (0.000s)
[442.997050] [077/133] (586s left) kms_concurrent (multi-plane-atomic-lowres)
[443.084325] Starting subtest: multi-plane-atomic-lowres
[443.086958] Starting dynamic subtest: pipe-A-eDP-1
[443.584234] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.500s)
[443.594491] Starting dynamic subtest: pipe-B-eDP-1
[444.855977] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.267s)
[444.866290] Starting dynamic subtest: pipe-C-eDP-1
[446.088110] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.231s)
[446.097775] Starting dynamic subtest: pipe-D-eDP-1
[447.295059] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.206s)
[447.297881] Subtest multi-plane-atomic-lowres: SUCCESS (4.210s)
[448.119807] [078/133] (581s left) gem_exec_schedule (fairslice)
[448.195262] Starting subtest: fairslice
[448.197814] Starting dynamic subtest: rcs0
[450.206280] Dynamic subtest rcs0: SUCCESS (2.018s)
[450.217126] Starting dynamic subtest: bcs0
[452.223319] Dynamic subtest bcs0: SUCCESS (2.017s)
[452.234106] Starting dynamic subtest: vcs0
[454.247556] Dynamic subtest vcs0: SUCCESS (2.020s)
[454.258684] Starting dynamic subtest: vcs1
[456.266689] Dynamic subtest vcs1: SUCCESS (2.018s)
[456.278336] Starting dynamic subtest: vecs0
[458.285929] Dynamic subtest vecs0: SUCCESS (2.019s)
[458.297458] Starting dynamic subtest: ccs0
[460.308248] Dynamic subtest ccs0: SUCCESS (2.021s)
[460.311038] Subtest fairslice: SUCCESS (12.116s)
[460.611852] [079/133] (568s left) gen9_exec_parse (cmd-crossing-page)
[460.685181] Subtest cmd-crossing-page: SKIP (0.000s)
[460.753548] [080/133] (568s left) perf (short-reads)
[460.872349] Starting subtest: short-reads
[460.887447] Subtest short-reads: SUCCESS (0.017s)
[460.934672] [081/133] (568s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[461.040764] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip
[462.055768] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip: SUCCESS (1.013s)
[462.166281] [082/133] (567s left) gem_exec_balancer (semaphore)
[462.221338] Starting subtest: semaphore
[463.675225] Subtest semaphore: SUCCESS (1.452s)
[463.988249] [083/133] (565s left) kms_chamelium_color (ctm-red-to-blue)
[464.094144] Subtest ctm-red-to-blue: SKIP (0.000s)
[464.143866] [084/133] (565s left) gem_userptr_blits (nohangcheck)
[464.221913] Starting subtest: nohangcheck
[464.462265] Subtest nohangcheck: SUCCESS (0.244s)
[464.585798] [085/133] (564s left) kms_addfb_basic (tile-pitch-mismatch)
[464.654463] Starting subtest: tile-pitch-mismatch
[464.660098] Subtest tile-pitch-mismatch: SKIP (0.000s)
[464.788517] [086/133] (564s left) perf_pmu (init-wait)
[464.835184] Starting subtest: init-wait
[464.837580] Starting dynamic subtest: rcs0
[464.840079] Dynamic subtest rcs0: SUCCESS (0.002s)
[464.851853] Starting dynamic subtest: bcs0
[464.853925] Dynamic subtest bcs0: SUCCESS (0.001s)
[464.862864] Starting dynamic subtest: vcs0
[464.864985] Dynamic subtest vcs0: SUCCESS (0.001s)
[464.873708] Starting dynamic subtest: vcs1
[464.875779] Dynamic subtest vcs1: SUCCESS (0.001s)
[464.885118] Starting dynamic subtest: vecs0
[464.887323] Dynamic subtest vecs0: SUCCESS (0.001s)
[464.896246] Starting dynamic subtest: ccs0
[464.898210] Dynamic subtest ccs0: SUCCESS (0.001s)
[464.900164] Subtest init-wait: SUCCESS (0.009s)
[464.949740] [087/133] (564s left) gem_exec_params (invalid-bsd1-flag-on-blt)
[465.009491] Starting subtest: invalid-bsd1-flag-on-blt
[465.012604] Subtest invalid-bsd1-flag-on-blt: SUCCESS (0.000s)
[465.107177] [088/133] (564s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[465.199455] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[465.204484] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[465.291059] [089/133] (564s left) gem_linear_blits (basic)
[465.723174] Starting subtest: basic
[465.729774] Subtest basic: SUCCESS (0.011s)
[465.866523] [090/133] (563s left) kms_cursor_crc (cursor-random-512x512)
[466.184830] Starting subtest: cursor-random-512x512
[466.190129] Subtest cursor-random-512x512: SKIP (0.002s)
[466.357707] [091/133] (563s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[466.455803] Starting subtest: addfb25-y-tiled-small-legacy
[466.460587] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s)
[466.551650] [092/133] (563s left) gem_spin_batch (legacy-resubmit-new)
[466.607224] Starting subtest: legacy-resubmit-new
[466.609856] Starting dynamic subtest: default
[466.616833] Dynamic subtest default: SUCCESS (0.009s)
[466.627755] Starting dynamic subtest: render
[466.630041] Dynamic subtest render: SUCCESS (0.003s)
[466.640257] Starting dynamic subtest: bsd
[466.643461] Dynamic subtest bsd: SUCCESS (0.004s)
[466.653240] Starting dynamic subtest: bsd1
[466.655482] Dynamic subtest bsd1: SUCCESS (0.003s)
[466.665124] Starting dynamic subtest: bsd2
[466.667277] Dynamic subtest bsd2: SUCCESS (0.008s)
[466.676893] Starting dynamic subtest: blt
[466.679073] Dynamic subtest blt: SUCCESS (0.004s)
[466.688675] Starting dynamic subtest: vebox
[466.691011] Dynamic subtest vebox: SUCCESS (0.004s)
[466.693267] Subtest legacy-resubmit-new: SUCCESS (0.040s)
[467.714958] [093/133] (562s left) syncobj_basic (bad-fd-to-handle)
[467.769253] Starting subtest: bad-fd-to-handle
[467.771500] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[467.861226] [094/133] (561s left) kms_flip (flip-vs-rmfb)
[467.956277] Starting subtest: flip-vs-rmfb
[467.958935] Starting dynamic subtest: A-eDP1
[476.622012] Dynamic subtest A-eDP1: SUCCESS (8.661s)
[476.633030] Starting dynamic subtest: B-eDP1
[485.252174] Dynamic subtest B-eDP1: SUCCESS (8.624s)
[485.264939] Starting dynamic subtest: C-eDP1
[493.874634] Dynamic subtest C-eDP1: SUCCESS (8.615s)
[493.895226] Starting dynamic subtest: D-eDP1
[502.518360] Dynamic subtest D-eDP1: SUCCESS (8.637s)
[502.523854] Subtest flip-vs-rmfb: SUCCESS (34.554s)
[503.714768] [095/133] (526s left) gem_userptr_blits (map-fixed-invalidate)
[503.786260] Starting subtest: map-fixed-invalidate
[503.791081] Subtest map-fixed-invalidate: SKIP (0.000s)
[503.903340] [096/133] (526s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-render)
[504.006721] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-render
[504.011266] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[504.110706] [097/133] (525s left) gem_set_tiling_vs_blt (tiled-to-untiled)
[504.173033] Subtest tiled-to-untiled: SKIP (0.000s)
[504.245946] [098/133] (525s left) gem_exec_schedule (preempt-engines)
[504.336293] Starting subtest: preempt-engines
[504.338481] Starting dynamic subtest: rcs0
[506.624350] Dynamic subtest rcs0: SUCCESS (2.296s)
[506.637399] Starting dynamic subtest: bcs0
[508.971555] Dynamic subtest bcs0: SUCCESS (2.344s)
[508.984910] Starting dynamic subtest: vcs0
[511.314058] Dynamic subtest vcs0: SUCCESS (2.340s)
[511.324549] Starting dynamic subtest: vcs1
[513.638477] Dynamic subtest vcs1: SUCCESS (2.321s)
[513.654459] Starting dynamic subtest: vecs0
[515.957171] Dynamic subtest vecs0: SUCCESS (2.316s)
[515.970712] Starting dynamic subtest: ccs0
[518.277820] Dynamic subtest ccs0: SUCCESS (2.318s)
[518.280699] Subtest preempt-engines: SUCCESS (13.944s)
[518.635026] [099/133] (511s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs)
[518.725881] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs
[518.728238] Starting dynamic subtest: pipe-A-eDP-1
[518.751437] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[518.765652] Starting dynamic subtest: pipe-B-eDP-1
[518.790703] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[518.800438] Starting dynamic subtest: pipe-C-eDP-1
[518.825838] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[518.835352] Starting dynamic subtest: pipe-D-eDP-1
[518.860564] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[518.866201] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.005s)
[520.973677] [100/133] (509s left) kms_frontbuffer_tracking (fbc-1p-indfb-fliptrack-mmap-gtt)
[521.080994] Starting subtest: fbc-1p-indfb-fliptrack-mmap-gtt
[521.086110] Subtest fbc-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[521.178011] [101/133] (509s left) gem_exec_flush (basic-uc-pro-default)
[521.238343] Starting subtest: basic-uc-pro-default
[526.709462] Subtest basic-uc-pro-default: SUCCESS (5.468s)
[526.899165] [102/133] (503s left) kms_fence_pin_leak
[527.062737] [103/133] (503s left) kms_frontbuffer_tracking (fbc-shrfb-scaledprimary)
[527.149872] Starting subtest: fbc-shrfb-scaledprimary
[530.181206] Subtest fbc-shrfb-scaledprimary: SUCCESS (3.035s)
[531.363697] [104/133] (498s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite)
[531.453844] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite
[540.864937] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (9.410s)
[540.992552] [105/133] (489s left) i915_query (query-topology-unsupported)
[541.051636] Starting subtest: query-topology-unsupported
[541.057024] Subtest query-topology-unsupported: SKIP (0.000s)
[541.150590] [106/133] (489s left) kms_lease (atomic-implicit-crtc)
[541.251135] Starting subtest: atomic-implicit-crtc
[541.253614] Starting dynamic subtest: pipe-A-eDP-1
[541.266705] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[541.280252] Starting dynamic subtest: pipe-B-eDP-1
[541.292489] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.009s)
[541.302315] Starting dynamic subtest: pipe-C-eDP-1
[541.314191] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.009s)
[541.327502] Starting dynamic subtest: pipe-D-eDP-1
[541.340187] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.010s)
[541.342670] Subtest atomic-implicit-crtc: SUCCESS (0.036s)
[541.393365] [107/133] (489s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy)
[541.516121] Starting subtest: 2x-cursor-vs-flip-legacy
[541.521334] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.001s)
[541.677975] [108/133] (488s left) gem_mmap_wc (pf-nonblock)
[541.745295] Subtest pf-nonblock: SKIP (0.000s)
[541.832816] [109/133] (488s left) kms_flip (2x-flip-vs-panning)
[541.918667] Starting subtest: 2x-flip-vs-panning
[541.930035] Subtest 2x-flip-vs-panning: SKIP (0.010s)
[542.009598] [110/133] (488s left) kms_cursor_legacy (short-flip-after-cursor-atomic-transitions-varying-size)
[542.124994] Starting subtest: short-flip-after-cursor-atomic-transitions-varying-size
[543.088878] Subtest short-flip-after-cursor-atomic-transitions-varying-size: SUCCESS (0.963s)
[543.913911] [111/133] (486s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-gtt)
[544.016289] Starting subtest: psr-rgb101010-draw-mmap-gtt
[544.020312] Subtest psr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[544.116630] [112/133] (486s left) kms_cursor_legacy (forked-move)
[544.243831] Starting subtest: forked-move
[544.246269] Starting dynamic subtest: pipe-A
[549.707311] Dynamic subtest pipe-A: SUCCESS (5.458s)
[549.720048] Starting dynamic subtest: pipe-B
[555.196423] Dynamic subtest pipe-B: SUCCESS (5.484s)
[555.212445] Starting dynamic subtest: pipe-C
[560.679949] Dynamic subtest pipe-C: SUCCESS (5.479s)
[560.692044] Starting dynamic subtest: pipe-D
[566.159474] Dynamic subtest pipe-D: SUCCESS (5.475s)
[566.171745] Starting dynamic subtest: all-pipes
[571.659269] Dynamic subtest all-pipes: SUCCESS (5.495s)
[571.662291] Subtest forked-move: SUCCESS (27.402s)
[571.807707] [113/133] (458s left) kms_chamelium_frames (vga-frame-dump)
[572.200943] Subtest vga-frame-dump: SKIP (0.000s)
[573.043668] [114/133] (457s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[573.133441] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu
[573.138439] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[573.230611] [115/133] (457s left) gem_exec_reloc (basic-gtt-wc-active)
[573.294269] Subtest basic-gtt-wc-active: SKIP (0.000s)
[573.361395] [116/133] (457s left) kms_cursor_crc (cursor-sliding-32x32)
[573.496191] Starting subtest: cursor-sliding-32x32
[573.543182] Subtest cursor-sliding-32x32: SKIP (0.040s)
[573.820584] [117/133] (457s left) vgem_basic (dmabuf-export)
[573.870289] Starting subtest: dmabuf-export
[573.908465] Subtest dmabuf-export: SUCCESS (0.041s)
[574.008167] [118/133] (456s left) kms_psr (fbc-psr2-sprite-render)
[574.101775] Starting subtest: fbc-psr2-sprite-render
[574.103832] Starting dynamic subtest: eDP-1
[574.108075] Dynamic subtest eDP-1: SKIP (0.000s)
[574.111988] Subtest fbc-psr2-sprite-render: SKIP (0.001s)
[574.174460] [119/133] (456s left) gem_exec_reloc (basic-cpu-wc-noreloc)
[574.241090] Subtest basic-cpu-wc-noreloc: SKIP (0.000s)
[574.316990] [120/133] (456s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-downscaling)
[574.403226] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-downscaling
[574.407752] Subtest flip-32bpp-ytile-to-64bpp-ytile-downscaling: SKIP (0.000s)
[574.487994] [121/133] (456s left) api_intel_allocator (default-alignment)
[574.547975] Starting subtest: default-alignment
[574.550193] Subtest default-alignment: SUCCESS (0.004s)
[574.681939] [122/133] (456s left) gem_exec_params (invalid-bsd1-flag-on-vebox)
[574.749117] Starting subtest: invalid-bsd1-flag-on-vebox
[574.751274] Subtest invalid-bsd1-flag-on-vebox: SUCCESS (0.000s)
[574.862819] [123/133] (456s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted)
[574.917806] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[574.920172] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[575.029855] [124/133] (456s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers)
[575.117758] Starting subtest: plane-upscale-factor-0-25-with-modifiers
[575.120110] Starting dynamic subtest: pipe-A
[575.453038] Dynamic subtest pipe-A: SUCCESS (0.338s)
[575.462874] Starting dynamic subtest: pipe-B
[576.844936] Dynamic subtest pipe-B: SUCCESS (1.390s)
[576.856000] Starting dynamic subtest: pipe-C
[578.273290] Dynamic subtest pipe-C: SUCCESS (1.427s)
[578.283229] Starting dynamic subtest: pipe-D
[579.704661] Dynamic subtest pipe-D: SUCCESS (1.430s)
[579.707009] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (4.588s)
[580.879985] [125/133] (450s left) kms_pm_backlight (fade-with-suspend)
[580.974788] Starting subtest: fade-with-suspend
[596.767113] Starting dynamic subtest: eDP-1
[599.229146] Dynamic subtest eDP-1: SUCCESS (2.461s)
[599.231521] Subtest fade-with-suspend: SUCCESS (3.676s)
[600.077342] [126/133] (431s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-mc-ccs)
[600.182485] Starting subtest: ccs-on-another-bo-4-tiled-mtl-mc-ccs
[600.184368] Starting dynamic subtest: pipe-A-eDP-1
[600.204815] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.023s)
[600.216482] Starting dynamic subtest: pipe-B-eDP-1
[600.236434] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.023s)
[600.246858] Starting dynamic subtest: pipe-C-eDP-1
[600.266973] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.022s)
[600.277559] Starting dynamic subtest: pipe-D-eDP-1
[600.297497] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.022s)
[600.299734] Subtest ccs-on-another-bo-4-tiled-mtl-mc-ccs: SUCCESS (0.096s)
[602.542043] [127/133] (428s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[602.639275] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[602.643561] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[602.736067] [128/133] (428s left) kms_rotation_crc (sprite-rotation-90)
[602.833540] Starting subtest: sprite-rotation-90
[602.837543] Subtest sprite-rotation-90: SKIP (0.001s)
[602.908313] [129/133] (428s left) kms_cursor_crc (cursor-onscreen-512x170)
[603.208580] Starting subtest: cursor-onscreen-512x170
[603.212909] Subtest cursor-onscreen-512x170: SKIP (0.001s)
[603.347300] [130/133] (428s left) gem_exec_schedule (smoketest)
[603.536450] Starting subtest: smoketest
[603.538293] Starting dynamic subtest: rcs0
[609.081456] Dynamic subtest rcs0: SUCCESS (5.491s)
[609.092879] Starting dynamic subtest: bcs0
[614.600943] Dynamic subtest bcs0: SUCCESS (5.515s)
[614.612508] Starting dynamic subtest: vcs0
[620.108173] Dynamic subtest vcs0: SUCCESS (5.501s)
[620.122437] Starting dynamic subtest: vcs1
[625.624615] Dynamic subtest vcs1: SUCCESS (5.510s)
[625.636807] Starting dynamic subtest: vecs0
[631.117008] Dynamic subtest vecs0: SUCCESS (5.493s)
[631.129070] Starting dynamic subtest: ccs0
[636.605847] Dynamic subtest ccs0: SUCCESS (5.486s)
[636.607882] Subtest smoketest: SUCCESS (33.007s)
[636.750283] [131/133] (394s left) gem_fenced_exec_thrash (too-many-fences)
[636.810349] Subtest too-many-fences: SKIP (0.000s)
[636.886365] [132/133] (394s left) perf (gen12-mi-rpc)
[637.004590] Starting subtest: gen12-mi-rpc
[637.006930] Starting dynamic subtest: rcs0
[637.024541] Dynamic subtest rcs0: SUCCESS (0.017s)
[637.026877] Subtest gen12-mi-rpc: SUCCESS (0.019s)
[637.071485] [133/133] (394s left) gem_mmap_gtt (big-bo-tiledx)
[637.126638] Subtest big-bo-tiledX: SKIP (0.000s)
[637.202230] Closing watchdogs
results: parsing output: 0/ for test: kms_color
results: parsing output: 1/ for test: gem_mmap_gtt
results: parsing output: 2/ for test: kms_psr
results: parsing output: 3/ for test: api_intel_bb
results: parsing output: 4/ for test: kms_invalid_mode
results: parsing output: 5/ for test: gem_mmap_offset
results: parsing output: 6/ for test: gem_pxp
results: parsing output: 7/ for test: syncobj_timeline
results: parsing output: 8/ for test: kms_atomic_transition
results: parsing output: 9/ for test: kms_big_fb
results: parsing output: 10/ for test: gem_mmap
results: parsing output: 11/ for test: syncobj_wait
results: parsing output: 12/ for test: kms_flip_scaled_crc
results: parsing output: 13/ for test: syncobj_timeline
results: parsing output: 14/ for test: kms_big_fb
results: parsing output: 15/ for test: i915_hangman
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: kms_plane_alpha_blend
results: parsing output: 19/ for test: i915_pm_rpm
results: parsing output: 20/ for test: kms_pipe_b_c_ivb
results: parsing output: 21/ for test: kms_atomic_interruptible
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: kms_cursor_legacy
results: parsing output: 24/ for test: i915_pm_sseu
results: parsing output: 25/ for test: syncobj_basic
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: prime_busy
results: parsing output: 28/ for test: kms_pm_rpm
results: parsing output: 29/ for test: gem_render_copy
results: parsing output: 30/ for test: kms_flip
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: kms_psr
results: parsing output: 33/ for test: kms_rotation_crc
results: parsing output: 34/ for test: gem_eio
results: parsing output: 35/ for test: kms_plane_scaling
results: parsing output: 36/ for test: i915_drm_fdinfo
results: parsing output: 37/ for test: kms_sequence
results: parsing output: 38/ for test: core_setmaster
results: parsing output: 39/ for test: kms_chamelium_color
results: parsing output: 40/ for test: gem_mmap_wc
results: parsing output: 41/ for test: gem_ctx_persistence
results: parsing output: 42/ for test: gem_ctx_isolation
results: parsing output: 43/ for test: kms_feature_discovery
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: kms_big_fb
results: parsing output: 47/ for test: gem_ccs
results: parsing output: 48/ for test: gem_exec_suspend
results: parsing output: 49/ for test: kms_prop_blob
results: parsing output: 50/ for test: gem_exec_balancer
results: parsing output: 51/ for test: sysfs_preempt_timeout
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: kms_ccs
results: parsing output: 54/ for test: syncobj_eventfd
results: parsing output: 55/ for test: kms_plane
results: parsing output: 56/ for test: kms_psr2_sf
results: parsing output: 57/ for test: kms_ccs
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: syncobj_timeline
results: parsing output: 60/ for test: gem_exec_fence
results: parsing output: 61/ for test: kms_big_fb
results: parsing output: 62/ for test: kms_psr
results: parsing output: 63/ for test: kms_big_fb
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: kms_plane
results: parsing output: 66/ for test: kms_vblank
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: kms_atomic_transition
results: parsing output: 69/ for test: syncobj_basic
results: parsing output: 70/ for test: kms_psr
results: parsing output: 71/ for test: gem_ctx_exec
results: parsing output: 72/ for test: prime_vgem
results: parsing output: 73/ for test: gem_lmem_evict
results: parsing output: 74/ for test: gem_ctx_shared
results: parsing output: 75/ for test: kms_psr
results: parsing output: 76/ for test: kms_concurrent
results: parsing output: 77/ for test: gem_exec_schedule
results: parsing output: 78/ for test: gen9_exec_parse
results: parsing output: 79/ for test: perf
results: parsing output: 80/ for test: kms_big_fb
results: parsing output: 81/ for test: gem_exec_balancer
results: parsing output: 82/ for test: kms_chamelium_color
results: parsing output: 83/ for test: gem_userptr_blits
results: parsing output: 84/ for test: kms_addfb_basic
results: parsing output: 85/ for test: perf_pmu
results: parsing output: 86/ for test: gem_exec_params
results: parsing output: 87/ for test: kms_big_fb
results: parsing output: 88/ for test: gem_linear_blits
results: parsing output: 89/ for test: kms_cursor_crc
results: parsing output: 90/ for test: kms_addfb_basic
results: parsing output: 91/ for test: gem_spin_batch
results: parsing output: 92/ for test: syncobj_basic
results: parsing output: 93/ for test: kms_flip
results: parsing output: 94/ for test: gem_userptr_blits
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: gem_set_tiling_vs_blt
results: parsing output: 97/ for test: gem_exec_schedule
results: parsing output: 98/ for test: kms_ccs
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: gem_exec_flush
results: parsing output: 101/ for test: kms_fence_pin_leak
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: i915_query
results: parsing output: 105/ for test: kms_lease
results: parsing output: 106/ for test: kms_cursor_legacy
results: parsing output: 107/ for test: gem_mmap_wc
results: parsing output: 108/ for test: kms_flip
results: parsing output: 109/ for test: kms_cursor_legacy
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_cursor_legacy
results: parsing output: 112/ for test: kms_chamelium_frames
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: gem_exec_reloc
results: parsing output: 115/ for test: kms_cursor_crc
results: parsing output: 116/ for test: vgem_basic
results: parsing output: 117/ for test: kms_psr
results: parsing output: 118/ for test: gem_exec_reloc
results: parsing output: 119/ for test: kms_flip_scaled_crc
results: parsing output: 120/ for test: api_intel_allocator
results: parsing output: 121/ for test: gem_exec_params
results: parsing output: 122/ for test: syncobj_timeline
results: parsing output: 123/ for test: kms_plane_scaling
results: parsing output: 124/ for test: kms_pm_backlight
results: parsing output: 125/ for test: kms_ccs
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: kms_rotation_crc
results: parsing output: 128/ for test: kms_cursor_crc
results: parsing output: 129/ for test: gem_exec_schedule
results: parsing output: 130/ for test: gem_fenced_exec_thrash
results: parsing output: 131/ for test: perf
results: parsing output: 132/ for test: gem_mmap_gtt
Done.