[59.213271] Initializing watchdogs
[59.213318]   /dev/watchdog0
[59.227887] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[59.232495] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.234656] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.238069] [001/156] (960s left) kms_flip (dpms-vs-vblank-race)
[59.364536] Starting subtest: dpms-vs-vblank-race
[59.367021] Starting dynamic subtest: A-eDP1
[64.435358] Dynamic subtest A-eDP1: SUCCESS (5.070s)
[64.444195] Starting dynamic subtest: B-eDP1
[68.021044] Dynamic subtest B-eDP1: SUCCESS (3.585s)
[68.028701] Starting dynamic subtest: C-eDP1
[72.639433] Dynamic subtest C-eDP1: SUCCESS (4.621s)
[72.648903] Starting dynamic subtest: D-eDP1
[76.241692] Dynamic subtest D-eDP1: SUCCESS (3.601s)
[76.247512] Subtest dpms-vs-vblank-race: SUCCESS (16.885s)
[77.115355] [002/156] (942s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-cur-indfb-draw-blt)
[77.217226] Starting subtest: psrhdr-2p-scndscrn-cur-indfb-draw-blt
[77.221159] Subtest psrhdr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[77.317374] [003/156] (942s left) gem_mmap (basic)
[77.371242] Subtest basic: SKIP (0.000s)
[77.428922] [004/156] (942s left) kms_flip (wf_vblank-ts-check)
[77.531228] Starting subtest: wf_vblank-ts-check
[77.533618] Starting dynamic subtest: A-eDP1
[86.461756] Dynamic subtest A-eDP1: SUCCESS (8.932s)
[86.469229] Starting dynamic subtest: B-eDP1
[95.408994] Dynamic subtest B-eDP1: SUCCESS (8.946s)
[95.418077] Starting dynamic subtest: C-eDP1
[104.321022] Dynamic subtest C-eDP1: SUCCESS (8.909s)
[104.331360] Starting dynamic subtest: D-eDP1
[113.249850] Dynamic subtest D-eDP1: SUCCESS (8.927s)
[113.252699] Subtest wf_vblank-ts-check: SUCCESS (35.724s)
[114.466540] [005/156] (905s left) gem_exec_reloc (basic-cpu-wc)
[114.528793] Subtest basic-cpu-wc: SKIP (0.000s)
[114.597265] [006/156] (905s left) i915_query (query-garbage)
[114.650811] Starting subtest: query-garbage
[114.652750] Subtest query-garbage: SUCCESS (0.000s)
[114.747251] [007/156] (905s left) kms_pm_backlight (fade-with-dpms)
[114.838034] Starting subtest: fade-with-dpms
[116.941399] Starting dynamic subtest: eDP-1
[119.950715] Dynamic subtest eDP-1: SUCCESS (3.010s)
[119.953128] Subtest fade-with-dpms: SUCCESS (5.114s)
[120.815165] [008/156] (899s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-onoff)
[120.911300] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-onoff
[120.915472] Subtest fbcpsr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[120.998796] [009/156] (899s left) kms_chamelium_audio (hdmi-audio)
[121.377725] Subtest hdmi-audio: SKIP (0.000s)
[122.227429] [010/156] (897s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted)
[122.280757] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted
[122.283082] Subtest multi-wait-for-submit-available-unsubmitted-submitted: SUCCESS (0.001s)
[122.391494] [011/156] (897s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-downscaling)
[122.491948] Starting subtest: flip-64bpp-linear-to-32bpp-linear-downscaling
[122.494285] Starting dynamic subtest: pipe-A-default-mode
[123.610666] Dynamic subtest pipe-A-default-mode: SKIP (1.116s)
[123.617564] Subtest flip-64bpp-linear-to-32bpp-linear-downscaling: SKIP (1.117s)
[123.764096] [012/156] (896s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-fullscreen)
[123.865503] Starting subtest: psr-1p-primscrn-spr-indfb-fullscreen
[130.519048] Subtest psr-1p-primscrn-spr-indfb-fullscreen: SUCCESS (6.661s)
[130.633265] [013/156] (889s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[130.736893] Starting subtest: fbcpsr-indfb-scaledprimary
[136.488805] Subtest fbcpsr-indfb-scaledprimary: SUCCESS (5.758s)
[136.610936] [014/156] (883s left) gem_pxp (create-protected-buffer)
[136.729693] Starting subtest: create-protected-buffer
[136.732180] Subtest create-protected-buffer: SUCCESS (0.000s)
[136.847521] [015/156] (883s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-cur-indfb-draw-blt)
[136.953026] Starting subtest: psrhdr-2p-primscrn-cur-indfb-draw-blt
[136.957225] Subtest psrhdr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[137.071739] [016/156] (883s left) gem_exec_reloc (basic-gtt-wc-noreloc)
[137.126626] Subtest basic-gtt-wc-noreloc: SKIP (0.000s)
[137.190175] [017/156] (883s left) kms_frontbuffer_tracking (hdr-1p-offscreen-pri-shrfb-draw-pwrite)
[137.290487] Starting subtest: hdr-1p-offscreen-pri-shrfb-draw-pwrite
[137.295068] Subtest hdr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[137.382539] [018/156] (883s left) kms_properties (colorop-properties-legacy)
[137.468064] Starting subtest: colorop-properties-legacy
[137.470099] Starting dynamic subtest: pipe-A-eDP-1
[137.824668] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.356s)
[137.835284] Starting dynamic subtest: pipe-B-eDP-1
[138.898571] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.073s)
[138.907075] Starting dynamic subtest: pipe-C-eDP-1
[140.049310] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.149s)
[140.057991] Starting dynamic subtest: pipe-D-eDP-1
[141.172888] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.123s)
[141.175073] Subtest colorop-properties-legacy: SUCCESS (3.704s)
[142.063469] [019/156] (878s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[142.166749] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[142.171160] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[142.259478] [020/156] (878s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-onoff)
[142.351202] Starting subtest: psr-2p-scndscrn-spr-indfb-onoff
[142.355782] Subtest psr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[142.446185] [021/156] (878s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-blt)
[142.557177] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-blt
[142.561251] Subtest fbc-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[142.675026] [022/156] (877s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-move)
[142.774261] Starting subtest: fbc-2p-scndscrn-spr-indfb-move
[142.778717] Subtest fbc-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[142.916497] [023/156] (877s left) kms_frontbuffer_tracking (hdr-2p-primscrn-spr-indfb-move)
[143.011857] Starting subtest: hdr-2p-primscrn-spr-indfb-move
[143.015472] Subtest hdr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[143.113284] [024/156] (877s left) kms_vblank (ts-continuation-dpms-suspend)
[143.210272] Starting subtest: ts-continuation-dpms-suspend
[143.211901] Starting dynamic subtest: pipe-A-eDP-1
[160.462279] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.085s)
[160.477683] Starting dynamic subtest: pipe-D-eDP-1
[178.459524] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.517s)
[178.461991] Subtest ts-continuation-dpms-suspend: SUCCESS (4.605s)
[179.267699] [025/156] (841s left) gem_pwrite_snooped
[179.398391] [026/156] (841s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[179.510732] Starting subtest: basic-flip-before-cursor-legacy
[180.427092] Subtest basic-flip-before-cursor-legacy: SUCCESS (0.914s)
[181.307735] [027/156] (839s left) syncobj_eventfd (invalid-bad-pad)
[181.371967] Starting subtest: invalid-bad-pad
[181.374294] Subtest invalid-bad-pad: SUCCESS (0.000s)
[181.464474] [028/156] (839s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping)
[181.565852] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping
[181.570223] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping: SKIP (0.000s)
[181.636025] [029/156] (839s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-shrfb-pgflip-blt)
[181.737724] Starting subtest: fbchdr-2p-primscrn-shrfb-pgflip-blt
[181.741590] Subtest fbchdr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[181.831152] [030/156] (839s left) kms_content_protection (dp-mst-lic-type-1)
[181.972447] Starting subtest: dp-mst-lic-type-1
[181.976996] Subtest dp-mst-lic-type-1: SKIP (0.000s)
[182.105322] [031/156] (838s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[182.218161] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[182.223028] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[182.314702] [032/156] (838s left) gem_exec_reloc (basic-wc-read-noreloc)
[182.377571] Subtest basic-wc-read-noreloc: SKIP (0.000s)
[182.441947] [033/156] (838s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions-varying-size)
[182.562935] Starting subtest: cursorA-vs-flipA-atomic-transitions-varying-size
[193.756432] Subtest cursorA-vs-flipA-atomic-transitions-varying-size: SUCCESS (11.188s)
[194.560536] [034/156] (826s left) gem_render_copy (y-tiled-ccs-to-y-tiled-mc-ccs)
[194.628740] Starting subtest: y-tiled-ccs-to-y-tiled-mc-ccs
[194.632997] Subtest y-tiled-ccs-to-y-tiled-mc-ccs: SKIP (0.000s)
[194.822325] [035/156] (826s left) core_debugfs (read-all-entries)
[194.865989] Starting subtest: read-all-entries
[194.949134] Subtest read-all-entries: SUCCESS (0.084s)
[195.012512] [036/156] (826s left) gem_exec_balancer (sequential)
[195.069934] Starting subtest: sequential
[198.126163] Subtest sequential: SUCCESS (3.055s)
[198.433261] [037/156] (822s left) gem_exec_async (forked-writes)
[198.499950] Starting subtest: forked-writes
[198.502454] Starting dynamic subtest: rcs0
[198.538011] Dynamic subtest rcs0: SUCCESS (0.037s)
[198.551641] Starting dynamic subtest: bcs0
[198.561992] Dynamic subtest bcs0: SUCCESS (0.024s)
[198.571916] Starting dynamic subtest: vcs0
[198.584765] Dynamic subtest vcs0: SUCCESS (0.022s)
[198.594519] Starting dynamic subtest: vcs1
[198.606982] Dynamic subtest vcs1: SUCCESS (0.021s)
[198.617060] Starting dynamic subtest: vecs0
[198.630992] Dynamic subtest vecs0: SUCCESS (0.023s)
[198.643058] Starting dynamic subtest: ccs0
[198.654075] Dynamic subtest ccs0: SUCCESS (0.022s)
[198.656217] Subtest forked-writes: SUCCESS (0.155s)
[198.905287] [038/156] (822s left) i915_pm_rc6_residency (media-rc6-accuracy)
[198.960183] Starting subtest: media-rc6-accuracy
[198.964871] Subtest media-rc6-accuracy: SKIP (0.000s)
[199.061668] [039/156] (822s left) kms_ccs (bad-rotation-90-4-tiled-dg2-mc-ccs)
[199.166258] Starting subtest: bad-rotation-90-4-tiled-dg2-mc-ccs
[199.168582] Starting dynamic subtest: pipe-A-eDP-1
[199.190333] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[199.200359] Starting dynamic subtest: pipe-B-eDP-1
[199.221741] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[199.230181] Starting dynamic subtest: pipe-C-eDP-1
[199.252211] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[199.260813] Starting dynamic subtest: pipe-D-eDP-1
[199.283003] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[199.287097] Subtest bad-rotation-90-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[201.429762] [040/156] (819s left) gem_pread (snoop)
[201.489418] Subtest snoop: SKIP (0.000s)
[201.543896] [041/156] (819s left) syncobj_basic (create-signaled)
[201.594851] Starting subtest: create-signaled
[201.596765] Subtest create-signaled: SUCCESS (0.000s)
[201.695523] [042/156] (819s left) kms_frontbuffer_tracking (hdr-2p-primscrn-cur-indfb-draw-mmap-wc)
[201.795606] Starting subtest: hdr-2p-primscrn-cur-indfb-draw-mmap-wc
[201.799566] Subtest hdr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[201.891225] [043/156] (819s left) sw_sync (sync_busy_fork)
[201.923697] Starting subtest: sync_busy_fork
[202.933849] Subtest sync_busy_fork: SUCCESS (1.010s)
[202.993687] [044/156] (818s left) i915_drm_fdinfo (memory-info-active)
[203.035399] Starting subtest: memory-info-active
[203.037618] Starting dynamic subtest: smem0
[205.829169] Dynamic subtest smem0: SUCCESS (2.795s)
[205.831813] Subtest memory-info-active: SUCCESS (2.796s)
[205.902149] [045/156] (815s left) kms_plane_alpha_blend (coverage-vs-premult-vs-constant)
[205.995878] Starting subtest: coverage-vs-premult-vs-constant
[206.277586] Starting dynamic subtest: pipe-A-eDP-1
[206.842150] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.563s)
[206.852239] Starting dynamic subtest: pipe-D-eDP-1
[208.149555] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.305s)
[208.151874] Subtest coverage-vs-premult-vs-constant: SUCCESS (2.153s)
[209.004884] [046/156] (812s left) gem_ctx_bad_destroy (double-destroy)
[209.068512] Starting subtest: double-destroy
[209.071007] Subtest double-destroy: SUCCESS (0.000s)
[209.140893] [047/156] (812s left) kms_feature_discovery (display)
[209.241758] Starting subtest: display
[209.243980] Subtest display: SUCCESS (0.000s)
[209.309824] [048/156] (812s left) perf (sysctl-defaults)
[209.375079] Starting subtest: sysctl-defaults
[209.377474] Subtest sysctl-defaults: SUCCESS (0.000s)
[209.466412] [049/156] (812s left) kms_psr_stress_test (invalidate-primary-flip-overlay)
[209.554425] Starting subtest: invalidate-primary-flip-overlay
[220.266700] Subtest invalidate-primary-flip-overlay: SUCCESS (10.714s)
[220.382599] [050/156] (801s left) kms_frontbuffer_tracking (fbchdr-1p-offscreen-pri-shrfb-draw-pwrite)
[220.482263] Starting subtest: fbchdr-1p-offscreen-pri-shrfb-draw-pwrite
[220.485946] Subtest fbchdr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[220.575302] [051/156] (801s left) kms_big_fb (4-tiled-64bpp-rotate-0)
[220.676639] Starting subtest: 4-tiled-64bpp-rotate-0
[222.280447] Subtest 4-tiled-64bpp-rotate-0: SUCCESS (1.603s)
[222.466889] [052/156] (799s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-pwrite)
[222.564129] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-pwrite
[230.516799] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (7.955s)
[230.639296] [053/156] (791s left) gem_spin_batch (engines)
[230.697816] Starting subtest: engines
[230.699971] Starting dynamic subtest: rcs0
[233.936504] Dynamic subtest rcs0: SUCCESS (3.233s)
[233.948311] Starting dynamic subtest: bcs0
[237.172535] Dynamic subtest bcs0: SUCCESS (3.233s)
[237.181702] Starting dynamic subtest: vcs0
[240.405512] Dynamic subtest vcs0: SUCCESS (3.230s)
[240.415124] Starting dynamic subtest: vcs1
[243.646843] Dynamic subtest vcs1: SUCCESS (3.238s)
[243.656486] Starting dynamic subtest: vecs0
[246.884188] Dynamic subtest vecs0: SUCCESS (3.233s)
[246.896046] Starting dynamic subtest: ccs0
[250.121704] Dynamic subtest ccs0: SUCCESS (3.235s)
[250.124305] Subtest engines: SUCCESS (19.419s)
[250.360624] [054/156] (771s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[250.464942] Starting subtest: psr-rgb565-draw-render
[257.582203] Subtest psr-rgb565-draw-render: SUCCESS (7.121s)
[257.693220] [055/156] (764s left) kms_cursor_crc (cursor-sliding-512x512)
[257.960470] Starting subtest: cursor-sliding-512x512
[257.964724] Subtest cursor-sliding-512x512: SKIP (0.001s)
[258.125725] [056/156] (763s left) gem_ctx_exec (basic-close-race)
[258.183335] Starting subtest: basic-close-race
[263.922325] Subtest basic-close-race: SUCCESS (5.737s)
[264.056951] [057/156] (757s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait)
[264.160279] Starting subtest: plane-primary-toggle-with-vblank-wait
[264.162464] Starting dynamic subtest: pipe-A-eDP-1
[264.334532] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.174s)
[264.641947] Starting dynamic subtest: pipe-B-eDP-1
[265.577433] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.946s)
[265.897812] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (1.737s)
[266.745825] [058/156] (755s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu)
[266.842079] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu
[270.866314] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (4.030s)
[272.035880] [059/156] (750s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[272.136631] Starting subtest: fbcpsrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt
[272.140940] Subtest fbcpsrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[272.230937] [060/156] (749s left) perf_pmu (busy-idle)
[272.270245] Starting subtest: busy-idle
[272.272884] Starting dynamic subtest: rcs0
[272.963898] Dynamic subtest rcs0: SUCCESS (0.695s)
[272.974765] Starting dynamic subtest: bcs0
[273.641452] Dynamic subtest bcs0: SUCCESS (0.675s)
[273.653174] Starting dynamic subtest: vcs0
[274.934246] Dynamic subtest vcs0: SUCCESS (1.290s)
[274.945869] Starting dynamic subtest: vcs1
[276.919349] Dynamic subtest vcs1: SUCCESS (1.982s)
[276.931962] Starting dynamic subtest: vecs0
[278.967361] Dynamic subtest vecs0: SUCCESS (2.045s)
[278.979687] Starting dynamic subtest: ccs0
[279.636651] Dynamic subtest ccs0: SUCCESS (0.668s)
[279.639239] Subtest busy-idle: SUCCESS (7.369s)
[279.772283] [061/156] (742s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-onoff)
[279.873309] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-onoff
[279.877516] Subtest fbcpsr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[279.975133] [062/156] (742s left) gem_pxp (verify-pxp-execution-after-suspend-resume)
[280.092821] Starting subtest: verify-pxp-execution-after-suspend-resume
[287.842203] Subtest verify-pxp-execution-after-suspend-resume: SUCCESS (7.751s)
[287.991739] [063/156] (734s left) gem_exec_balancer (full-pulse)
[288.061151] Starting subtest: full-pulse
[292.821939] Subtest full-pulse: SUCCESS (4.760s)
[293.177008] [064/156] (729s left) kms_flip (bo-too-big)
[293.280608] Starting subtest: bo-too-big
[293.282489] Starting dynamic subtest: A-eDP1
[294.643461] Dynamic subtest A-eDP1: SUCCESS (1.363s)
[294.657906] Starting dynamic subtest: B-eDP1
[295.968231] Dynamic subtest B-eDP1: SUCCESS (1.323s)
[295.980977] Starting dynamic subtest: C-eDP1
[297.307004] Dynamic subtest C-eDP1: SUCCESS (1.338s)
[297.320911] Starting dynamic subtest: D-eDP1
[298.635866] Dynamic subtest D-eDP1: SUCCESS (1.326s)
[298.641843] Subtest bo-too-big: SUCCESS (5.363s)
[299.834775] [065/156] (722s left) kms_psr (pr-sprite-render)
[299.941803] Starting subtest: pr-sprite-render
[299.946071] Subtest pr-sprite-render: SKIP (0.000s)
[300.025701] [066/156] (722s left) i915_hangman (gt-engine-hang)
[300.090275] Starting subtest: gt-engine-hang
[300.092639] Starting dynamic subtest: rcs0
[301.912461] Dynamic subtest rcs0: SUCCESS (1.821s)
[301.925209] Starting dynamic subtest: bcs0
[303.893416] Dynamic subtest bcs0: SUCCESS (1.977s)
[303.906846] Starting dynamic subtest: vcs0
[305.941906] Dynamic subtest vcs0: SUCCESS (2.046s)
[305.953712] Starting dynamic subtest: vcs1
[307.924930] Dynamic subtest vcs1: SUCCESS (1.979s)
[307.939209] Starting dynamic subtest: vecs0
[309.909854] Dynamic subtest vecs0: SUCCESS (1.982s)
[309.923087] Starting dynamic subtest: ccs0
[311.892677] Dynamic subtest ccs0: SUCCESS (1.980s)
[311.895710] Subtest gt-engine-hang: SUCCESS (11.802s)
[311.991591] [067/156] (710s left) gem_blits (basic)
[312.056689] Starting subtest: basic
[314.223482] Subtest basic: SUCCESS (2.165s)
[314.329955] [068/156] (708s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted)
[314.381243] Starting subtest: invalid-multi-wait-unsubmitted-submitted
[314.383618] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s)
[314.461871] [069/156] (708s left) gem_ppgtt (blt-vs-render-ctxn)
[314.514893] Starting subtest: blt-vs-render-ctxN
[347.464082] Subtest blt-vs-render-ctxN: SUCCESS (32.943s)
[347.588466] [070/156] (674s left) drm_mm (drm_mm)
[347.664281] Starting subtest: drm_mm
[347.717154] Starting dynamic subtest: drm_test_mm_init
[347.829454] Dynamic subtest drm_test_mm_init: SUCCESS (0.112s)
[347.838822] Starting dynamic subtest: drm_test_mm_debug
[347.942405] Dynamic subtest drm_test_mm_debug: SUCCESS (0.112s)
[347.952245] Starting dynamic subtest: drm_test_mm_align32
[348.046872] Dynamic subtest drm_test_mm_align32: SUCCESS (0.102s)
[348.056419] Starting dynamic subtest: drm_test_mm_align64
[348.158953] Dynamic subtest drm_test_mm_align64: SUCCESS (0.111s)
[348.175622] Starting dynamic subtest: drm_test_mm_lowest
[348.255440] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.093s)
[348.266771] Starting dynamic subtest: drm_test_mm_highest
[348.354425] Dynamic subtest drm_test_mm_highest: SUCCESS (0.098s)
[348.356413] Subtest drm_mm: SUCCESS (0.687s)
[348.519253] [071/156] (674s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-blt)
[348.635793] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-blt
[348.639982] Subtest fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[348.752030] [072/156] (673s left) kms_frontbuffer_tracking (fbcpsrhdr-modesetfrombusy)
[348.859865] Starting subtest: fbcpsrhdr-modesetfrombusy
[348.863847] Subtest fbcpsrhdr-modesetfrombusy: SKIP (0.000s)
[348.962861] [073/156] (673s left) kms_color (deep-color)
[349.048333] Starting subtest: deep-color
[350.106102] Starting dynamic subtest: pipe-A-eDP-1-gamma
[350.829280] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.720s)
[350.840191] Starting dynamic subtest: pipe-A-eDP-1-degamma
[352.298902] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.469s)
[352.312257] Starting dynamic subtest: pipe-A-eDP-1-ctm
[353.724199] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.426s)
[354.509675] Starting dynamic subtest: pipe-B-eDP-1-gamma
[355.211274] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.715s)
[355.222157] Starting dynamic subtest: pipe-B-eDP-1-degamma
[356.694134] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.480s)
[356.710155] Starting dynamic subtest: pipe-B-eDP-1-ctm
[358.118431] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.425s)
[358.897946] Starting dynamic subtest: pipe-C-eDP-1-gamma
[359.590261] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.699s)
[359.600212] Starting dynamic subtest: pipe-C-eDP-1-degamma
[361.048942] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.456s)
[361.059711] Starting dynamic subtest: pipe-C-eDP-1-ctm
[362.467807] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.419s)
[363.289229] Starting dynamic subtest: pipe-D-eDP-1-gamma
[363.997683] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.715s)
[364.009293] Starting dynamic subtest: pipe-D-eDP-1-degamma
[365.448647] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.450s)
[365.460151] Starting dynamic subtest: pipe-D-eDP-1-ctm
[366.855772] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.406s)
[366.858022] Subtest deep-color: SUCCESS (17.807s)
[367.717575] [074/156] (654s left) kms_big_fb (linear-32bpp-rotate-270)
[367.823670] Starting subtest: linear-32bpp-rotate-270
[367.843451] Subtest linear-32bpp-rotate-270: SKIP (0.019s)
[367.968573] [075/156] (654s left) kms_flip (basic-flip-vs-modeset)
[368.064918] Starting subtest: basic-flip-vs-modeset
[368.067281] Starting dynamic subtest: A-eDP1
[370.706147] Dynamic subtest A-eDP1: SUCCESS (2.638s)
[370.719046] Starting dynamic subtest: B-eDP1
[372.896918] Dynamic subtest B-eDP1: SUCCESS (2.192s)
[372.907480] Starting dynamic subtest: C-eDP1
[375.079018] Dynamic subtest C-eDP1: SUCCESS (2.178s)
[375.089811] Starting dynamic subtest: D-eDP1
[377.262815] Dynamic subtest D-eDP1: SUCCESS (2.182s)
[377.264806] Subtest basic-flip-vs-modeset: SUCCESS (9.198s)
[378.056788] [076/156] (644s left) kms_hdr (invalid-metadata-sizes)
[378.151262] Starting subtest: invalid-metadata-sizes
[378.153639] Starting dynamic subtest: pipe-A-eDP-1-XRGB2101010
[378.157757] Dynamic subtest pipe-A-eDP-1-XRGB2101010: SKIP (0.000s)
[378.171210] Starting dynamic subtest: pipe-A-eDP-1-XRGB16161616F
[378.175644] Dynamic subtest pipe-A-eDP-1-XRGB16161616F: SKIP (0.000s)
[378.179516] Subtest invalid-metadata-sizes: SKIP (0.003s)
[378.225294] [077/156] (644s left) kms_lease (lease-get)
[378.315902] Starting subtest: lease-get
[378.318701] Starting dynamic subtest: pipe-A-eDP-1
[378.321268] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[378.332694] Starting dynamic subtest: pipe-B-eDP-1
[378.334967] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[378.344688] Starting dynamic subtest: pipe-C-eDP-1
[378.346914] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[378.356452] Starting dynamic subtest: pipe-D-eDP-1
[378.358609] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[378.360772] Subtest lease-get: SUCCESS (0.009s)
[378.448092] [078/156] (644s left) kms_cursor_crc (cursor-dpms)
[378.570454] Starting subtest: cursor-dpms
[378.572821] Starting dynamic subtest: pipe-A-eDP-1
[381.627108] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.053s)
[381.637673] Starting dynamic subtest: pipe-D-eDP-1
[385.292706] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.666s)
[385.295162] Subtest cursor-dpms: SUCCESS (6.722s)
[386.143831] [079/156] (636s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[386.243223] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu
[392.824383] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.586s)
[392.936261] [080/156] (629s left) kms_addfb_basic (too-wide)
[393.032357] Starting subtest: too-wide
[393.034717] Subtest too-wide: SUCCESS (0.000s)
[393.136498] [081/156] (629s left) kms_pm_dc (dc5-psr)
[394.235615] Starting subtest: dc5-psr
[397.231495] Subtest dc5-psr: SUCCESS (2.995s)
[398.104937] [082/156] (624s left) gen9_exec_parse (batch-zero-length)
[398.177050] Subtest batch-zero-length: SKIP (0.000s)
[398.248893] [083/156] (624s left) kms_frontbuffer_tracking (psrhdr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[398.350524] Starting subtest: psrhdr-1p-offscreen-pri-shrfb-draw-mmap-wc
[398.354838] Subtest psrhdr-1p-offscreen-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[398.444414] [084/156] (624s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-mc-ccs)
[398.536458] Starting subtest: crc-primary-suspend-y-tiled-gen12-mc-ccs
[398.538750] Starting dynamic subtest: pipe-A-eDP-1
[398.547720] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[398.558469] Starting dynamic subtest: pipe-B-eDP-1
[398.567915] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[398.578329] Starting dynamic subtest: pipe-C-eDP-1
[398.587320] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[398.596810] Starting dynamic subtest: pipe-D-eDP-1
[398.605530] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[398.609894] Subtest crc-primary-suspend-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[400.794780] [085/156] (622s left) kms_frontbuffer_tracking (hdr-rgb101010-draw-render)
[400.891882] Starting subtest: hdr-rgb101010-draw-render
[400.896034] Subtest hdr-rgb101010-draw-render: SKIP (0.000s)
[400.990802] [086/156] (622s left) gem_exec_params (larger-than-life-batch)
[401.051582] Starting subtest: larger-than-life-batch
[403.142123] Subtest larger-than-life-batch: SUCCESS (2.089s)
[404.007638] [087/156] (619s left) gem_lmem_swapping (verify-ccs)
[404.094270] Subtest verify-ccs: SKIP (0.000s)
[404.144312] [088/156] (619s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180-hflip)
[404.256016] Starting subtest: linear-max-hw-stride-32bpp-rotate-180-hflip
[404.260770] Subtest linear-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[404.372364] [089/156] (618s left) gem_exec_suspend (basic-s0)
[404.445248] Starting subtest: basic-S0
[404.447639] Starting dynamic subtest: smem
[424.817153] Dynamic subtest smem: SUCCESS (6.485s)
[424.820288] Subtest basic-S0: SUCCESS (6.487s)
[425.016417] [090/156] (598s left) kms_atomic (test-only)
[425.131713] Starting subtest: test-only
[425.211429] Starting dynamic subtest: pipe-A-eDP-1
[427.759794] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.543s)
[427.762090] Subtest test-only: SUCCESS (2.626s)
[428.555051] [091/156] (594s left) kms_dp_linktrain_fallback (dp-fallback)
[428.661329] Starting subtest: dp-fallback
[428.667873] Subtest dp-fallback: SKIP (0.000s)
[428.733242] [092/156] (594s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move)
[428.834668] Starting subtest: psr-2p-primscrn-spr-indfb-move
[428.838660] Subtest psr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[428.926655] [093/156] (594s left) kms_frontbuffer_tracking (psrhdr-rgb101010-draw-pwrite)
[429.017228] Starting subtest: psrhdr-rgb101010-draw-pwrite
[429.021172] Subtest psrhdr-rgb101010-draw-pwrite: SKIP (0.000s)
[429.117383] [094/156] (594s left) kms_cursor_crc (cursor-rapid-movement-max-size)
[429.422869] Starting subtest: cursor-rapid-movement-max-size
[429.429349] Subtest cursor-rapid-movement-max-size: SKIP (0.000s)
[429.543405] [095/156] (593s left) gem_ctx_param (invalid-get-no-zeromap)
[429.590944] Starting subtest: invalid-get-no-zeromap
[429.592970] Subtest invalid-get-no-zeromap: SUCCESS (0.001s)
[429.705783] [096/156] (593s left) syncobj_timeline (etime-single-wait-for-submit-available-unsubmitted)
[429.763026] Starting subtest: etime-single-wait-for-submit-available-unsubmitted
[429.870628] Subtest etime-single-wait-for-submit-available-unsubmitted: SUCCESS (0.107s)
[429.947273] [097/156] (593s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[430.042396] Starting subtest: hdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[430.046953] Subtest hdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[430.148349] [098/156] (593s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-shrfb-msflip-blt)
[430.243518] Starting subtest: fbchdr-2p-primscrn-shrfb-msflip-blt
[430.247726] Subtest fbchdr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[430.326637] [099/156] (593s left) kms_chamelium_frames (dp-crc-single)
[430.727493] Subtest dp-crc-single: SKIP (0.000s)
[431.564839] [100/156] (592s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-render)
[431.677737] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-render
[435.407330] Subtest fbc-1p-primscrn-cur-indfb-draw-render: SUCCESS (3.735s)
[436.602151] [101/156] (587s left) gem_exec_flush (basic-uc-pro-default)
[436.661748] Starting subtest: basic-uc-pro-default
[442.116628] Subtest basic-uc-pro-default: SUCCESS (5.453s)
[442.318459] [102/156] (581s left) gem_lmem_swapping (parallel-random)
[442.360015] Subtest parallel-random: SKIP (0.000s)
[442.401645] [103/156] (581s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[442.496883] Starting subtest: plane-downscale-factor-0-75-with-rotation
[442.499127] Starting dynamic subtest: pipe-A
[442.723841] Dynamic subtest pipe-A: SUCCESS (0.230s)
[442.736921] Starting dynamic subtest: pipe-B
[444.058059] Dynamic subtest pipe-B: SUCCESS (1.333s)
[444.071487] Starting dynamic subtest: pipe-C
[445.386707] Dynamic subtest pipe-C: SUCCESS (1.327s)
[445.398575] Starting dynamic subtest: pipe-D
[446.709600] Dynamic subtest pipe-D: SUCCESS (1.322s)
[446.711880] Subtest plane-downscale-factor-0-75-with-rotation: SUCCESS (4.215s)
[447.898397] [104/156] (575s left) syncobj_timeline (invalid-single-wait-unsubmitted)
[447.952404] Starting subtest: invalid-single-wait-unsubmitted
[447.954754] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s)
[448.055333] [105/156] (575s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode)
[448.437176] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s)
[449.312014] [106/156] (574s left) drm_read (empty-nonblock)
[449.458951] Starting subtest: empty-nonblock
[449.461316] Subtest empty-nonblock: SUCCESS (0.000s)
[449.585139] [107/156] (574s left) kms_psr (fbc-psr-cursor-render)
[449.680932] Starting subtest: fbc-psr-cursor-render
[449.683249] Starting dynamic subtest: eDP-1
[449.687678] Dynamic subtest eDP-1: SKIP (0.000s)
[449.692388] Subtest fbc-psr-cursor-render: SKIP (0.001s)
[449.754063] [108/156] (574s left) kms_psr (psr-cursor-mmap-cpu)
[449.857456] Starting subtest: psr-cursor-mmap-cpu
[449.859846] Starting dynamic subtest: eDP-1
[451.620748] Dynamic subtest eDP-1: SUCCESS (1.763s)
[451.623165] Subtest psr-cursor-mmap-cpu: SUCCESS (1.764s)
[452.516672] [109/156] (571s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-pri-shrfb-draw-blt)
[452.614703] Starting subtest: psrhdr-2p-primscrn-pri-shrfb-draw-blt
[452.618663] Subtest psrhdr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[452.707898] [110/156] (571s left) kms_frontbuffer_tracking (fbchdr-rgb565-draw-blt)
[452.800141] Starting subtest: fbchdr-rgb565-draw-blt
[452.804367] Subtest fbchdr-rgb565-draw-blt: SKIP (0.000s)
[452.887572] [111/156] (571s left) kms_frontbuffer_tracking (hdr-1p-primscrn-pri-indfb-draw-mmap-wc)
[452.982202] Starting subtest: hdr-1p-primscrn-pri-indfb-draw-mmap-wc
[452.986304] Subtest hdr-1p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[453.083712] [112/156] (571s left) gem_watchdog (default-physical)
[453.157455] Starting subtest: default-physical
[454.913574] Subtest default-physical: SUCCESS (1.768s)
[455.010588] [113/156] (569s left) perf_pmu (module-unload)