[60.657214] Initializing watchdogs
[60.657281]   /dev/watchdog0
[60.677437] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[60.688577] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[60.692335] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.694803] [001/130] (960s left) gem_exec_whisper (basic-forked-all)
[60.787214] Starting subtest: basic-forked-all
[63.632962] Subtest basic-forked-all: SUCCESS (2.832s)
[63.927308] [002/130] (957s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[64.111426] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[64.113072] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[64.308506] [003/130] (957s left) kms_lease (cursor-implicit-plane)
[64.493464] Starting subtest: cursor-implicit-plane
[64.494346] Starting dynamic subtest: pipe-A-DP-3
[64.866127] Dynamic subtest pipe-A-DP-3: SUCCESS (0.370s)
[64.880723] Starting dynamic subtest: pipe-B-DP-3
[65.192911] Dynamic subtest pipe-B-DP-3: SUCCESS (0.324s)
[65.203990] Starting dynamic subtest: pipe-C-DP-3
[65.491955] Dynamic subtest pipe-C-DP-3: SUCCESS (0.296s)
[65.502893] Starting dynamic subtest: pipe-D-DP-3
[65.792486] Dynamic subtest pipe-D-DP-3: SUCCESS (0.298s)
[65.793398] Subtest cursor-implicit-plane: SUCCESS (1.295s)
[66.129906] [004/130] (955s left) gem_exec_fence (syncobj-import)
[66.684429] Starting subtest: syncobj-import
[66.725266] Subtest syncobj-import: SUCCESS (0.042s)
[67.612859] [FACT gem_exec_fence (syncobj-import)] new: kernel.kmod_is_loaded.vgem: true
[67.615142] [005/130] (953s left) perf_pmu (pmu-read)
[67.724786] Starting subtest: pmu-read
[67.730151] Subtest pmu-read: SUCCESS (0.005s)
[67.986076] [006/130] (953s left) perf (enable-disable)
[68.398552] Starting subtest: enable-disable
[68.399395] Starting dynamic subtest: 0-rcs0
[70.666245] Dynamic subtest 0-rcs0: SUCCESS (2.264s)
[70.667171] Subtest enable-disable: SUCCESS (2.264s)
[70.728590] [007/130] (950s left) gem_ctx_persistence (userptr)
[70.832072] Starting subtest: userptr
[71.074530] Subtest userptr: SUCCESS (0.243s)
[71.256932] [008/130] (950s left) gem_eio (suspend)
[71.522991] Starting subtest: suspend
[85.625360] Subtest suspend: SUCCESS (14.094s)
[85.922780] [009/130] (935s left) kms_scaling_modes (scaling-mode-full-aspect)
[86.115964] Starting subtest: scaling-mode-full-aspect
[86.121132] Subtest scaling-mode-full-aspect: SKIP (0.001s)
[86.235106] [010/130] (935s left) gen9_exec_parse (basic-rejected-ctx-param)
[86.329889] Subtest basic-rejected-ctx-param: SKIP (0.000s)
[86.449409] [011/130] (935s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[86.638254] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-cpu
[86.639972] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[86.814399] [012/130] (935s left) sw_sync (sync_merge_invalid)
[86.862053] Starting subtest: sync_merge_invalid
[86.908085] Subtest sync_merge_invalid: SUCCESS (0.046s)
[86.979259] [013/130] (935s left) kms_psr (psr2-sprite-plane-move)
[87.173283] Subtest psr2-sprite-plane-move: SKIP (0.000s)
[87.232064] [014/130] (934s left) gem_madvise (dontneed-after-mmap)
[87.279888] Starting subtest: dontneed-after-mmap
[87.326986] Subtest dontneed-after-mmap: SUCCESS (0.048s)
[87.519149] [015/130] (934s left) syncobj_timeline (signal)
[87.598225] Starting subtest: signal
[87.599320] Subtest signal: SUCCESS (0.000s)
[87.752240] [016/130] (934s left) gem_lmem_swapping (verify)
[90.503896] Starting subtest: verify
[90.505452] Starting dynamic subtest: lmem0
[126.638336] Dynamic subtest lmem0: SUCCESS (36.123s)
[126.639264] Subtest verify: SUCCESS (36.123s)
[128.808199] [FACT gem_lmem_swapping (verify)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[128.809144] [FACT gem_lmem_swapping (verify)] deleted: kernel.kmod_is_loaded.i915: true
[128.810551] [017/130] (893s left) sw_sync (sync_expired_merge)
[128.848158] Starting subtest: sync_expired_merge
[129.921961] Subtest sync_expired_merge: SUCCESS (1.074s)
[129.950904] [018/130] (892s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[131.699278] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-cpu
[131.701032] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[131.909906] [FACT kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[131.912767] [FACT kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu)] new: kernel.kmod_is_loaded.i915: true
[131.915621] [019/130] (890s left) syncobj_timeline (etime-multi-wait-for-submit-available-unsubmitted)
[131.995347] Starting subtest: etime-multi-wait-for-submit-available-unsubmitted
[132.102817] Subtest etime-multi-wait-for-submit-available-unsubmitted: SUCCESS (0.105s)
[132.249256] [020/130] (890s left) gem_ringfill (engines-basic)
[132.644673] Starting subtest: engines-basic
[132.645687] Starting dynamic subtest: rcs0
[132.736377] Dynamic subtest rcs0: SUCCESS (0.092s)
[132.746671] Starting dynamic subtest: bcs0
[132.776728] Dynamic subtest bcs0: SUCCESS (0.040s)
[132.793475] Starting dynamic subtest: vcs0
[132.820021] Dynamic subtest vcs0: SUCCESS (0.043s)
[132.848203] Starting dynamic subtest: vcs1
[132.868061] Dynamic subtest vcs1: SUCCESS (0.047s)
[132.891025] Starting dynamic subtest: vecs0
[132.911353] Dynamic subtest vecs0: SUCCESS (0.043s)
[132.926612] Starting dynamic subtest: vecs1
[132.952617] Dynamic subtest vecs1: SUCCESS (0.041s)
[132.969747] Starting dynamic subtest: ccs0
[132.994540] Dynamic subtest ccs0: SUCCESS (0.041s)
[132.995668] Subtest engines-basic: SUCCESS (0.350s)
[133.189468] [021/130] (889s left) sw_sync (sync_multi_consumer_producer)
[133.235205] Starting subtest: sync_multi_consumer_producer
[133.469846] Subtest sync_multi_consumer_producer: SUCCESS (0.235s)
[133.591598] [022/130] (888s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[133.776513] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[133.777397] Starting dynamic subtest: pipe-A-valid-mode
[134.123962] Dynamic subtest pipe-A-valid-mode: SKIP (0.345s)
[134.126077] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.347s)
[134.435231] [023/130] (888s left) gem_ctx_param (invalid-set-ringsize)
[134.519355] Starting subtest: invalid-set-ringsize
[134.520258] Subtest invalid-set-ringsize: SUCCESS (0.000s)
[134.690469] [024/130] (888s left) kms_flip (2x-nonexisting-fb-interruptible)
[134.878545] Starting subtest: 2x-nonexisting-fb-interruptible
[134.894184] Subtest 2x-nonexisting-fb-interruptible: SKIP (0.015s)
[135.069233] [025/130] (887s left) kms_chamelium_frames (hdmi-crc-single)
[135.378651] Subtest hdmi-crc-single: SKIP (0.000s)
[135.529079] [026/130] (887s left) gem_exec_parallel (engines)
[135.624781] Starting subtest: engines
[135.625649] Starting dynamic subtest: basic
[137.172887] Dynamic subtest basic: SUCCESS (1.548s)
[137.182780] Starting dynamic subtest: contexts
[140.917322] Dynamic subtest contexts: SUCCESS (3.743s)
[140.927391] Starting dynamic subtest: fds
[145.794917] Dynamic subtest fds: SUCCESS (4.877s)
[145.805942] Starting dynamic subtest: userptr
[147.250343] Dynamic subtest userptr: SUCCESS (1.455s)
[147.251518] Subtest engines: SUCCESS (11.625s)
[147.569951] [027/130] (875s left) gem_eio (context-create)
[147.861427] Starting subtest: context-create
[148.441054] Subtest context-create: SUCCESS (0.580s)
[148.719132] [028/130] (874s left) gem_readwrite (beyond-eob)
[148.796056] Subtest beyond-EOB: SKIP (0.000s)
[148.877523] [029/130] (874s left) dmabuf_sync_file (export-basic)
[148.931381] Starting subtest: export-basic
[148.932303] Subtest export-basic: SUCCESS (0.001s)
[149.085745] [030/130] (874s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite)
[149.273606] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite
[149.275290] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[149.477959] [031/130] (873s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[149.665332] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[149.667081] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[149.869024] [032/130] (873s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-cpu)
[150.060540] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-cpu
[152.932383] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (2.872s)
[153.129477] [033/130] (870s left) kms_frontbuffer_tracking (fbc-1p-rte)
[153.330527] Starting subtest: fbc-1p-rte
[157.431733] Subtest fbc-1p-rte: SUCCESS (4.103s)
[157.723780] [034/130] (865s left) vgem_basic (unload)
[157.769129] Starting subtest: unload
[186.796032] Subtest unload: SUCCESS (29.023s)
[187.019140] [035/130] (836s left) gem_mmap (pf-nonblock)
[187.095205] Subtest pf-nonblock: SKIP (0.000s)
[187.159921] [036/130] (836s left) syncobj_eventfd (invalid-bad-flags)
[187.240985] Starting subtest: invalid-bad-flags
[187.242085] Subtest invalid-bad-flags: SUCCESS (0.000s)
[187.443246] [037/130] (836s left) kms_chamelium_hpd (dp-hpd-fast)
[187.712823] Subtest dp-hpd-fast: SKIP (0.000s)
[187.869672] [038/130] (835s left) gem_mmap_gtt (zero-extend)
[187.947016] Subtest zero-extend: SKIP (0.000s)
[188.026177] [039/130] (835s left) kms_cursor_crc (cursor-rapid-movement-128x42)
[188.420872] Starting subtest: cursor-rapid-movement-128x42
[188.424951] Starting dynamic subtest: pipe-A-DP-3
[188.911560] Dynamic subtest pipe-A-DP-3: SUCCESS (0.485s)
[188.962434] Starting dynamic subtest: pipe-D-DP-3
[189.387547] Dynamic subtest pipe-D-DP-3: SUCCESS (0.434s)
[189.388845] Subtest cursor-rapid-movement-128x42: SUCCESS (0.966s)
[189.833593] [040/130] (834s left) kms_draw_crc (draw-method-mmap-gtt)
[190.026969] Starting subtest: draw-method-mmap-gtt
[190.028780] Subtest draw-method-mmap-gtt: SKIP (0.000s)
[190.228496] [041/130] (833s left) perf_pmu (busy)
[190.295574] Starting subtest: busy
[190.296489] Starting dynamic subtest: rcs0
[190.920418] Dynamic subtest rcs0: SUCCESS (0.624s)
[190.934672] Starting dynamic subtest: bcs0
[191.483606] Dynamic subtest bcs0: SUCCESS (0.562s)
[191.498470] Starting dynamic subtest: vcs0
[192.043614] Dynamic subtest vcs0: SUCCESS (0.558s)
[192.058517] Starting dynamic subtest: vcs1
[192.608391] Dynamic subtest vcs1: SUCCESS (0.563s)
[192.622201] Starting dynamic subtest: vecs0
[193.169399] Dynamic subtest vecs0: SUCCESS (0.559s)
[193.183674] Starting dynamic subtest: vecs1
[193.733446] Dynamic subtest vecs1: SUCCESS (0.562s)
[193.747512] Starting dynamic subtest: ccs0
[194.296392] Dynamic subtest ccs0: SUCCESS (0.561s)
[194.298139] Subtest busy: SUCCESS (4.001s)
[194.479143] [042/130] (829s left) gem_spin_batch (legacy-resubmit-new)
[194.564703] Starting subtest: legacy-resubmit-new
[194.565608] Starting dynamic subtest: default
[194.598551] Dynamic subtest default: SUCCESS (0.033s)
[194.610569] Starting dynamic subtest: render
[194.611448] Dynamic subtest render: SUCCESS (0.004s)
[194.623464] Starting dynamic subtest: bsd
[194.624334] Dynamic subtest bsd: SUCCESS (0.004s)
[194.636398] Starting dynamic subtest: bsd1
[194.637517] Dynamic subtest bsd1: SUCCESS (0.005s)
[194.649082] Starting dynamic subtest: bsd2
[194.650189] Dynamic subtest bsd2: SUCCESS (0.005s)
[194.661516] Starting dynamic subtest: blt
[194.662571] Dynamic subtest blt: SUCCESS (0.007s)
[194.673538] Starting dynamic subtest: vebox
[194.674683] Dynamic subtest vebox: SUCCESS (0.004s)
[194.675768] Subtest legacy-resubmit-new: SUCCESS (0.066s)
[194.964510] [043/130] (829s left) core_auth (basic-auth)
[195.040959] Starting subtest: basic-auth
[195.057226] Subtest basic-auth: SUCCESS (0.016s)
[195.248567] [044/130] (828s left) kms_big_fb (yf-tiled-32bpp-rotate-0)
[195.442230] Starting subtest: yf-tiled-32bpp-rotate-0
[195.443983] Subtest yf-tiled-32bpp-rotate-0: SKIP (0.000s)
[195.649168] [045/130] (828s left) kms_flip (flip-vs-absolute-wf_vblank)
[195.834957] Starting subtest: flip-vs-absolute-wf_vblank
[195.838960] Starting dynamic subtest: A-DP3
[203.954376] Dynamic subtest A-DP3: SUCCESS (8.115s)
[203.968184] Starting dynamic subtest: B-DP3
[212.008604] Dynamic subtest B-DP3: SUCCESS (8.053s)
[212.021168] Starting dynamic subtest: C-DP3
[220.050693] Dynamic subtest C-DP3: SUCCESS (8.040s)
[220.063228] Starting dynamic subtest: D-DP3
[228.105544] Dynamic subtest D-DP3: SUCCESS (8.053s)
[228.107446] Subtest flip-vs-absolute-wf_vblank: SUCCESS (32.269s)
[228.453755] [046/130] (795s left) kms_flip_tiling (flip-change-tiling)
[228.642128] Starting subtest: flip-change-tiling
[228.642988] Starting dynamic subtest: pipe-A-DP-3-4-to-4
[228.904621] Dynamic subtest pipe-A-DP-3-4-to-4: SUCCESS (0.261s)
[228.920586] Starting dynamic subtest: pipe-A-DP-3-4-to-x
[229.088166] Dynamic subtest pipe-A-DP-3-4-to-x: SUCCESS (0.181s)
[229.131795] Starting dynamic subtest: pipe-A-DP-3-4-to-linear
[229.304682] Dynamic subtest pipe-A-DP-3-4-to-linear: SUCCESS (0.214s)
[229.349524] Starting dynamic subtest: pipe-A-DP-3-x-to-4
[229.521330] Dynamic subtest pipe-A-DP-3-x-to-4: SUCCESS (0.214s)
[229.539959] Starting dynamic subtest: pipe-A-DP-3-x-to-x
[229.688118] Dynamic subtest pipe-A-DP-3-x-to-x: SUCCESS (0.164s)
[229.732071] Starting dynamic subtest: pipe-A-DP-3-x-to-linear
[229.904528] Dynamic subtest pipe-A-DP-3-x-to-linear: SUCCESS (0.214s)
[229.920535] Starting dynamic subtest: pipe-A-DP-3-linear-to-4
[230.088386] Dynamic subtest pipe-A-DP-3-linear-to-4: SUCCESS (0.182s)
[230.103964] Starting dynamic subtest: pipe-A-DP-3-linear-to-x
[230.271637] Dynamic subtest pipe-A-DP-3-linear-to-x: SUCCESS (0.181s)
[230.315068] Starting dynamic subtest: pipe-A-DP-3-linear-to-linear
[230.454550] Dynamic subtest pipe-A-DP-3-linear-to-linear: SUCCESS (0.181s)
[230.547674] Starting dynamic subtest: pipe-B-DP-3-4-to-4
[230.868373] Dynamic subtest pipe-B-DP-3-4-to-4: SUCCESS (0.359s)
[230.911368] Starting dynamic subtest: pipe-B-DP-3-4-to-x
[231.034109] Dynamic subtest pipe-B-DP-3-4-to-x: SUCCESS (0.164s)
[231.055677] Starting dynamic subtest: pipe-B-DP-3-4-to-linear
[231.184157] Dynamic subtest pipe-B-DP-3-4-to-linear: SUCCESS (0.149s)
[231.198851] Starting dynamic subtest: pipe-B-DP-3-x-to-4
[231.317362] Dynamic subtest pipe-B-DP-3-x-to-4: SUCCESS (0.132s)
[231.331512] Starting dynamic subtest: pipe-B-DP-3-x-to-x
[231.450885] Dynamic subtest pipe-B-DP-3-x-to-x: SUCCESS (0.132s)
[231.475027] Starting dynamic subtest: pipe-B-DP-3-x-to-linear
[231.600780] Dynamic subtest pipe-B-DP-3-x-to-linear: SUCCESS (0.149s)
[231.624898] Starting dynamic subtest: pipe-B-DP-3-linear-to-4
[231.750886] Dynamic subtest pipe-B-DP-3-linear-to-4: SUCCESS (0.149s)
[231.776186] Starting dynamic subtest: pipe-B-DP-3-linear-to-x
[231.900879] Dynamic subtest pipe-B-DP-3-linear-to-x: SUCCESS (0.149s)
[231.924859] Starting dynamic subtest: pipe-B-DP-3-linear-to-linear
[232.050928] Dynamic subtest pipe-B-DP-3-linear-to-linear: SUCCESS (0.149s)
[232.097761] Starting dynamic subtest: pipe-C-DP-3-4-to-4
[232.416182] Dynamic subtest pipe-C-DP-3-4-to-4: SUCCESS (0.330s)
[232.432368] Starting dynamic subtest: pipe-C-DP-3-4-to-x
[232.565936] Dynamic subtest pipe-C-DP-3-4-to-x: SUCCESS (0.148s)
[232.607322] Starting dynamic subtest: pipe-C-DP-3-4-to-linear
[232.732217] Dynamic subtest pipe-C-DP-3-4-to-linear: SUCCESS (0.165s)
[232.747118] Starting dynamic subtest: pipe-C-DP-3-x-to-4
[232.865411] Dynamic subtest pipe-C-DP-3-x-to-4: SUCCESS (0.132s)
[232.888681] Starting dynamic subtest: pipe-C-DP-3-x-to-x
[233.015508] Dynamic subtest pipe-C-DP-3-x-to-x: SUCCESS (0.149s)
[233.030170] Starting dynamic subtest: pipe-C-DP-3-x-to-linear
[233.148865] Dynamic subtest pipe-C-DP-3-x-to-linear: SUCCESS (0.132s)
[233.162721] Starting dynamic subtest: pipe-C-DP-3-linear-to-4
[233.282126] Dynamic subtest pipe-C-DP-3-linear-to-4: SUCCESS (0.132s)
[233.305883] Starting dynamic subtest: pipe-C-DP-3-linear-to-x
[233.432192] Dynamic subtest pipe-C-DP-3-linear-to-x: SUCCESS (0.149s)
[233.445772] Starting dynamic subtest: pipe-C-DP-3-linear-to-linear
[233.565580] Dynamic subtest pipe-C-DP-3-linear-to-linear: SUCCESS (0.132s)
[233.640068] Starting dynamic subtest: pipe-D-DP-3-4-to-4
[233.970049] Dynamic subtest pipe-D-DP-3-4-to-4: SUCCESS (0.358s)
[234.019022] Starting dynamic subtest: pipe-D-DP-3-4-to-x
[234.131926] Dynamic subtest pipe-D-DP-3-4-to-x: SUCCESS (0.164s)
[234.158125] Starting dynamic subtest: pipe-D-DP-3-4-to-linear
[234.278251] Dynamic subtest pipe-D-DP-3-4-to-linear: SUCCESS (0.149s)
[234.306355] Starting dynamic subtest: pipe-D-DP-3-x-to-4
[234.428045] Dynamic subtest pipe-D-DP-3-x-to-4: SUCCESS (0.149s)
[234.448332] Starting dynamic subtest: pipe-D-DP-3-x-to-x
[234.578312] Dynamic subtest pipe-D-DP-3-x-to-x: SUCCESS (0.149s)
[234.611207] Starting dynamic subtest: pipe-D-DP-3-x-to-linear
[234.744896] Dynamic subtest pipe-D-DP-3-x-to-linear: SUCCESS (0.165s)
[234.777659] Starting dynamic subtest: pipe-D-DP-3-linear-to-4
[234.911641] Dynamic subtest pipe-D-DP-3-linear-to-4: SUCCESS (0.166s)
[234.944444] Starting dynamic subtest: pipe-D-DP-3-linear-to-x
[235.078402] Dynamic subtest pipe-D-DP-3-linear-to-x: SUCCESS (0.165s)
[235.093209] Starting dynamic subtest: pipe-D-DP-3-linear-to-linear
[235.211570] Dynamic subtest pipe-D-DP-3-linear-to-linear: SUCCESS (0.132s)
[235.244617] Subtest flip-change-tiling: SUCCESS (6.603s)
[235.676665] [047/130] (788s left) kms_content_protection (legacy)
[235.927572] Starting subtest: legacy
[236.201083] Starting dynamic subtest: pipe-A-DP-3
[357.466144] Dynamic subtest pipe-A-DP-3: FAIL (121.005s)
[357.467320] Subtest legacy: FAIL (121.384s)
[357.638250] [048/130] (666s left) kms_psr (fbc-psr-basic)
[357.832601] Subtest fbc-psr-basic: SKIP (0.000s)
[357.898266] [049/130] (666s left) gem_userptr_blits (invalid-mmap-offset-unsync)
[357.984787] Subtest invalid-mmap-offset-unsync: SKIP (0.000s)
[358.207770] [050/130] (666s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-wc)
[358.406205] Starting subtest: psr-rgb565-draw-mmap-wc
[358.407949] Subtest psr-rgb565-draw-mmap-wc: SKIP (0.000s)
[358.605204] [051/130] (666s left) perf (invalid-oa-format-id)
[359.024952] Starting subtest: invalid-oa-format-id
[359.042927] Subtest invalid-oa-format-id: SUCCESS (0.019s)
[359.128862] [052/130] (665s left) gem_exec_schedule (pi-shared-iova)
[359.346955] Starting subtest: pi-shared-iova
[359.347915] Starting dynamic subtest: rcs0
[359.615816] Dynamic subtest rcs0: SUCCESS (0.267s)
[359.627844] Starting dynamic subtest: bcs0
[359.789850] Dynamic subtest bcs0: SUCCESS (0.177s)
[359.802157] Starting dynamic subtest: vcs0
[359.977699] Dynamic subtest vcs0: SUCCESS (0.183s)
[359.990208] Starting dynamic subtest: vcs1
[360.153978] Dynamic subtest vcs1: SUCCESS (0.183s)
[360.166426] Starting dynamic subtest: vecs0
[360.338474] Dynamic subtest vecs0: SUCCESS (0.185s)
[360.351136] Starting dynamic subtest: vecs1
[360.525124] Dynamic subtest vecs1: SUCCESS (0.186s)
[360.537420] Starting dynamic subtest: ccs0
[360.713445] Dynamic subtest ccs0: SUCCESS (0.188s)
[360.714268] Subtest pi-shared-iova: SUCCESS (1.374s)
[361.189936] [053/130] (663s left) kms_cursor_legacy (cursora-vs-flipa-varying-size)
[361.385123] Starting subtest: cursorA-vs-flipA-varying-size
[372.334606] Subtest cursorA-vs-flipA-varying-size: SUCCESS (10.948s)
[372.650994] [054/130] (652s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-gtt)
[372.845933] Starting subtest: fbcpsr-rgb101010-draw-mmap-gtt
[372.847584] Subtest fbcpsr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[373.046351] [055/130] (652s left) kms_big_fb (x-tiled-addfb-size-overflow)
[373.244446] Starting subtest: x-tiled-addfb-size-overflow
[373.246476] Subtest x-tiled-addfb-size-overflow: SUCCESS (0.001s)
[373.451069] [056/130] (651s left) gem_exec_fence (concurrent)
[373.658415] Starting subtest: concurrent
[373.660588] Subtest concurrent: SKIP (0.000s)
[374.433512] [057/130] (650s left) kms_big_fb (linear-16bpp-rotate-270)
[374.628587] Starting subtest: linear-16bpp-rotate-270
[374.697675] Subtest linear-16bpp-rotate-270: SKIP (0.068s)
[374.931216] [058/130] (650s left) prime_mmap_kms (buffer-sharing)
[375.115319] Starting subtest: buffer-sharing
[375.460169] Subtest buffer-sharing: SUCCESS (0.344s)
[375.801230] [059/130] (649s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt)
[375.990742] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt
[375.992327] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[376.210901] [060/130] (649s left) gem_close_race (multigpu-basic-process)
[376.321680] Starting subtest: multigpu-basic-process
[376.323676] Subtest multigpu-basic-process: SKIP (0.000s)
[376.658816] [061/130] (649s left) kms_pm_rpm (modeset-lpsp-stress-no-wait)
[379.069954] Starting subtest: modeset-lpsp-stress-no-wait
[379.189349] Subtest modeset-lpsp-stress-no-wait: SKIP (0.119s)
[379.508057] [062/130] (646s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area)
[379.702163] Subtest psr2-primary-plane-update-sf-dmg-area: SKIP (0.000s)
[379.751382] [063/130] (646s left) gem_ccs (block-copy-compressed)
[379.843305] Starting subtest: block-copy-compressed
[379.845421] Starting dynamic subtest: linear-compressed-compfmt0-smem-lmem0
[379.893507] Dynamic subtest linear-compressed-compfmt0-smem-lmem0: SUCCESS (0.049s)
[379.906237] Starting dynamic subtest: linear-compressed-compfmt0-lmem0-lmem0
[380.007874] Dynamic subtest linear-compressed-compfmt0-lmem0-lmem0: SUCCESS (0.113s)
[380.022115] Starting dynamic subtest: xmajor-compressed-compfmt0-smem-lmem0
[380.026297] Dynamic subtest xmajor-compressed-compfmt0-smem-lmem0: SUCCESS (0.017s)
[380.039205] Starting dynamic subtest: xmajor-compressed-compfmt0-lmem0-lmem0
[380.140908] Dynamic subtest xmajor-compressed-compfmt0-lmem0-lmem0: SUCCESS (0.114s)
[380.154912] Starting dynamic subtest: tile4-compressed-compfmt0-smem-lmem0
[380.160227] Dynamic subtest tile4-compressed-compfmt0-smem-lmem0: SUCCESS (0.018s)
[380.174185] Starting dynamic subtest: tile4-compressed-compfmt0-lmem0-lmem0
[380.275245] Dynamic subtest tile4-compressed-compfmt0-lmem0-lmem0: SUCCESS (0.114s)
[380.289222] Starting dynamic subtest: tile64-compressed-compfmt0-smem-lmem0
[380.293243] Dynamic subtest tile64-compressed-compfmt0-smem-lmem0: SUCCESS (0.017s)
[380.305806] Starting dynamic subtest: tile64-compressed-compfmt0-lmem0-lmem0
[380.407328] Dynamic subtest tile64-compressed-compfmt0-lmem0-lmem0: SUCCESS (0.113s)
[380.408240] Subtest block-copy-compressed: SUCCESS (0.565s)
[380.591698] [064/130] (645s left) kms_addfb_basic (basic-y-tiled-legacy)
[380.669534] Starting subtest: basic-y-tiled-legacy
[380.671256] Subtest basic-y-tiled-legacy: SKIP (0.000s)
[380.975981] [065/130] (644s left) gem_exec_schedule (u-fairslice)
[381.066379] Starting subtest: u-fairslice
[381.067305] Starting dynamic subtest: rcs0
[383.147763] Dynamic subtest rcs0: SUCCESS (2.080s)
[383.168525] Starting dynamic subtest: bcs0
[385.174542] Dynamic subtest bcs0: SUCCESS (2.025s)
[385.187274] Starting dynamic subtest: vcs0
[387.196398] Dynamic subtest vcs0: SUCCESS (2.021s)
[387.209386] Starting dynamic subtest: vcs1
[389.216388] Dynamic subtest vcs1: SUCCESS (2.019s)
[389.229553] Starting dynamic subtest: vecs0
[391.238122] Dynamic subtest vecs0: SUCCESS (2.021s)
[391.251159] Starting dynamic subtest: vecs1
[393.259156] Dynamic subtest vecs1: SUCCESS (2.020s)
[393.272191] Starting dynamic subtest: ccs0
[395.281162] Dynamic subtest ccs0: SUCCESS (2.021s)
[395.282310] Subtest u-fairslice: SUCCESS (14.215s)
[395.688262] [066/130] (630s left) core_getclient (basic)
[395.762263] Starting subtest: basic
[395.763175] Subtest basic: SUCCESS (0.000s)
[395.957324] [067/130] (630s left) gem_exec_whisper (basic-queues-forked-all)
[396.045739] Starting subtest: basic-queues-forked-all
[418.151238] Subtest basic-queues-forked-all: SUCCESS (22.105s)
[418.395824] [068/130] (607s left) gem_mmap_wc (write-cpu-read-wc)
[418.474240] Subtest write-cpu-read-wc: SKIP (0.000s)
[418.557384] [069/130] (607s left) kms_pm_dc (dc6-psr)
[419.746367] Starting subtest: dc6-psr
[419.748161] Subtest dc6-psr: SKIP (0.000s)
[419.933543] [070/130] (606s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[420.127195] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip
[421.406439] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip: SUCCESS (1.278s)
[421.689284] [071/130] (604s left) gen3_render_linear_blits
[421.840423] [072/130] (604s left) syncobj_wait (wait-all-delayed-signal)
[421.917483] Starting subtest: wait-all-delayed-signal
[422.020594] Subtest wait-all-delayed-signal: SUCCESS (0.102s)
[422.163651] [073/130] (604s left) kms_cursor_crc (cursor-tearing-framebuffer-change)
[422.408966] Starting subtest: cursor-tearing-framebuffer-change
[422.411074] Starting dynamic subtest: pipe-A-DP-3
[422.937252] Dynamic subtest pipe-A-DP-3: SUCCESS (0.525s)
[422.964682] Starting dynamic subtest: pipe-D-DP-3
[423.376992] Dynamic subtest pipe-D-DP-3: SUCCESS (0.436s)
[423.377900] Subtest cursor-tearing-framebuffer-change: SUCCESS (0.967s)
[424.016963] [074/130] (602s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0)
[424.212458] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0
[424.214238] Subtest y-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[424.412657] [075/130] (602s left) kms_flip (2x-flip-vs-panning)
[424.597516] Starting subtest: 2x-flip-vs-panning
[424.612990] Subtest 2x-flip-vs-panning: SKIP (0.015s)
[424.779365] [076/130] (602s left) kms_addfb_basic (bad-pitch-256)
[424.859503] Starting subtest: bad-pitch-256
[424.860429] Subtest bad-pitch-256: SUCCESS (0.000s)
[425.158716] [077/130] (601s left) syncobj_timeline (multi-wait-all-available-signaled)
[425.242375] Starting subtest: multi-wait-all-available-signaled
[425.243321] Subtest multi-wait-all-available-signaled: SUCCESS (0.001s)
[425.427127] [078/130] (601s left) kms_plane_scaling (plane-scaler-unity-scaling-with-pixel-format)
[425.610427] Starting subtest: plane-scaler-unity-scaling-with-pixel-format
[425.611167] Starting dynamic subtest: pipe-A
[427.760950] Dynamic subtest pipe-A: SUCCESS (2.151s)
[427.783986] Starting dynamic subtest: pipe-B
[430.074070] Dynamic subtest pipe-B: SUCCESS (2.311s)
[430.104087] Starting dynamic subtest: pipe-C
[430.388199] Dynamic subtest pipe-C: SUCCESS (0.312s)
[430.420527] Starting dynamic subtest: pipe-D
[430.700937] Dynamic subtest pipe-D: SUCCESS (0.311s)
[430.702038] Subtest plane-scaler-unity-scaling-with-pixel-format: SUCCESS (5.092s)
[431.081936] [079/130] (595s left) gem_ctx_param (set-priority-range)
[431.158790] Starting subtest: set-priority-range
[431.177465] Subtest set-priority-range: SUCCESS (0.019s)
[431.381573] [080/130] (595s left) i915_drm_fdinfo (virtual-busy-idle)
[431.450800] Starting subtest: virtual-busy-idle
[431.452584] Subtest virtual-busy-idle: SKIP (0.000s)
[431.601532] [081/130] (595s left) kms_tiled_display (basic-test-pattern-with-chamelium)
[431.862355] Subtest basic-test-pattern-with-chamelium: SKIP (0.000s)
[431.926578] [082/130] (595s left) prime_vgem (basic-write)
[432.024721] Starting subtest: basic-write
[432.037028] Subtest basic-write: SKIP (0.012s)
[432.250502] [083/130] (595s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-blt)
[432.441169] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-blt
[435.681832] Subtest fbc-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (3.241s)
[435.940521] [084/130] (591s left) i915_pm_rpm (sysfs-read)
[438.063637] Starting subtest: sysfs-read
[438.374623] Subtest sysfs-read: SUCCESS (0.310s)
[438.780714] [085/130] (588s left) gem_render_copy (y-tiled-ccs-to-y-tiled)
[438.875800] Starting subtest: y-tiled-ccs-to-y-tiled
[438.877895] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s)
[439.162420] [086/130] (588s left) kms_ccs (bad-pixel-format-yf-tiled-ccs)
[439.350275] Starting subtest: bad-pixel-format-yf-tiled-ccs
[439.351186] Starting dynamic subtest: pipe-A-DP-3
[439.359422] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[439.372103] Starting dynamic subtest: pipe-B-DP-3
[439.380415] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[439.392862] Starting dynamic subtest: pipe-C-DP-3
[439.401038] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[439.413644] Starting dynamic subtest: pipe-D-DP-3
[439.424537] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[439.426364] Subtest bad-pixel-format-yf-tiled-ccs: SKIP (0.007s)
[439.837483] [087/130] (587s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[440.025739] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (0.000s)
[440.082260] [088/130] (587s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[440.271939] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[440.276680] Starting dynamic subtest: A-DP3
[441.189461] Dynamic subtest A-DP3: SUCCESS (0.911s)
[441.205371] Starting dynamic subtest: B-DP3
[441.931147] Dynamic subtest B-DP3: SUCCESS (0.740s)
[441.958226] Starting dynamic subtest: C-DP3
[442.677987] Dynamic subtest C-DP3: SUCCESS (0.745s)
[442.690803] Starting dynamic subtest: D-DP3
[443.392591] Dynamic subtest D-DP3: SUCCESS (0.714s)
[443.394875] Subtest single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (3.122s)
[443.711994] [089/130] (584s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-fullscreen)
[443.906131] Starting subtest: psr-2p-scndscrn-spr-indfb-fullscreen
[443.907903] Subtest psr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[444.109895] [090/130] (583s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0)
[444.301565] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0
[444.303275] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[444.493505] [091/130] (583s left) kms_plane_scaling (plane-upscale-20x20-with-pixel-format)
[444.679412] Starting subtest: plane-upscale-20x20-with-pixel-format
[444.680130] Starting dynamic subtest: pipe-A
[446.291610] Dynamic subtest pipe-A: SUCCESS (1.612s)
[446.329421] Starting dynamic subtest: pipe-B
[448.021326] Dynamic subtest pipe-B: SUCCESS (1.727s)
[448.052261] Starting dynamic subtest: pipe-C
[448.333828] Dynamic subtest pipe-C: SUCCESS (0.310s)
[448.352779] Starting dynamic subtest: pipe-D
[448.630254] Dynamic subtest pipe-D: SUCCESS (0.295s)
[448.634073] Subtest plane-upscale-20x20-with-pixel-format: SUCCESS (3.953s)
[448.977764] [092/130] (579s left) syncobj_wait (reset-unsignaled)
[449.062430] Starting subtest: reset-unsignaled
[449.063476] Subtest reset-unsignaled: SUCCESS (0.000s)
[449.259206] [093/130] (578s left) syncobj_timeline (etime-single-wait-all-for-submit-submitted)
[449.339514] Starting subtest: etime-single-wait-all-for-submit-submitted
[449.446600] Subtest etime-single-wait-all-for-submit-submitted: SUCCESS (0.105s)
[449.591610] [094/130] (578s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-blt)
[449.783581] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-blt
[449.785277] Subtest psr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[449.977600] [095/130] (578s left) gem_exec_flush (basic-wb-rw-default)
[450.062227] Subtest basic-wb-rw-default: SKIP (0.000s)
[450.138056] [096/130] (578s left) syncobj_timeline (single-wait-for-submit-available-submitted)
[450.214444] Starting subtest: single-wait-for-submit-available-submitted
[450.215629] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.000s)
[450.412110] [097/130] (578s left) gem_mmap_wc (coherency)
[450.502164] Subtest coherency: SKIP (0.000s)
[450.570713] [098/130] (577s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs)
[450.756452] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-mc-ccs
[450.757390] Starting dynamic subtest: pipe-A-DP-3
[450.778047] Dynamic subtest pipe-A-DP-3: SKIP (0.002s)
[450.791064] Starting dynamic subtest: pipe-B-DP-3
[450.812809] Dynamic subtest pipe-B-DP-3: SKIP (0.002s)
[450.825741] Starting dynamic subtest: pipe-C-DP-3
[450.852478] Dynamic subtest pipe-C-DP-3: SKIP (0.002s)
[450.866818] Starting dynamic subtest: pipe-D-DP-3
[450.891198] Dynamic subtest pipe-D-DP-3: SKIP (0.002s)
[450.893523] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SKIP (0.015s)
[451.243823] [099/130] (577s left) i915_drm_fdinfo (all-busy-check-all)
[451.313975] Starting subtest: all-busy-check-all
[451.343271] Subtest all-busy-check-all: SKIP (0.028s)
[451.514422] [100/130] (577s left) gem_userptr_blits (unsync-overlap)
[451.626272] Subtest unsync-overlap: SKIP (0.000s)
[451.826339] [101/130] (576s left) gem_mmap_gtt (big-copy-xy)
[451.902240] Subtest big-copy-XY: SKIP (0.000s)
[451.987926] [102/130] (576s left) gem_pxp (verify-pxp-stale-buf-optout-execution)
[454.591284] Starting subtest: verify-pxp-stale-buf-optout-execution
[454.593290] Subtest verify-pxp-stale-buf-optout-execution: SKIP (0.000s)
[454.739337] [103/130] (574s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-msflip-blt)
[454.931169] Starting subtest: fbcpsr-2p-primscrn-indfb-msflip-blt
[454.932916] Subtest fbcpsr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[455.140504] [104/130] (573s left) gem_ctx_create (basic-files)
[455.227398] Starting subtest: basic-files
[457.346359] Subtest basic-files: SUCCESS (2.119s)
[457.774982] [105/130] (571s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-sf)
[457.968541] Subtest psr2-cursor-plane-move-continuous-sf: SKIP (0.000s)
[458.034432] [106/130] (571s left) kms_chamelium_color (gamma)
[458.222144] Subtest gamma: SKIP (0.000s)
[458.284828] [107/130] (570s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-msflip-blt)
[458.481091] Starting subtest: psr-1p-primscrn-indfb-msflip-blt
[458.482848] Subtest psr-1p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[458.690366] [108/130] (570s left) kms_atomic_transition (modeset-transition)
[458.882293] Starting subtest: modeset-transition
[458.883193] Starting dynamic subtest: 1x-outputs
[461.481090] Dynamic subtest 1x-outputs: SUCCESS (2.598s)
[461.494784] Subtest modeset-transition: SUCCESS (2.601s)
[461.740007] [109/130] (567s left) kms_flip (flip-vs-dpms-on-nop)
[461.925629] Starting subtest: flip-vs-dpms-on-nop
[461.930371] Starting dynamic subtest: A-DP3
[463.064685] Dynamic subtest A-DP3: SUCCESS (1.134s)
[463.081632] Starting dynamic subtest: B-DP3
[464.117976] Dynamic subtest B-DP3: SUCCESS (1.051s)
[464.155350] Starting dynamic subtest: C-DP3
[465.200235] Dynamic subtest C-DP3: SUCCESS (1.077s)
[465.215150] Starting dynamic subtest: D-DP3
[466.269540] Dynamic subtest D-DP3: SUCCESS (1.068s)
[466.274359] Subtest flip-vs-dpms-on-nop: SUCCESS (4.348s)
[466.666926] [110/130] (562s left) kms_properties (plane-properties-legacy)
[466.860912] Starting subtest: plane-properties-legacy
[466.863209] Starting dynamic subtest: pipe-A-DP-3
[467.361431] Dynamic subtest pipe-A-DP-3: SUCCESS (0.498s)
[467.378494] Starting dynamic subtest: pipe-B-DP-3
[467.888495] Dynamic subtest pipe-B-DP-3: SUCCESS (0.524s)
[467.905579] Starting dynamic subtest: pipe-C-DP-3
[468.411377] Dynamic subtest pipe-C-DP-3: SUCCESS (0.521s)
[468.426306] Starting dynamic subtest: pipe-D-DP-3
[468.936920] Dynamic subtest pipe-D-DP-3: SUCCESS (0.524s)
[468.937903] Subtest plane-properties-legacy: SUCCESS (2.076s)
[469.236324] [111/130] (560s left) core_setmaster_vs_auth
[469.514525] [112/130] (559s left) kms_hdr (static-toggle-suspend)
[469.709448] Starting subtest: static-toggle-suspend
[470.274669] Starting dynamic subtest: pipe-A-DP-3
[489.843429] Dynamic subtest pipe-A-DP-3: SUCCESS (5.200s)
[489.844345] Subtest static-toggle-suspend: SUCCESS (5.767s)
[490.178104] [113/130] (539s left) kms_psr (fbc-psr2-basic)
[490.365294] Subtest fbc-psr2-basic: SKIP (0.000s)
[490.427000] [114/130] (539s left) gem_eio (in-flight-10ms)
[490.731974] Starting subtest: in-flight-10ms
[495.860241] Subtest in-flight-10ms: SUCCESS (5.129s)
[496.146595] [115/130] (533s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-blt)
[496.338112] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-blt
[500.099089] Subtest fbc-1p-primscrn-spr-indfb-draw-blt: SUCCESS (3.761s)
[500.367014] [116/130] (529s left) kms_ccs (crc-primary-suspend-4-tiled-bmg-ccs)
[500.559327] Starting subtest: crc-primary-suspend-4-tiled-bmg-ccs
[500.561132] Subtest crc-primary-suspend-4-tiled-bmg-ccs: SKIP (0.000s)
[500.906998] [117/130] (528s left) kms_busy (extended-pageflip-modeset-hang-oldfb)
[501.095439] Starting subtest: extended-pageflip-modeset-hang-oldfb
[501.096372] Starting dynamic subtest: pipe-A
[508.931452] Dynamic subtest pipe-A: SUCCESS (7.834s)
[508.947534] Starting dynamic subtest: pipe-D
[516.777146] Dynamic subtest pipe-D: SUCCESS (7.842s)
[516.778103] Subtest extended-pageflip-modeset-hang-oldfb: SUCCESS (15.682s)
[517.097130] [118/130] (512s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt)
[517.286218] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt
[517.287969] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[517.497556] [119/130] (512s left) kms_ccs (crc-primary-basic-y-tiled-gen12-mc-ccs)
[517.681431] Starting subtest: crc-primary-basic-y-tiled-gen12-mc-ccs
[517.682332] Starting dynamic subtest: pipe-A-DP-3
[517.690974] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[517.704937] Starting dynamic subtest: pipe-B-DP-3
[517.713371] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[517.727184] Starting dynamic subtest: pipe-C-DP-3
[517.735394] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[517.749447] Starting dynamic subtest: pipe-D-DP-3
[517.759575] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[517.761547] Subtest crc-primary-basic-y-tiled-gen12-mc-ccs: SKIP (0.009s)
[518.171945] [120/130] (511s left) api_intel_allocator (reserve-simple)
[518.248347] Starting subtest: reserve-simple
[518.276161] Subtest reserve-simple: SUCCESS (0.028s)
[518.462076] [121/130] (511s left) kms_vblank (wait-forked-busy)
[518.647401] Starting subtest: wait-forked-busy
[518.648281] Starting dynamic subtest: pipe-A-DP-3
[521.148165] Dynamic subtest pipe-A-DP-3: SUCCESS (2.499s)
[521.179529] Starting dynamic subtest: pipe-D-DP-3
[523.611685] Dynamic subtest pipe-D-DP-3: SUCCESS (2.456s)
[523.612825] Subtest wait-forked-busy: SUCCESS (4.966s)
[523.915410] [122/130] (506s left) gem_fence_thrash (bo-write-verify-threaded-y)
[523.962154] Starting subtest: bo-write-verify-threaded-y
[523.998207] Subtest bo-write-verify-threaded-y: SKIP (0.035s)
[524.076906] [123/130] (506s left) kms_pipe_stress (stress-xrgb8888-4tiled)
[524.269605] Starting subtest: stress-xrgb8888-4tiled
[532.162394] Subtest stress-xrgb8888-4tiled: SUCCESS (7.894s)
[532.413941] [124/130] (498s left) gem_exec_balancer (noheartbeat)
[532.797773] Starting subtest: noheartbeat
[532.799566] Subtest noheartbeat: SKIP (0.000s)
[532.949416] [125/130] (497s left) i915_query (query-regions-unallocated)
[533.026789] Starting subtest: query-regions-unallocated
[534.139683] Subtest query-regions-unallocated: SUCCESS (1.114s)
[534.277915] [126/130] (496s left) kms_cursor_crc (cursor-onscreen-128x128)
[534.641723] Starting subtest: cursor-onscreen-128x128
[534.646860] Starting dynamic subtest: pipe-A-DP-3
[537.480592] Dynamic subtest pipe-A-DP-3: SUCCESS (2.833s)
[537.532913] Starting dynamic subtest: pipe-D-DP-3
[540.109546] Dynamic subtest pipe-D-DP-3: SUCCESS (2.589s)
[540.110482] Subtest cursor-onscreen-128x128: SUCCESS (5.467s)
[540.575662] [127/130] (490s left) kms_debugfs (display-off-read-all)
[540.761400] Starting subtest: display-off-read-all
[540.848360] Subtest display-off-read-all: SUCCESS (0.088s)
[541.110932] [128/130] (489s left) kms_psr (pr-sprite-mmap-cpu)
[541.298437] Subtest pr-sprite-mmap-cpu: SKIP (0.000s)
[541.356280] [129/130] (489s left) kms_plane_lowres (tiling-x)
[541.549561] Starting subtest: tiling-x
[541.551815] Starting dynamic subtest: pipe-A-DP-3
[552.936602] Dynamic subtest pipe-A-DP-3: SUCCESS (11.384s)
[553.057433] Starting dynamic subtest: pipe-B-DP-3
[563.531338] Dynamic subtest pipe-B-DP-3: SUCCESS (10.487s)
[563.669468] Starting dynamic subtest: pipe-C-DP-3
[574.045089] Dynamic subtest pipe-C-DP-3: SUCCESS (10.388s)
[574.141835] Starting dynamic subtest: pipe-D-DP-3
[584.553162] Dynamic subtest pipe-D-DP-3: SUCCESS (10.429s)
[584.658927] Subtest tiling-x: SUCCESS (43.106s)
[584.984733] [130/130] (445s left) gem_exec_schedule (smoketest-all)
[585.089486] Starting subtest: smoketest-all
[617.407306] Subtest smoketest-all: SUCCESS (32.310s)
[617.928924] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_whisper
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_lease
results: parsing output: 3/ for test: gem_exec_fence
results: parsing output: 4/ for test: perf_pmu
results: parsing output: 5/ for test: perf
results: parsing output: 6/ for test: gem_ctx_persistence
results: parsing output: 7/ for test: gem_eio
results: parsing output: 8/ for test: kms_scaling_modes
results: parsing output: 9/ for test: gen9_exec_parse
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: sw_sync
results: parsing output: 12/ for test: kms_psr
results: parsing output: 13/ for test: gem_madvise
results: parsing output: 14/ for test: syncobj_timeline
results: parsing output: 15/ for test: gem_lmem_swapping
results: parsing output: 16/ for test: sw_sync
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: syncobj_timeline
results: parsing output: 19/ for test: gem_ringfill
results: parsing output: 20/ for test: sw_sync
results: parsing output: 21/ for test: kms_flip_scaled_crc
results: parsing output: 22/ for test: gem_ctx_param
results: parsing output: 23/ for test: kms_flip
results: parsing output: 24/ for test: kms_chamelium_frames
results: parsing output: 25/ for test: gem_exec_parallel
results: parsing output: 26/ for test: gem_eio
results: parsing output: 27/ for test: gem_readwrite
results: parsing output: 28/ for test: dmabuf_sync_file
results: parsing output: 29/ for test: kms_frontbuffer_tracking
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: vgem_basic
results: parsing output: 34/ for test: gem_mmap
results: parsing output: 35/ for test: syncobj_eventfd
results: parsing output: 36/ for test: kms_chamelium_hpd
results: parsing output: 37/ for test: gem_mmap_gtt
results: parsing output: 38/ for test: kms_cursor_crc
results: parsing output: 39/ for test: kms_draw_crc
results: parsing output: 40/ for test: perf_pmu
results: parsing output: 41/ for test: gem_spin_batch
results: parsing output: 42/ for test: core_auth
results: parsing output: 43/ for test: kms_big_fb
results: parsing output: 44/ for test: kms_flip
results: parsing output: 45/ for test: kms_flip_tiling
results: parsing output: 46/ for test: kms_content_protection
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: gem_userptr_blits
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: perf
results: parsing output: 51/ for test: gem_exec_schedule
results: parsing output: 52/ for test: kms_cursor_legacy
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_big_fb
results: parsing output: 55/ for test: gem_exec_fence
results: parsing output: 56/ for test: kms_big_fb
results: parsing output: 57/ for test: prime_mmap_kms
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: gem_close_race
results: parsing output: 60/ for test: kms_pm_rpm
results: parsing output: 61/ for test: kms_psr2_sf
results: parsing output: 62/ for test: gem_ccs
results: parsing output: 63/ for test: kms_addfb_basic
results: parsing output: 64/ for test: gem_exec_schedule
results: parsing output: 65/ for test: core_getclient
results: parsing output: 66/ for test: gem_exec_whisper
results: parsing output: 67/ for test: gem_mmap_wc
results: parsing output: 68/ for test: kms_pm_dc
results: parsing output: 69/ for test: kms_big_fb
results: parsing output: 70/ for test: gen3_render_linear_blits
results: parsing output: 71/ for test: syncobj_wait
results: parsing output: 72/ for test: kms_cursor_crc
results: parsing output: 73/ for test: kms_big_fb
results: parsing output: 74/ for test: kms_flip
results: parsing output: 75/ for test: kms_addfb_basic
results: parsing output: 76/ for test: syncobj_timeline
results: parsing output: 77/ for test: kms_plane_scaling
results: parsing output: 78/ for test: gem_ctx_param
results: parsing output: 79/ for test: i915_drm_fdinfo
results: parsing output: 80/ for test: kms_tiled_display
results: parsing output: 81/ for test: prime_vgem
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: i915_pm_rpm
results: parsing output: 84/ for test: gem_render_copy
results: parsing output: 85/ for test: kms_ccs
results: parsing output: 86/ for test: kms_psr2_sf
results: parsing output: 87/ for test: kms_flip
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: kms_big_fb
results: parsing output: 90/ for test: kms_plane_scaling
results: parsing output: 91/ for test: syncobj_wait
results: parsing output: 92/ for test: syncobj_timeline
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: gem_exec_flush
results: parsing output: 95/ for test: syncobj_timeline
results: parsing output: 96/ for test: gem_mmap_wc
results: parsing output: 97/ for test: kms_ccs
results: parsing output: 98/ for test: i915_drm_fdinfo
results: parsing output: 99/ for test: gem_userptr_blits
results: parsing output: 100/ for test: gem_mmap_gtt
results: parsing output: 101/ for test: gem_pxp
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: gem_ctx_create
results: parsing output: 104/ for test: kms_psr2_sf
results: parsing output: 105/ for test: kms_chamelium_color
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_atomic_transition
results: parsing output: 108/ for test: kms_flip
results: parsing output: 109/ for test: kms_properties
results: parsing output: 110/ for test: core_setmaster_vs_auth
results: parsing output: 111/ for test: kms_hdr
results: parsing output: 112/ for test: kms_psr
results: parsing output: 113/ for test: gem_eio
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: kms_ccs
results: parsing output: 116/ for test: kms_busy
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_ccs
results: parsing output: 119/ for test: api_intel_allocator
results: parsing output: 120/ for test: kms_vblank
results: parsing output: 121/ for test: gem_fence_thrash
results: parsing output: 122/ for test: kms_pipe_stress
results: parsing output: 123/ for test: gem_exec_balancer
results: parsing output: 124/ for test: i915_query
results: parsing output: 125/ for test: kms_cursor_crc
results: parsing output: 126/ for test: kms_debugfs
results: parsing output: 127/ for test: kms_psr
results: parsing output: 128/ for test: kms_plane_lowres
results: parsing output: 129/ for test: gem_exec_schedule
Done.