[50.303981] Initializing watchdogs
[50.304071]   /dev/watchdog0
[50.320577] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:9a49 Intel Tigerlake (Gen12) TigerLake-LP GT2 [Iris Xe Graphics]
[50.326052] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[50.329119] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[50.330994] [001/156] (960s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-y-tiled)
[50.375586] Starting subtest: yf-tiled-mc-ccs-to-vebox-y-tiled
[50.376309] Starting dynamic subtest: smem
[50.480780] Dynamic subtest smem: SUCCESS (0.105s)
[50.481554] Subtest yf-tiled-mc-ccs-to-vebox-y-tiled: SUCCESS (0.105s)
[50.672563] [002/156] (960s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-modifier)
[50.768625] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-modifier
[50.770074] Subtest pixel-format-4-tiled-dg2-rc-ccs-modifier: SKIP (0.000s)
[50.823541] [003/156] (960s left) kms_psr2_sf (fbc-psr2-overlay-plane-update-sf-dmg-area)
[50.914164] Subtest fbc-psr2-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[50.952420] [004/156] (959s left) kms_psr (psr-cursor-mmap-cpu)
[51.043404] Subtest psr-cursor-mmap-cpu: SKIP (0.000s)
[51.078652] [005/156] (959s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-cur-indfb-draw-mmap-wc)
[51.172419] Starting subtest: fbchdr-1p-primscrn-cur-indfb-draw-mmap-wc
[51.173887] Subtest fbchdr-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[51.270716] [006/156] (959s left) syncobj_timeline (host-signal-ordered)
[51.307375] Starting subtest: host-signal-ordered
[51.308907] Subtest host-signal-ordered: SUCCESS (0.001s)
[51.371352] [007/156] (959s left) gem_exec_balancer (busy)
[51.416007] Starting subtest: busy
[52.128074] Subtest busy: SUCCESS (0.708s)
[52.316910] [008/156] (958s left) gem_exec_reloc (basic-wc-gtt)
[52.354743] Starting subtest: basic-wc-gtt
[52.363300] Subtest basic-wc-gtt: SUCCESS (0.009s)
[52.475645] [009/156] (958s left) kms_flip (flip-vs-suspend)
[52.565304] Starting subtest: flip-vs-suspend
[52.566052] Starting dynamic subtest: A-HDMI-A1
[197.533206] Dynamic subtest A-HDMI-A1: SUCCESS (10.947s)
[197.534722] Subtest flip-vs-suspend: SUCCESS (10.949s)
[209.667083] [010/156] (813s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions-varying-size)
[209.759827] Starting subtest: cursorB-vs-flipA-atomic-transitions-varying-size
[209.762272] Subtest cursorB-vs-flipA-atomic-transitions-varying-size: SKIP (0.002s)
[209.822001] [011/156] (813s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-pwrite)
[209.915097] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-pwrite
[209.916546] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[210.017941] [012/156] (813s left) kms_cursor_edge_walk (64x64-right-edge)
[210.106426] Starting subtest: 64x64-right-edge
[210.107158] Starting dynamic subtest: pipe-A-HDMI-A-1
[211.884898] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.762s)
[211.892825] Starting dynamic subtest: pipe-D-HDMI-A-1
[213.583628] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.686s)
[213.584411] Subtest 64x64-right-edge: SUCCESS (3.451s)
[213.707226] [013/156] (809s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[213.807863] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu
[213.809262] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[213.910601] [014/156] (809s left) perf_pmu (interrupts)
[213.947894] Starting subtest: interrupts
[215.056908] Subtest interrupts: SUCCESS (1.094s)
[215.138844] [FACT perf_pmu (interrupts)] new: kernel.kmod_is_loaded.vgem: true
[215.141034] [015/156] (808s left) kms_getfb (getfb2-handle-zero)
[215.231130] Starting subtest: getfb2-handle-zero
[215.231850] Subtest getfb2-handle-zero: SUCCESS (0.000s)
[215.333039] [016/156] (808s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-shrfb-fliptrack-mmap-gtt)
[215.425972] Starting subtest: fbcpsrhdr-2p-shrfb-fliptrack-mmap-gtt
[215.427378] Subtest fbcpsrhdr-2p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[215.532375] [017/156] (807s left) kms_frontbuffer_tracking (psrhdr-farfromfence-mmap-gtt)
[215.624826] Starting subtest: psrhdr-farfromfence-mmap-gtt
[215.626288] Subtest psrhdr-farfromfence-mmap-gtt: SKIP (0.000s)
[215.725946] [018/156] (807s left) drm_read (short-buffer-block)
[215.834369] Starting subtest: short-buffer-block
[215.835125] Subtest short-buffer-block: SUCCESS (0.000s)
[215.927492] [019/156] (807s left) gem_caching (reads)
[215.966228] Starting subtest: reads
[217.808541] Subtest reads: SUCCESS (1.835s)
[217.917226] [020/156] (805s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[218.011018] Starting subtest: compare-crc-sanitycheck-nv12
[218.012586] Starting dynamic subtest: pipe-A-HDMI-A-1
[218.350565] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.337s)
[218.360379] Starting dynamic subtest: pipe-B-HDMI-A-1
[218.692308] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.338s)
[218.705234] Starting dynamic subtest: pipe-C-HDMI-A-1
[219.017588] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.322s)
[219.026681] Starting dynamic subtest: pipe-D-HDMI-A-1
[219.348128] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.327s)
[219.349826] Subtest compare-crc-sanitycheck-nv12: SUCCESS (1.332s)
[219.525272] [021/156] (804s left) kms_scaling_modes (scaling-mode-full)
[219.620040] Starting subtest: scaling-mode-full
[219.624198] Subtest scaling-mode-full: SKIP (0.001s)
[219.682668] [022/156] (803s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs-cc)
[219.772366] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs-cc
[219.773057] Starting dynamic subtest: pipe-A-HDMI-A-1
[219.779895] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s)
[219.791718] Starting dynamic subtest: pipe-B-HDMI-A-1
[219.798974] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s)
[219.809987] Starting dynamic subtest: pipe-C-HDMI-A-1
[219.816939] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s)
[219.825553] Starting dynamic subtest: pipe-D-HDMI-A-1
[219.832391] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.001s)
[219.833755] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.007s)
[220.055616] [023/156] (803s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs)
[220.145130] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs
[220.145844] Starting dynamic subtest: pipe-A-HDMI-A-1
[220.152668] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s)
[220.160830] Starting dynamic subtest: pipe-B-HDMI-A-1
[220.167668] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s)
[220.175698] Starting dynamic subtest: pipe-C-HDMI-A-1
[220.182571] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s)
[220.190388] Starting dynamic subtest: pipe-D-HDMI-A-1
[220.197234] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.001s)
[220.198590] Subtest crc-primary-rotation-180-yf-tiled-ccs: SKIP (0.007s)
[220.408645] [024/156] (803s left) kms_chamelium_hpd (vga-hpd-after-suspend)
[220.555555] Subtest vga-hpd-after-suspend: SKIP (0.000s)
[220.661246] [025/156] (803s left) kms_ccs (random-ccs-data-4-tiled-mtl-mc-ccs)
[220.764302] Starting subtest: random-ccs-data-4-tiled-mtl-mc-ccs
[220.765030] Starting dynamic subtest: pipe-A-HDMI-A-1
[220.772861] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[220.780861] Starting dynamic subtest: pipe-B-HDMI-A-1
[220.796030] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[220.803904] Starting dynamic subtest: pipe-C-HDMI-A-1
[220.811156] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[220.819932] Starting dynamic subtest: pipe-D-HDMI-A-1
[220.828293] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[220.829713] Subtest random-ccs-data-4-tiled-mtl-mc-ccs: SKIP (0.005s)
[221.020646] [026/156] (802s left) gem_exec_flush (basic-uc-ro-default)
[221.064163] Starting subtest: basic-uc-ro-default
[226.514482] Subtest basic-uc-ro-default: SUCCESS (5.440s)
[226.747605] [027/156] (797s left) gem_spin_batch (engines)
[226.797216] Starting subtest: engines
[226.797904] Starting dynamic subtest: rcs0
[230.149037] Dynamic subtest rcs0: SUCCESS (3.313s)
[230.159864] Starting dynamic subtest: bcs0
[233.469810] Dynamic subtest bcs0: SUCCESS (3.316s)
[233.480888] Starting dynamic subtest: vcs0
[236.766716] Dynamic subtest vcs0: SUCCESS (3.317s)
[236.777883] Starting dynamic subtest: vcs1
[240.111453] Dynamic subtest vcs1: SUCCESS (3.317s)
[240.122436] Starting dynamic subtest: vecs0
[243.432520] Dynamic subtest vecs0: SUCCESS (3.321s)
[243.433548] Subtest engines: SUCCESS (16.590s)
[243.579322] [028/156] (780s left) gem_fence_thrash (bo-copy)
[243.612657] Starting subtest: bo-copy
[244.853044] Subtest bo-copy: SUCCESS (1.233s)
[244.966664] [029/156] (779s left) kms_frontbuffer_tracking (hdr-modesetfrombusy)
[245.060753] Starting subtest: hdr-modesetfrombusy
[245.062150] Subtest hdr-modesetfrombusy: SKIP (0.000s)
[245.155721] [030/156] (778s left) gem_ccs (ctrl-surf-copy-new-ctx)
[245.193754] Starting subtest: ctrl-surf-copy-new-ctx
[245.195309] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s)
[245.253832] [031/156] (778s left) kms_big_fb (linear-16bpp-rotate-270)
[245.354953] Starting subtest: linear-16bpp-rotate-270
[245.432006] Subtest linear-16bpp-rotate-270: SKIP (0.076s)
[245.536880] [032/156] (778s left) gen9_exec_parse (valid-registers)
[245.574774] Subtest valid-registers: SKIP (0.000s)
[245.614868] [033/156] (778s left) i915_suspend (fence-restore-untiled)
[245.647915] Starting subtest: fence-restore-untiled
[265.442889] Subtest fence-restore-untiled: SUCCESS (5.223s)
[270.573189] [034/156] (758s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-msflip-blt)
[270.686198] Starting subtest: psr-2p-scndscrn-indfb-msflip-blt
[270.687694] Subtest psr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[270.782810] [035/156] (758s left) gem_exec_gttfill (multigpu-basic)
[270.946418] Starting subtest: multigpu-basic
[282.903153] Subtest multigpu-basic: SUCCESS (11.894s)
[282.983575] [036/156] (746s left) kms_rotation_crc (primary-y-tiled-reflect-x-90)
[283.137564] Starting subtest: primary-y-tiled-reflect-x-90
[288.167367] Subtest primary-y-tiled-reflect-x-90: SUCCESS (5.015s)
[288.386628] [037/156] (741s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-spr-indfb-onoff)
[288.482703] Starting subtest: fbchdr-1p-primscrn-spr-indfb-onoff
[288.484135] Subtest fbchdr-1p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[288.572731] [038/156] (740s left) kms_color_pipeline (plane-ctm3x4-lut1d)
[288.660987] Starting subtest: plane-ctm3x4-lut1d
[288.750158] Starting dynamic subtest: pipe-A-plane-0
[288.842060] Dynamic subtest pipe-A-plane-0: SUCCESS (0.091s)
[288.859791] Starting dynamic subtest: pipe-A-plane-1
[288.933803] Dynamic subtest pipe-A-plane-1: SUCCESS (0.090s)
[288.950477] Starting dynamic subtest: pipe-A-plane-2
[289.034016] Dynamic subtest pipe-A-plane-2: SUCCESS (0.098s)
[289.251584] Starting dynamic subtest: pipe-B-plane-0
[289.327122] Dynamic subtest pipe-B-plane-0: SUCCESS (0.083s)
[289.343172] Starting dynamic subtest: pipe-B-plane-1
[289.419328] Dynamic subtest pipe-B-plane-1: SUCCESS (0.090s)
[289.434182] Starting dynamic subtest: pipe-B-plane-2
[289.510815] Dynamic subtest pipe-B-plane-2: SUCCESS (0.090s)
[289.713102] Starting dynamic subtest: pipe-C-plane-0
[289.790362] Dynamic subtest pipe-C-plane-0: SUCCESS (0.083s)
[289.803751] Starting dynamic subtest: pipe-C-plane-1
[289.889015] Dynamic subtest pipe-C-plane-1: SUCCESS (0.098s)
[289.902521] Starting dynamic subtest: pipe-C-plane-2
[289.988910] Dynamic subtest pipe-C-plane-2: SUCCESS (0.098s)
[290.187157] Starting dynamic subtest: pipe-D-plane-0
[290.270864] Dynamic subtest pipe-D-plane-0: SUCCESS (0.091s)
[290.284314] Starting dynamic subtest: pipe-D-plane-1
[290.371310] Dynamic subtest pipe-D-plane-1: SUCCESS (0.098s)
[290.387067] Starting dynamic subtest: pipe-D-plane-2
[290.471381] Dynamic subtest pipe-D-plane-2: SUCCESS (0.098s)
[290.520082] Subtest plane-ctm3x4-lut1d: SUCCESS (1.855s)
[290.637056] [039/156] (738s left) api_intel_bb (crc32)
[290.675812] Starting subtest: crc32
[290.677290] Subtest crc32: SKIP (0.000s)
[290.792634] [040/156] (738s left) perf_pmu (rc6)
[290.830504] Starting subtest: rc6
[290.831276] Starting dynamic subtest: gt0
[297.184772] Dynamic subtest gt0: SUCCESS (6.337s)
[297.195945] Starting dynamic subtest: runtime-pm-gt0
[304.724407] Dynamic subtest runtime-pm-gt0: SUCCESS (7.532s)
[304.733371] Starting dynamic subtest: runtime-pm-long-gt0
[317.162105] Dynamic subtest runtime-pm-long-gt0: SUCCESS (12.439s)
[317.170776] Starting dynamic subtest: other-idle-gt0
[317.172233] Dynamic subtest other-idle-gt0: SKIP (0.000s)
[317.172967] Subtest rc6: SUCCESS (26.312s)
[317.529595] [041/156] (712s left) kms_vblank (query-idle)
[317.619689] Starting subtest: query-idle
[317.620379] Starting dynamic subtest: pipe-A-HDMI-A-1
[318.781865] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.160s)
[318.791906] Starting dynamic subtest: pipe-D-HDMI-A-1
[319.941048] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.157s)
[319.941756] Subtest query-idle: SUCCESS (2.322s)
[320.096464] [042/156] (709s left) gem_mmap_gtt (zero-extend)
[320.135104] Starting subtest: zero-extend
[320.135889] Subtest zero-extend: SUCCESS (0.000s)
[320.218658] [043/156] (709s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[320.310688] Starting subtest: basic-flip-after-cursor-legacy
[320.860356] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.550s)
[320.999854] [044/156] (708s left) kms_frontbuffer_tracking (hdr-2p-primscrn-spr-indfb-draw-pwrite)
[321.096515] Starting subtest: hdr-2p-primscrn-spr-indfb-draw-pwrite
[321.097934] Subtest hdr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[321.157453] [045/156] (708s left) syncobj_wait (multi-wait-all-for-submit-submitted-signaled)
[321.200730] Starting subtest: multi-wait-all-for-submit-submitted-signaled
[321.309745] Subtest multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.107s)
[321.372106] [046/156] (708s left) kms_async_flips (invalid-async-flip)
[321.461373] Starting subtest: invalid-async-flip
[321.598646] Starting dynamic subtest: pipe-A-HDMI-A-1
[321.737427] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.139s)
[321.864090] Starting dynamic subtest: pipe-B-HDMI-A-1
[321.962934] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.107s)
[322.069192] Starting dynamic subtest: pipe-C-HDMI-A-1
[322.185081] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.125s)
[322.311722] Starting dynamic subtest: pipe-D-HDMI-A-1
[322.388555] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.102s)
[322.389426] Subtest invalid-async-flip: SUCCESS (0.928s)
[322.586134] [047/156] (707s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[322.692971] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip
[322.694474] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[322.758065] [048/156] (707s left) kms_cursor_crc (cursor-rapid-movement-128x128)
[322.850352] Starting subtest: cursor-rapid-movement-128x128
[322.853922] Starting dynamic subtest: pipe-A-HDMI-A-1
[323.095317] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.241s)
[323.144475] Starting dynamic subtest: pipe-D-HDMI-A-1
[323.366484] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.233s)
[323.367198] Subtest cursor-rapid-movement-128x128: SUCCESS (0.517s)
[323.519028] [049/156] (706s left) gem_ctx_shared (q-smoketest)
[323.568994] Starting subtest: Q-smoketest
[323.569811] Starting dynamic subtest: rcs0
[329.029695] Dynamic subtest rcs0: SUCCESS (5.420s)
[329.041508] Starting dynamic subtest: bcs0
[334.458416] Dynamic subtest bcs0: SUCCESS (5.426s)
[334.469414] Starting dynamic subtest: vcs0
[339.882285] Dynamic subtest vcs0: SUCCESS (5.421s)
[339.893785] Starting dynamic subtest: vcs1
[345.305591] Dynamic subtest vcs1: SUCCESS (5.421s)
[345.315816] Starting dynamic subtest: vecs0
[350.733128] Dynamic subtest vecs0: SUCCESS (5.424s)
[350.734074] Subtest Q-smoketest: SUCCESS (27.117s)
[350.866494] [050/156] (679s left) api_intel_bb (render)
[350.899724] Starting subtest: render
[350.900419] Starting dynamic subtest: render-none-512
[350.991319] Dynamic subtest render-none-512: SUCCESS (0.091s)
[351.000012] Starting dynamic subtest: render-none-1024
[351.358669] Dynamic subtest render-none-1024: SUCCESS (0.358s)
[351.367342] Starting dynamic subtest: render-x-512
[351.429789] Dynamic subtest render-x-512: SUCCESS (0.079s)
[351.439682] Starting dynamic subtest: render-x-1024
[351.768672] Dynamic subtest render-x-1024: SUCCESS (0.329s)
[351.777792] Starting dynamic subtest: render-y-512
[351.847469] Dynamic subtest render-y-512: SUCCESS (0.087s)
[351.856313] Starting dynamic subtest: render-y-1024
[352.187961] Dynamic subtest render-y-1024: SUCCESS (0.331s)
[352.188697] Subtest render: SUCCESS (1.280s)
[352.266763] [051/156] (677s left) prime_mmap (test_refcounting)
[352.300649] Starting subtest: test_refcounting
[352.301361] Starting dynamic subtest: test_refcounting-smem
[352.303202] Dynamic subtest test_refcounting-smem: SUCCESS (0.002s)
[352.303957] Subtest test_refcounting: SUCCESS (0.002s)
[352.373820] [052/156] (677s left) kms_frontbuffer_tracking (psrhdr-1p-pri-indfb-multidraw)
[352.468320] Starting subtest: psrhdr-1p-pri-indfb-multidraw
[352.469721] Subtest psrhdr-1p-pri-indfb-multidraw: SKIP (0.000s)
[352.553451] [053/156] (677s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-indfb-msflip-blt)
[352.645690] Starting subtest: fbcpsrhdr-2p-scndscrn-indfb-msflip-blt
[352.647168] Subtest fbcpsrhdr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[352.710162] [054/156] (677s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[352.802701] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[352.804151] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[352.871698] [055/156] (677s left) kms_psr2_su (page_flip-nv12)
[352.907277] Subtest page_flip-NV12: SKIP (0.000s)
[352.947012] [056/156] (677s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[353.039473] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-wc
[353.040890] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[353.111508] [057/156] (677s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted-signaled)
[353.147056] Starting subtest: multi-wait-all-for-submit-available-submitted-signaled
[353.147768] Subtest multi-wait-all-for-submit-available-submitted-signaled: SUCCESS (0.001s)
[353.191144] [058/156] (677s left) perf (gen12-oa-tlb-invalidate)
[353.263646] Starting subtest: gen12-oa-tlb-invalidate
[353.264412] Starting dynamic subtest: 0-rcs0
[363.356509] Dynamic subtest 0-rcs0: SUCCESS (10.055s)
[363.357633] Subtest gen12-oa-tlb-invalidate: SUCCESS (10.056s)
[363.414535] [059/156] (666s left) kms_ccs (crc-sprite-planes-basic-4-tiled-lnl-ccs)
[363.515907] Starting subtest: crc-sprite-planes-basic-4-tiled-lnl-ccs
[363.517324] Subtest crc-sprite-planes-basic-4-tiled-lnl-ccs: SKIP (0.000s)
[363.673059] [060/156] (666s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[363.769074] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu
[365.046024] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (1.277s)
[365.151663] [061/156] (665s left) kms_psr (psr2-dpms)
[365.242696] Subtest psr2-dpms: SKIP (0.000s)
[365.287962] [062/156] (665s left) gem_mmap_gtt (fault-concurrent-x)
[365.322406] Starting subtest: fault-concurrent-X
[368.062562] Subtest fault-concurrent-X: SUCCESS (2.732s)
[368.146668] [063/156] (662s left) gem_ctx_bad_destroy (invalid-ctx)
[368.184655] Starting subtest: invalid-ctx
[368.185368] Subtest invalid-ctx: SUCCESS (0.000s)
[368.232246] [064/156] (662s left) kms_pm_rpm (i2c)
[369.641253] Starting subtest: i2c
[372.332172] Subtest i2c: SUCCESS (2.692s)
[372.427146] [065/156] (658s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-cur-indfb-onoff)
[372.520365] Starting subtest: fbchdr-2p-primscrn-cur-indfb-onoff
[372.521796] Subtest fbchdr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[372.585214] [066/156] (658s left) kms_pm_rpm (modeset-non-lpsp-stress-no-wait)
[373.980776] Starting subtest: modeset-non-lpsp-stress-no-wait
[374.076630] Subtest modeset-non-lpsp-stress-no-wait: SKIP (0.095s)
[374.179622] [067/156] (656s left) kms_psr (fbc-psr2-cursor-mmap-gtt)
[374.271680] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.000s)
[374.317769] [068/156] (656s left) gem_exec_reloc (basic-gtt-cpu)
[374.357853] Starting subtest: basic-gtt-cpu
[374.363703] Subtest basic-gtt-cpu: SUCCESS (0.007s)
[374.462954] [069/156] (656s left) gen7_exec_parse (basic-rejected)
[374.501592] Subtest basic-rejected: SKIP (0.000s)
[374.542061] [070/156] (656s left) kms_draw_crc (draw-method-mmap-cpu)
[374.631076] Starting subtest: draw-method-mmap-cpu
[374.631917] Starting dynamic subtest: xrgb8888-untiled
[374.783805] Dynamic subtest xrgb8888-untiled: SUCCESS (0.152s)
[374.800553] Starting dynamic subtest: rgb565-untiled
[374.942139] Dynamic subtest rgb565-untiled: SUCCESS (0.156s)
[374.958939] Starting dynamic subtest: xrgb2101010-untiled
[375.084365] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.139s)
[375.101662] Starting dynamic subtest: xbgr16161616f-untiled
[375.233849] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.147s)
[375.250541] Starting dynamic subtest: xrgb8888-xtiled
[375.316975] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.081s)
[375.332203] Starting dynamic subtest: rgb565-xtiled
[375.400323] Dynamic subtest rgb565-xtiled: SUCCESS (0.081s)
[375.416005] Starting dynamic subtest: xrgb2101010-xtiled
[375.475618] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.073s)
[375.491417] Starting dynamic subtest: xbgr16161616f-xtiled
[375.558671] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.081s)
[375.575993] Starting dynamic subtest: xrgb8888-ytiled
[375.649995] Dynamic subtest xrgb8888-ytiled: SUCCESS (0.088s)
[375.665233] Starting dynamic subtest: rgb565-ytiled
[375.734037] Dynamic subtest rgb565-ytiled: SUCCESS (0.082s)
[375.751550] Starting dynamic subtest: xrgb2101010-ytiled
[375.817066] Dynamic subtest xrgb2101010-ytiled: SUCCESS (0.080s)
[375.834631] Starting dynamic subtest: xbgr16161616f-ytiled
[375.908677] Dynamic subtest xbgr16161616f-ytiled: SUCCESS (0.089s)
[375.913083] Subtest draw-method-mmap-cpu: SUCCESS (1.280s)
[375.991782] [071/156] (654s left) kms_flip (basic-flip-vs-dpms)
[376.082598] Starting subtest: basic-flip-vs-dpms
[376.084841] Starting dynamic subtest: A-HDMI-A1
[376.762706] Dynamic subtest A-HDMI-A1: SUCCESS (0.678s)
[376.776589] Starting dynamic subtest: B-HDMI-A1
[377.411472] Dynamic subtest B-HDMI-A1: SUCCESS (0.645s)
[377.420781] Starting dynamic subtest: C-HDMI-A1
[378.129144] Dynamic subtest C-HDMI-A1: SUCCESS (0.717s)
[378.140103] Starting dynamic subtest: D-HDMI-A1
[378.842940] Dynamic subtest D-HDMI-A1: SUCCESS (0.712s)
[378.845725] Subtest basic-flip-vs-dpms: SUCCESS (2.764s)
[378.970740] [072/156] (651s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[379.071360] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[379.072775] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[379.134194] [073/156] (651s left) syncobj_timeline (multi-wait-for-submit-signaled)
[379.169138] Starting subtest: multi-wait-for-submit-signaled
[379.169844] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[379.217744] [074/156] (651s left) i915_pciid
[379.290639] [075/156] (651s left) gem_render_copy (yf-tiled)
[379.331815] Starting subtest: yf-tiled
[379.332630] Starting dynamic subtest: smem
[379.399168] Dynamic subtest smem: SUCCESS (0.068s)
[379.399997] Subtest yf-tiled: SUCCESS (0.069s)
[379.571121] [076/156] (651s left) gem_ctx_param (get-priority-new-ctx)
[379.604750] Starting subtest: get-priority-new-ctx
[379.605571] Subtest get-priority-new-ctx: SUCCESS (0.000s)
[379.648080] [077/156] (651s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[379.740338] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[379.741739] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[379.812415] [078/156] (651s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs)
[379.901021] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs
[379.901718] Starting dynamic subtest: pipe-A-HDMI-A-1
[379.908368] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[379.917475] Starting dynamic subtest: pipe-B-HDMI-A-1
[379.924125] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[379.933165] Starting dynamic subtest: pipe-C-HDMI-A-1
[379.939821] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[379.948681] Starting dynamic subtest: pipe-D-HDMI-A-1
[379.956091] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[379.957501] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs: SKIP (0.007s)
[380.139229] [079/156] (651s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[380.231995] Starting subtest: fbcpsrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[380.233403] Subtest fbcpsrhdr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[380.294124] [080/156] (650s left) gem_cs_tlb (engines)
[380.331253] Starting subtest: engines
[380.331993] Starting dynamic subtest: rcs0
[382.490341] Dynamic subtest rcs0: SUCCESS (2.150s)
[382.499721] Starting dynamic subtest: bcs0
[384.640977] Dynamic subtest bcs0: SUCCESS (2.150s)
[384.651078] Starting dynamic subtest: vcs0
[386.791721] Dynamic subtest vcs0: SUCCESS (2.150s)
[386.800819] Starting dynamic subtest: vcs1
[388.942294] Dynamic subtest vcs1: SUCCESS (2.150s)
[388.951559] Starting dynamic subtest: vecs0
[391.092988] Dynamic subtest vecs0: SUCCESS (2.150s)
[391.093694] Subtest engines: SUCCESS (10.755s)
[391.178577] [081/156] (640s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions)
[391.268977] Starting subtest: short-busy-flip-before-cursor-atomic-transitions
[391.270358] Subtest short-busy-flip-before-cursor-atomic-transitions: SKIP (0.000s)
[391.309748] [082/156] (639s left) kms_pm_dc (dc3co-vpb-simulation)
[392.408859] Starting subtest: dc3co-vpb-simulation
[392.410428] Subtest dc3co-vpb-simulation: SKIP (0.000s)
[392.452873] [083/156] (638s left) kms_content_protection (dp-mst-lic-type-0)
[392.546646] Starting subtest: dp-mst-lic-type-0
[392.548112] Subtest dp-mst-lic-type-0: SKIP (0.000s)
[392.625920] [084/156] (638s left) sw_sync (sync_busy_fork)
[392.660177] Starting subtest: sync_busy_fork
[393.673370] Subtest sync_busy_fork: SUCCESS (1.013s)
[393.715944] [085/156] (637s left) gem_exec_schedule (u-fairslice)
[393.760121] Starting subtest: u-fairslice
[393.760933] Starting dynamic subtest: rcs0
[395.784083] Dynamic subtest rcs0: SUCCESS (2.014s)
[395.795071] Starting dynamic subtest: bcs0
[397.797398] Dynamic subtest bcs0: SUCCESS (2.011s)
[397.809176] Starting dynamic subtest: vcs0
[399.809890] Dynamic subtest vcs0: SUCCESS (2.012s)
[399.821662] Starting dynamic subtest: vcs1
[401.822014] Dynamic subtest vcs1: SUCCESS (2.011s)
[401.834009] Starting dynamic subtest: vecs0
[403.834388] Dynamic subtest vecs0: SUCCESS (2.011s)
[403.835362] Subtest u-fairslice: SUCCESS (10.065s)
[404.115435] [086/156] (627s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-pwrite)
[404.210360] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-pwrite
[404.211792] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[404.286014] [087/156] (627s left) gen7_exec_parse (basic-allowed)
[404.323147] Subtest basic-allowed: SKIP (0.000s)
[404.369177] [088/156] (627s left) kms_frontbuffer_tracking (hdr-2p-pri-indfb-multidraw)
[404.461645] Starting subtest: hdr-2p-pri-indfb-multidraw
[404.463117] Subtest hdr-2p-pri-indfb-multidraw: SKIP (0.000s)
[404.531539] [089/156] (627s left) kms_cursor_crc (cursor-offscreen-512x170)
[404.624406] Starting subtest: cursor-offscreen-512x170
[404.625782] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[404.702047] [090/156] (626s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[404.798978] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[405.124762] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.326s)
[405.240016] [091/156] (626s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0)
[405.337520] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0
[405.951146] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (0.613s)
[406.058345] [092/156] (625s left) gem_mmap_wc (write)
[406.094470] Starting subtest: write
[406.128523] Subtest write: SUCCESS (0.035s)
[406.203023] [093/156] (625s left) gem_exec_fence (syncobj-export)
[406.549790] Starting subtest: syncobj-export
[406.551498] Subtest syncobj-export: SUCCESS (0.003s)
[406.837966] [094/156] (624s left) kms_big_fb (4-tiled-16bpp-rotate-90)
[406.937292] Starting subtest: 4-tiled-16bpp-rotate-90
[406.938679] Subtest 4-tiled-16bpp-rotate-90: SKIP (0.000s)
[406.985482] [095/156] (624s left) gem_exec_flush (basic-wb-rw-before-default)
[407.028145] Starting subtest: basic-wb-rw-before-default
[412.455908] Subtest basic-wb-rw-before-default: SUCCESS (5.427s)
[412.656288] [096/156] (619s left) gem_mmap_gtt (basic-write-read)
[412.691116] Starting subtest: basic-write-read
[412.692819] Subtest basic-write-read: SUCCESS (0.003s)
[412.778293] [097/156] (619s left) gem_partial_pwrite_pread (writes-after-reads)
[412.816300] Starting subtest: writes-after-reads
[425.089308] Subtest writes-after-reads: SUCCESS (12.268s)
[425.179750] [098/156] (606s left) syncobj_wait (single-wait-for-submit-signaled)
[425.214499] Starting subtest: single-wait-for-submit-signaled
[425.215286] Subtest single-wait-for-submit-signaled: SUCCESS (0.000s)
[425.257719] [099/156] (606s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-render)
[425.352319] Starting subtest: psr-1p-primscrn-pri-indfb-draw-render
[425.353694] Subtest psr-1p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[425.433126] [100/156] (606s left) gem_exec_fence (basic-busy)
[425.593828] Starting subtest: basic-busy
[425.594897] Starting dynamic subtest: rcs0
[425.639641] Dynamic subtest rcs0: SUCCESS (0.044s)
[425.661094] Starting dynamic subtest: bcs0
[425.684677] Dynamic subtest bcs0: SUCCESS (0.042s)
[425.702767] Starting dynamic subtest: vcs0
[425.719394] Dynamic subtest vcs0: SUCCESS (0.031s)
[425.735136] Starting dynamic subtest: vcs1
[425.764485] Dynamic subtest vcs1: SUCCESS (0.043s)
[425.782989] Starting dynamic subtest: vecs0
[425.803445] Dynamic subtest vecs0: SUCCESS (0.035s)
[425.804560] Subtest basic-busy: SUCCESS (0.211s)
[426.258085] [101/156] (605s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-cur-indfb-draw-pwrite)
[426.351084] Starting subtest: fbcpsrhdr-2p-primscrn-cur-indfb-draw-pwrite
[426.352505] Subtest fbcpsrhdr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[426.428861] [102/156] (605s left) gem_workarounds (suspend-resume-context)
[426.479505] Starting subtest: suspend-resume-context
[442.514886] Subtest suspend-resume-context: SUCCESS (1.269s)
[450.637378] [103/156] (589s left) kms_frontbuffer_tracking (fbchdr-indfb-scaledprimary)
[450.741194] Starting subtest: fbchdr-indfb-scaledprimary
[450.742680] Subtest fbchdr-indfb-scaledprimary: SKIP (0.000s)
[450.816372] [104/156] (589s left) kms_psr (fbc-psr-sprite-render)
[450.907507] Subtest fbc-psr-sprite-render: SKIP (0.000s)
[450.954938] [105/156] (589s left) sysfs_preempt_timeout (timeout)
[450.993995] Starting subtest: timeout
[450.996378] Starting dynamic subtest: vecs0
[451.897185] Dynamic subtest vecs0: SUCCESS (0.892s)
[451.910375] Starting dynamic subtest: vcs0
[452.801538] Dynamic subtest vcs0: SUCCESS (0.892s)
[452.814611] Starting dynamic subtest: bcs0
[453.680626] Dynamic subtest bcs0: SUCCESS (0.869s)
[453.693689] Starting dynamic subtest: rcs0
[454.582720] Dynamic subtest rcs0: SUCCESS (0.893s)
[454.595705] Starting dynamic subtest: vcs1
[455.485615] Dynamic subtest vcs1: SUCCESS (0.894s)
[455.486789] Subtest timeout: SUCCESS (4.455s)
[455.534555] [106/156] (584s left) gem_exec_whisper (basic-queues-all)
[455.580521] Starting subtest: basic-queues-all
[456.896689] Subtest basic-queues-all: SUCCESS (1.307s)
[457.086092] [107/156] (583s left) gem_gpgpu_fill (offset-16x16)
[457.122619] Starting subtest: offset-16x16
[457.127989] Subtest offset-16x16: SUCCESS (0.005s)
[457.225812] [108/156] (583s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-shrfb-plflip-blt)
[457.324215] Starting subtest: fbchdr-2p-primscrn-shrfb-plflip-blt
[457.325621] Subtest fbchdr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[457.390044] [109/156] (583s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-cur-indfb-draw-pwrite)
[457.484523] Starting subtest: psrhdr-2p-primscrn-cur-indfb-draw-pwrite
[457.485946] Subtest psrhdr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[457.555839] [110/156] (582s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-wc)
[457.652247] Starting subtest: fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-wc
[457.653782] Subtest fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[457.716599] [111/156] (582s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[457.809770] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[457.811192] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[457.879021] [112/156] (582s left) kms_big_fb (x-tiled-addfb-size-offset-overflow)
[457.978049] Starting subtest: x-tiled-addfb-size-offset-overflow
[457.978779] Subtest x-tiled-addfb-size-offset-overflow: SUCCESS (0.000s)
[458.034240] [113/156] (582s left) gem_reg_read (bad-register)
[458.069248] Starting subtest: bad-register
[458.069956] Subtest bad-register: SUCCESS (0.000s)
[458.109386] [114/156] (582s left) perf_pmu (frequency)
[458.147822] Starting subtest: frequency
[458.148518] Starting dynamic subtest: gt0
[460.269262] Dynamic subtest gt0: SUCCESS (2.110s)
[460.279804] Starting dynamic subtest: idle-gt0
[460.785552] Dynamic subtest idle-gt0: SUCCESS (0.504s)
[460.786803] Subtest frequency: SUCCESS (2.621s)
[460.828584] [115/156] (579s left) gem_ctx_persistence (userptr)
[460.869165] Starting subtest: userptr
[460.964287] Subtest userptr: SUCCESS (0.094s)
[461.013356] [116/156] (579s left) kms_addfb_basic (invalid-smem-bo-on-discrete)
[461.049507] Starting subtest: invalid-smem-bo-on-discrete
[461.050922] Subtest invalid-smem-bo-on-discrete: SKIP (0.000s)
[461.175946] [117/156] (579s left) gem_pwrite (basic-random)
[461.212599] Starting subtest: basic-random
[466.781466] Subtest basic-random: SUCCESS (5.519s)
[466.852780] [118/156] (573s left) kms_plane_scaling (plane-downscale-factor-0-5-with-modifiers)
[466.993012] Starting subtest: plane-downscale-factor-0-5-with-modifiers
[466.993746] Starting dynamic subtest: pipe-A
[467.453742] Dynamic subtest pipe-A: SUCCESS (0.460s)
[467.473673] Starting dynamic subtest: pipe-B
[467.904923] Dynamic subtest pipe-B: SUCCESS (0.449s)
[467.920237] Starting dynamic subtest: pipe-C
[468.350067] Dynamic subtest pipe-C: SUCCESS (0.443s)
[468.360963] Starting dynamic subtest: pipe-D
[468.794376] Dynamic subtest pipe-D: SUCCESS (0.443s)
[468.795117] Subtest plane-downscale-factor-0-5-with-modifiers: SUCCESS (1.800s)
[468.972885] [119/156] (571s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-pri-indfb-draw-pwrite)
[469.071390] Starting subtest: psrhdr-2p-primscrn-pri-indfb-draw-pwrite
[469.072861] Subtest psrhdr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[469.145137] [120/156] (571s left) sw_sync (alloc_fence_invalid_timeline)
[469.185329] Starting subtest: alloc_fence_invalid_timeline
[469.186090] Subtest alloc_fence_invalid_timeline: SUCCESS (0.000s)
[469.222021] [121/156] (571s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-blt)
[469.314885] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-blt
[469.316349] Subtest psr-1p-offscreen-pri-shrfb-draw-blt: SKIP (0.000s)
[469.388981] [122/156] (571s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area)
[469.482372] Subtest psr2-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[469.528417] [123/156] (571s left) kms_plane (pixel-format-y-tiled-ccs-modifier)
[469.618077] Starting subtest: pixel-format-y-tiled-ccs-modifier
[469.619566] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.000s)
[469.666805] [124/156] (571s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[469.759574] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt
[470.822516] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-gtt: SUCCESS (1.062s)
[470.927829] [125/156] (570s left) gem_basic (create-fd-close)
[470.962045] Starting subtest: create-fd-close
[470.963493] Subtest create-fd-close: SUCCESS (0.000s)
[471.045558] [126/156] (570s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[471.140559] Starting subtest: fbcpsrhdr-2p-primscrn-pri-shrfb-draw-mmap-gtt
[471.142019] Subtest fbcpsrhdr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[471.202955] [127/156] (569s left) gem_mmap_gtt (basic-short)
[471.237187] Starting subtest: basic-short
[471.256129] Subtest basic-short: SUCCESS (0.019s)
[471.309404] [128/156] (569s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-blt)
[471.405258] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-blt
[471.406826] Subtest fbc-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[471.470933] [129/156] (569s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-downscaling)
[471.559015] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-downscaling
[471.560797] Starting dynamic subtest: pipe-A-valid-mode
[472.759520] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.197s)
[472.760306] Subtest flip-32bpp-ytile-to-64bpp-ytile-downscaling: SUCCESS (1.199s)
[472.934041] [130/156] (568s left) kms_frontbuffer_tracking (hdr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[473.033437] Starting subtest: hdr-1p-offscreen-pri-shrfb-draw-mmap-wc
[473.034935] Subtest hdr-1p-offscreen-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[473.102184] [131/156] (568s left) syncobj_timeline (wait-all-for-submit-snapshot)
[473.138585] Starting subtest: wait-all-for-submit-snapshot
[473.221536] Subtest wait-all-for-submit-snapshot: SUCCESS (0.083s)
[473.283136] [132/156] (568s left) kms_atomic_transition (plane-all-modeset-transition)
[473.371175] Starting subtest: plane-all-modeset-transition
[473.372963] Starting dynamic subtest: pipe-A-HDMI-A-1
[473.618073] Dynamic subtest pipe-A-HDMI-A-1: FAIL (0.061s)
[473.628139] Starting dynamic subtest: pipe-B-HDMI-A-1
[484.633261] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (11.193s)
[484.659770] Subtest plane-all-modeset-transition: FAIL (11.285s)
[484.800563] [133/156] (556s left) gem_ctx_persistence (engines-queued)
[484.844611] Starting subtest: engines-queued
[484.845407] Starting dynamic subtest: rcs0
[484.887798] Dynamic subtest rcs0: SUCCESS (0.042s)
[484.907357] Starting dynamic subtest: bcs0
[484.936809] Dynamic subtest bcs0: SUCCESS (0.046s)
[484.957702] Starting dynamic subtest: vcs0
[484.989779] Dynamic subtest vcs0: SUCCESS (0.050s)
[485.011109] Starting dynamic subtest: vcs1
[485.041662] Dynamic subtest vcs1: SUCCESS (0.049s)
[485.062402] Starting dynamic subtest: vecs0
[485.093731] Dynamic subtest vecs0: SUCCESS (0.049s)
[485.097460] Subtest engines-queued: SUCCESS (0.250s)
[485.163271] [134/156] (556s left) prime_mmap_coherency (write)
[485.203968] Starting subtest: write
[490.586229] Subtest write: SUCCESS (5.372s)
[490.670165] [135/156] (550s left) i915_pm_rpm (gem-mmap-type)
[492.087484] Starting subtest: gem-mmap-type
[492.088712] Starting dynamic subtest: gtt-smem0
[498.311340] Dynamic subtest gtt-smem0: SUCCESS (6.223s)
[498.323227] Starting dynamic subtest: wb-smem0
[500.743226] Dynamic subtest wb-smem0: SUCCESS (2.430s)
[500.753466] Starting dynamic subtest: wc-smem0
[503.333865] Dynamic subtest wc-smem0: SUCCESS (2.590s)
[503.345573] Starting dynamic subtest: uc-smem0
[505.828795] Dynamic subtest uc-smem0: SUCCESS (2.492s)
[505.829540] Subtest gem-mmap-type: SUCCESS (13.740s)
[505.929008] [136/156] (535s left) gem_exec_schedule (preempt-queue-contexts-chain)
[505.978153] Starting subtest: preempt-queue-contexts-chain
[505.978849] Starting dynamic subtest: rcs0
[506.363038] Dynamic subtest rcs0: SUCCESS (0.377s)
[506.376425] Starting dynamic subtest: bcs0
[506.747999] Dynamic subtest bcs0: SUCCESS (0.384s)
[506.761259] Starting dynamic subtest: vcs0
[507.116605] Dynamic subtest vcs0: SUCCESS (0.367s)
[507.128765] Starting dynamic subtest: vcs1
[507.482846] Dynamic subtest vcs1: SUCCESS (0.365s)
[507.493970] Starting dynamic subtest: vecs0
[507.838128] Dynamic subtest vecs0: SUCCESS (0.354s)
[507.838874] Subtest preempt-queue-contexts-chain: SUCCESS (1.853s)
[508.129559] [137/156] (533s left) gem_softpin (evict-snoop)
[508.170971] Starting subtest: evict-snoop
[508.172481] Subtest evict-snoop: SKIP (0.000s)
[508.222107] [138/156] (533s left) kms_force_connector_basic (force-connector-state)
[508.346981] Starting subtest: force-connector-state
[508.652897] Subtest force-connector-state: SUCCESS (0.301s)
[508.900835] [139/156] (532s left) kms_invalid_mode (int-max-clock)
[508.993776] Starting subtest: int-max-clock
[508.994474] Starting dynamic subtest: pipe-A-HDMI-A-1
[509.042931] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.049s)
[509.054738] Starting dynamic subtest: pipe-B-HDMI-A-1
[509.055429] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s)
[509.064966] Starting dynamic subtest: pipe-C-HDMI-A-1
[509.065661] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.001s)
[509.076293] Starting dynamic subtest: pipe-D-HDMI-A-1
[509.076991] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.001s)
[509.077676] Subtest int-max-clock: SUCCESS (0.058s)
[509.174890] [140/156] (532s left) syncobj_timeline (etime-multi-wait-available-unsubmitted)
[509.212647] Starting subtest: etime-multi-wait-available-unsubmitted
[509.319786] Subtest etime-multi-wait-available-unsubmitted: SUCCESS (0.106s)
[509.378815] [141/156] (532s left) gem_render_copy_redux (normal)
[509.417572] Starting subtest: normal
[509.739326] Subtest normal: SUCCESS (0.313s)
[509.828701] [142/156] (532s left) syncobj_wait (wait-for-submit-delayed-submit)
[509.864534] Starting subtest: wait-for-submit-delayed-submit
[509.967607] Subtest wait-for-submit-delayed-submit: SUCCESS (0.102s)
[510.030731] [143/156] (531s left) dumb_buffer (map-invalid-size)
[510.066891] Starting subtest: map-invalid-size
[510.067603] Subtest map-invalid-size: SUCCESS (0.000s)
[510.127199] [144/156] (531s left) kms_pipe_stress (stress-xrgb8888-yftiled)
[510.226647] Starting subtest: stress-xrgb8888-yftiled
[510.228166] Subtest stress-xrgb8888-yftiled: SKIP (0.000s)
[510.269998] [145/156] (531s left) perf (polling-parameterized)
[510.337828] Starting subtest: polling-parameterized
[530.386457] Subtest polling-parameterized: SUCCESS (20.008s)
[530.453878] [146/156] (511s left) kms_frontbuffer_tracking (hdr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[530.561897] Starting subtest: hdr-1p-primscrn-cur-indfb-draw-mmap-gtt
[530.563330] Subtest hdr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[530.614966] [147/156] (511s left) kms_chamelium_edid (dp-edid-stress-resolution-4k)
[530.762913] Subtest dp-edid-stress-resolution-4k: SKIP (0.000s)
[530.873935] [148/156] (511s left) gem_mmap_gtt (basic-copy)
[530.912661] Starting subtest: basic-copy
[531.376672] Subtest basic-copy: SUCCESS (0.457s)
[531.439882] [149/156] (510s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[531.533250] Starting subtest: psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[531.534602] Subtest psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[531.585773] [150/156] (510s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[531.688320] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[531.689798] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[531.743550] [151/156] (510s left) prime_busy (hang)
[531.781785] Starting subtest: hang
[531.782491] Starting dynamic subtest: rcs0
[545.898500] Dynamic subtest rcs0: SUCCESS (14.076s)
[545.907658] Starting dynamic subtest: bcs0
[552.874740] Dynamic subtest bcs0: SUCCESS (6.977s)
[552.883945] Starting dynamic subtest: vcs0
[559.916474] Dynamic subtest vcs0: SUCCESS (7.040s)
[559.925807] Starting dynamic subtest: vcs1
[566.892059] Dynamic subtest vcs1: SUCCESS (6.976s)
[566.901477] Starting dynamic subtest: vecs0
[573.932560] Dynamic subtest vecs0: SUCCESS (7.039s)
[573.933524] Subtest hang: SUCCESS (42.115s)
[573.983182] [152/156] (468s left) kms_vblank (ts-continuation-suspend)
[574.076065] Starting subtest: ts-continuation-suspend
[574.076794] Starting dynamic subtest: pipe-A-HDMI-A-1
[590.573535] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.465s)
[590.587605] Starting dynamic subtest: pipe-D-HDMI-A-1
[607.545706] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.287s)
[607.546457] Subtest ts-continuation-suspend: SUCCESS (2.757s)
[616.692712] [153/156] (434s left) gem_tiled_partial_pwrite_pread (writes)
[616.732993] Starting subtest: writes
[617.357715] Subtest writes: SUCCESS (0.618s)
[617.450206] [154/156] (433s left) kms_flip (plain-flip-fb-recreate-interruptible)
[617.546893] Starting subtest: plain-flip-fb-recreate-interruptible
[617.550020] Starting dynamic subtest: A-HDMI-A1
[636.144729] Dynamic subtest A-HDMI-A1: SUCCESS (18.517s)
[636.161223] Starting dynamic subtest: B-HDMI-A1
[643.946461] Dynamic subtest B-HDMI-A1: SUCCESS (7.790s)
[643.961912] Starting dynamic subtest: C-HDMI-A1
[651.732311] Dynamic subtest C-HDMI-A1: SUCCESS (7.781s)
[651.753007] Starting dynamic subtest: D-HDMI-A1
[659.544909] Dynamic subtest D-HDMI-A1: SUCCESS (7.810s)
[659.550496] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (41.917s)
[659.698609] [155/156] (391s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-shrfb-pgflip-blt)
[659.794975] Starting subtest: hdr-2p-scndscrn-shrfb-pgflip-blt
[659.796389] Subtest hdr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[659.875807] [156/156] (391s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[659.967994] Starting subtest: fbcpsr-indfb-scaledprimary
[659.969399] Subtest fbcpsr-indfb-scaledprimary: SKIP (0.000s)
[660.038097] Closing watchdogs
results: parsing output: 0/ for test: gem_render_copy
results: parsing output: 1/ for test: kms_plane
results: parsing output: 2/ for test: kms_psr2_sf
results: parsing output: 3/ for test: kms_psr
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: syncobj_timeline
results: parsing output: 6/ for test: gem_exec_balancer
results: parsing output: 7/ for test: gem_exec_reloc
results: parsing output: 8/ for test: kms_flip
results: parsing output: 9/ for test: kms_cursor_legacy
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_cursor_edge_walk
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: perf_pmu
results: parsing output: 14/ for test: kms_getfb
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: drm_read
results: parsing output: 18/ for test: gem_caching
results: parsing output: 19/ for test: kms_pipe_crc_basic
results: parsing output: 20/ for test: kms_scaling_modes
results: parsing output: 21/ for test: kms_ccs
results: parsing output: 22/ for test: kms_ccs
results: parsing output: 23/ for test: kms_chamelium_hpd
results: parsing output: 24/ for test: kms_ccs
results: parsing output: 25/ for test: gem_exec_flush
results: parsing output: 26/ for test: gem_spin_batch
results: parsing output: 27/ for test: gem_fence_thrash
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: gem_ccs
results: parsing output: 30/ for test: kms_big_fb
results: parsing output: 31/ for test: gen9_exec_parse
results: parsing output: 32/ for test: i915_suspend
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: gem_exec_gttfill
results: parsing output: 35/ for test: kms_rotation_crc
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: kms_color_pipeline
results: parsing output: 38/ for test: api_intel_bb
results: parsing output: 39/ for test: perf_pmu
results: parsing output: 40/ for test: kms_vblank
results: parsing output: 41/ for test: gem_mmap_gtt
results: parsing output: 42/ for test: kms_cursor_legacy
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: syncobj_wait
results: parsing output: 45/ for test: kms_async_flips
results: parsing output: 46/ for test: kms_big_fb
results: parsing output: 47/ for test: kms_cursor_crc
results: parsing output: 48/ for test: gem_ctx_shared
results: parsing output: 49/ for test: api_intel_bb
results: parsing output: 50/ for test: prime_mmap
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_psr2_su
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: syncobj_timeline
results: parsing output: 57/ for test: perf
results: parsing output: 58/ for test: kms_ccs
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: kms_psr
results: parsing output: 61/ for test: gem_mmap_gtt
results: parsing output: 62/ for test: gem_ctx_bad_destroy
results: parsing output: 63/ for test: kms_pm_rpm
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: kms_pm_rpm
results: parsing output: 66/ for test: kms_psr
results: parsing output: 67/ for test: gem_exec_reloc
results: parsing output: 68/ for test: gen7_exec_parse
results: parsing output: 69/ for test: kms_draw_crc
results: parsing output: 70/ for test: kms_flip
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: syncobj_timeline
results: parsing output: 73/ for test: i915_pciid
results: parsing output: 74/ for test: gem_render_copy
results: parsing output: 75/ for test: gem_ctx_param
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_ccs
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: gem_cs_tlb
results: parsing output: 80/ for test: kms_cursor_legacy
results: parsing output: 81/ for test: kms_pm_dc
results: parsing output: 82/ for test: kms_content_protection
results: parsing output: 83/ for test: sw_sync
results: parsing output: 84/ for test: gem_exec_schedule
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: gen7_exec_parse
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_cursor_crc
results: parsing output: 89/ for test: kms_big_fb
results: parsing output: 90/ for test: kms_big_fb
results: parsing output: 91/ for test: gem_mmap_wc
results: parsing output: 92/ for test: gem_exec_fence
results: parsing output: 93/ for test: kms_big_fb
results: parsing output: 94/ for test: gem_exec_flush
results: parsing output: 95/ for test: gem_mmap_gtt
results: parsing output: 96/ for test: gem_partial_pwrite_pread
results: parsing output: 97/ for test: syncobj_wait
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: gem_exec_fence
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: gem_workarounds
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_psr
results: parsing output: 104/ for test: sysfs_preempt_timeout
results: parsing output: 105/ for test: gem_exec_whisper
results: parsing output: 106/ for test: gem_gpgpu_fill
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_big_fb
results: parsing output: 112/ for test: gem_reg_read
results: parsing output: 113/ for test: perf_pmu
results: parsing output: 114/ for test: gem_ctx_persistence
results: parsing output: 115/ for test: kms_addfb_basic
results: parsing output: 116/ for test: gem_pwrite
results: parsing output: 117/ for test: kms_plane_scaling
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: sw_sync
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: kms_psr2_sf
results: parsing output: 122/ for test: kms_plane
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: gem_basic
results: parsing output: 125/ for test: kms_frontbuffer_tracking
results: parsing output: 126/ for test: gem_mmap_gtt
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: kms_flip_scaled_crc
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: syncobj_timeline
results: parsing output: 131/ for test: kms_atomic_transition
results: parsing output: 132/ for test: gem_ctx_persistence
results: parsing output: 133/ for test: prime_mmap_coherency
results: parsing output: 134/ for test: i915_pm_rpm
results: parsing output: 135/ for test: gem_exec_schedule
results: parsing output: 136/ for test: gem_softpin
results: parsing output: 137/ for test: kms_force_connector_basic
results: parsing output: 138/ for test: kms_invalid_mode
results: parsing output: 139/ for test: syncobj_timeline
results: parsing output: 140/ for test: gem_render_copy_redux
results: parsing output: 141/ for test: syncobj_wait
results: parsing output: 142/ for test: dumb_buffer
results: parsing output: 143/ for test: kms_pipe_stress
results: parsing output: 144/ for test: perf
results: parsing output: 145/ for test: kms_frontbuffer_tracking
results: parsing output: 146/ for test: kms_chamelium_edid
results: parsing output: 147/ for test: gem_mmap_gtt
results: parsing output: 148/ for test: kms_frontbuffer_tracking
results: parsing output: 149/ for test: kms_big_fb
results: parsing output: 150/ for test: prime_busy
results: parsing output: 151/ for test: kms_vblank
results: parsing output: 152/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 153/ for test: kms_flip
results: parsing output: 154/ for test: kms_frontbuffer_tracking
results: parsing output: 155/ for test: kms_frontbuffer_tracking
Done.