[65.557904] Initializing watchdogs
[65.557991]   /dev/watchdog0
[65.590551] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:4905 Intel Dg1 (Gen12) DG1 [Iris Xe MAX Graphics]
[65.604875] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[65.609923] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[65.613559] [001/130] (960s left) gem_fence_thrash (bo-write-verify-y)
[65.664285] Starting subtest: bo-write-verify-y
[65.670121] Subtest bo-write-verify-y: SKIP (0.003s)
[65.733112] [002/130] (960s left) gem_ctx_bad_destroy (invalid-default-ctx)
[65.778187] Starting subtest: invalid-default-ctx
[65.779872] Subtest invalid-default-ctx: SUCCESS (0.000s)
[65.894155] [003/130] (960s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions-varying-size)
[67.883827] Starting subtest: cursorB-vs-flipA-atomic-transitions-varying-size
[67.887241] Subtest cursorB-vs-flipA-atomic-transitions-varying-size: SKIP (0.003s)
[68.011466] [004/130] (958s left) perf_pmu (all-busy-check-all)
[68.088789] Starting subtest: all-busy-check-all
[68.673475] Subtest all-busy-check-all: SUCCESS (0.582s)
[68.786202] [005/130] (957s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[70.786856] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt
[70.790148] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[70.939687] [006/130] (955s left) gem_render_copy (y-tiled-ccs-to-y-tiled-ccs)
[71.006805] Starting subtest: y-tiled-ccs-to-y-tiled-ccs
[71.008699] Starting dynamic subtest: smem
[71.142247] Dynamic subtest smem: SUCCESS (0.134s)
[71.152626] Starting dynamic subtest: lmem0
[72.318362] Dynamic subtest lmem0: SUCCESS (1.170s)
[72.320112] Subtest y-tiled-ccs-to-y-tiled-ccs: SUCCESS (1.306s)
[72.587233] [007/130] (953s left) kms_big_fb (yf-tiled-8bpp-rotate-0)
[74.607047] Starting subtest: yf-tiled-8bpp-rotate-0
[74.611038] Subtest yf-tiled-8bpp-rotate-0: SKIP (0.000s)
[74.790667] [008/130] (951s left) syncobj_wait (invalid-signal-zero-handles)
[74.838934] Starting subtest: invalid-signal-zero-handles
[74.840316] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[74.953592] [009/130] (951s left) syncobj_timeline (multi-wait-all-available-submitted)
[74.999117] Starting subtest: multi-wait-all-available-submitted
[75.000539] Subtest multi-wait-all-available-submitted: SUCCESS (0.001s)
[75.110928] [010/130] (951s left) gem_exec_balancer (bonded-semaphore)
[75.165805] Starting subtest: bonded-semaphore
[75.169168] Subtest bonded-semaphore: SKIP (0.000s)
[75.631721] [011/130] (951s left) kms_async_flips (crc-atomic)
[77.624706] Starting subtest: crc-atomic
[77.887632] Starting dynamic subtest: pipe-A-HDMI-A-4
[80.358826] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (2.468s)
[80.529587] Starting dynamic subtest: pipe-B-HDMI-A-4
[82.696692] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (2.172s)
[82.881040] Starting dynamic subtest: pipe-C-HDMI-A-4
[85.051582] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (2.175s)
[85.192886] Starting dynamic subtest: pipe-D-HDMI-A-4
[87.365779] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (2.177s)
[87.367609] Subtest crc-atomic: SUCCESS (9.733s)
[87.686821] [012/130] (939s left) gem_lmem_swapping (massive-random)
[92.645703] Starting subtest: massive-random
[92.647328] Starting dynamic subtest: lmem0
[93.324239] Dynamic subtest lmem0: SUCCESS (0.677s)
[93.325886] Subtest massive-random: SUCCESS (0.677s)
[96.554172] [FACT gem_lmem_swapping (massive-random)] deleted: kernel.kmod_is_loaded.i915: true
[96.557059] [013/130] (930s left) gem_exec_flush (basic-batch-kernel-default-uc)
[100.506529] Subtest basic-batch-kernel-default-uc: SKIP (0.000s)
[100.594796] [FACT gem_exec_flush (basic-batch-kernel-default-uc)] new: kernel.kmod_is_loaded.i915: true
[100.598437] [014/130] (926s left) gem_ccs (block-copy-compressed)
[100.701060] Starting subtest: block-copy-compressed
[100.706728] Subtest block-copy-compressed: SKIP (0.000s)
[100.890425] [015/130] (926s left) kms_lease (setcrtc-implicit-plane)
[102.860857] Starting subtest: setcrtc-implicit-plane
[102.862345] Starting dynamic subtest: pipe-A-HDMI-A-4
[103.316372] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.453s)
[103.325523] Starting dynamic subtest: pipe-B-HDMI-A-4
[103.560573] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.243s)
[103.571313] Starting dynamic subtest: pipe-C-HDMI-A-4
[103.802962] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.240s)
[103.813275] Starting dynamic subtest: pipe-D-HDMI-A-4
[104.050800] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.246s)
[104.052514] Subtest setcrtc-implicit-plane: SUCCESS (1.189s)
[104.225090] [016/130] (922s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-fully-sf)
[106.229422] Subtest fbc-pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[106.301499] [017/130] (920s left) gem_softpin (zero)
[106.356629] Starting subtest: zero
[106.365844] Subtest zero: SUCCESS (0.009s)
[106.579843] [018/130] (920s left) kms_flip (2x-flip-vs-suspend)
[108.570727] Starting subtest: 2x-flip-vs-suspend
[108.588392] Subtest 2x-flip-vs-suspend: SKIP (0.017s)
[108.736827] [019/130] (918s left) prime_mmap (test_correct_cpu_write)
[108.807199] Starting subtest: test_correct_cpu_write
[108.808906] Starting dynamic subtest: test_correct_cpu_write-smem
[108.810609] Dynamic subtest test_correct_cpu_write-smem: SUCCESS (0.000s)
[108.822412] Starting dynamic subtest: test_correct_cpu_write-lmem0
[108.824165] Dynamic subtest test_correct_cpu_write-lmem0: SUCCESS (0.000s)
[108.825907] Subtest test_correct_cpu_write: SUCCESS (0.001s)
[108.983139] [020/130] (918s left) gem_mmap_wc (bad-offset)
[109.029481] Subtest bad-offset: SKIP (0.000s)
[109.102395] [021/130] (918s left) gem_exec_balancer (sequential)
[109.159586] Starting subtest: sequential
[113.346984] Subtest sequential: SUCCESS (4.187s)
[113.771850] [022/130] (913s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[113.827261] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[113.828708] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[113.920028] [023/130] (913s left) gem_mmap_gtt (basic-short)
[113.966221] Subtest basic-short: SKIP (0.000s)
[114.033342] [024/130] (913s left) kms_debugfs (display-off-read-all)
[116.024915] Starting subtest: display-off-read-all
[116.068693] Subtest display-off-read-all: SUCCESS (0.043s)
[116.206358] [025/130] (911s left) perf_pmu (init-wait)
[116.259204] Starting subtest: init-wait
[116.260692] Starting dynamic subtest: rcs0
[116.262170] Dynamic subtest rcs0: SUCCESS (0.002s)
[116.271653] Starting dynamic subtest: bcs0
[116.273214] Dynamic subtest bcs0: SUCCESS (0.001s)
[116.282246] Starting dynamic subtest: vcs0
[116.283862] Dynamic subtest vcs0: SUCCESS (0.001s)
[116.292880] Starting dynamic subtest: vcs1
[116.294626] Dynamic subtest vcs1: SUCCESS (0.001s)
[116.303898] Starting dynamic subtest: vecs0
[116.305542] Dynamic subtest vecs0: SUCCESS (0.001s)
[116.307179] Subtest init-wait: SUCCESS (0.005s)
[116.382142] [026/130] (911s left) kms_frontbuffer_tracking (fbc-farfromfence-mmap-gtt)
[118.379497] Starting subtest: fbc-farfromfence-mmap-gtt
[118.382500] Subtest fbc-farfromfence-mmap-gtt: SKIP (0.000s)
[118.545136] [027/130] (909s left) kms_pm_rpm (dpms-non-lpsp)
[123.051893] Starting subtest: dpms-non-lpsp
[123.154527] Subtest dpms-non-lpsp: SUCCESS (0.103s)
[124.245805] [028/130] (903s left) gem_ctx_isolation (preservation-reset)
[124.429540] Starting subtest: preservation-reset
[124.432521] Starting dynamic subtest: rcs0
[125.112924] Dynamic subtest rcs0: SUCCESS (0.683s)
[125.122945] Starting dynamic subtest: bcs0
[125.809183] Dynamic subtest bcs0: SUCCESS (0.696s)
[125.819440] Starting dynamic subtest: vcs0
[126.478856] Dynamic subtest vcs0: SUCCESS (0.669s)
[126.489026] Starting dynamic subtest: vcs1
[127.158908] Dynamic subtest vcs1: SUCCESS (0.680s)
[127.168837] Starting dynamic subtest: vecs0
[127.883153] Dynamic subtest vecs0: SUCCESS (0.724s)
[127.884599] Subtest preservation-reset: SUCCESS (3.455s)
[128.044448] [029/130] (900s left) gem_ctx_param (invalid-set-no-zeromap)
[128.089947] Starting subtest: invalid-set-no-zeromap
[128.091439] Subtest invalid-set-no-zeromap: SUCCESS (0.000s)
[128.199210] [030/130] (900s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-shrfb-draw-mmap-wc)
[130.198950] Starting subtest: fbc-1p-offscren-pri-shrfb-draw-mmap-wc
[130.201777] Subtest fbc-1p-offscren-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[130.402395] [031/130] (897s left) kms_big_fb (linear-64bpp-rotate-180)
[132.405894] Starting subtest: linear-64bpp-rotate-180
[135.105540] Subtest linear-64bpp-rotate-180: SUCCESS (2.697s)
[135.314964] [032/130] (893s left) gem_exercise_blt (fast-copy)
[135.364521] Starting subtest: fast-copy
[135.365957] Starting dynamic subtest: linear-smem-smem
[135.404802] Dynamic subtest linear-smem-smem: SUCCESS (0.040s)
[135.416026] Starting dynamic subtest: linear-smem-lmem0
[135.422032] Dynamic subtest linear-smem-lmem0: SUCCESS (0.017s)
[135.432452] Starting dynamic subtest: linear-lmem0-smem
[135.485033] Dynamic subtest linear-lmem0-smem: SUCCESS (0.063s)
[135.495304] Starting dynamic subtest: linear-lmem0-lmem0
[135.546095] Dynamic subtest linear-lmem0-lmem0: SUCCESS (0.061s)
[135.556277] Starting dynamic subtest: ymajor-smem-smem
[135.563158] Dynamic subtest ymajor-smem-smem: SUCCESS (0.017s)
[135.573174] Starting dynamic subtest: ymajor-smem-lmem0
[135.580393] Dynamic subtest ymajor-smem-lmem0: SUCCESS (0.017s)
[135.590617] Starting dynamic subtest: ymajor-lmem0-smem
[135.644050] Dynamic subtest ymajor-lmem0-smem: SUCCESS (0.063s)
[135.654163] Starting dynamic subtest: ymajor-lmem0-lmem0
[135.705477] Dynamic subtest ymajor-lmem0-lmem0: SUCCESS (0.061s)
[135.715728] Starting dynamic subtest: tile4-smem-smem
[135.723674] Dynamic subtest tile4-smem-smem: SUCCESS (0.018s)
[135.733969] Starting dynamic subtest: tile4-smem-lmem0
[135.740292] Dynamic subtest tile4-smem-lmem0: SUCCESS (0.016s)
[135.750613] Starting dynamic subtest: tile4-lmem0-smem
[135.802936] Dynamic subtest tile4-lmem0-smem: SUCCESS (0.062s)
[135.813240] Starting dynamic subtest: tile4-lmem0-lmem0
[135.863767] Dynamic subtest tile4-lmem0-lmem0: SUCCESS (0.061s)
[135.874103] Starting dynamic subtest: tile64-smem-smem
[135.881108] Dynamic subtest tile64-smem-smem: SUCCESS (0.017s)
[135.891516] Starting dynamic subtest: tile64-smem-lmem0
[135.898255] Dynamic subtest tile64-smem-lmem0: SUCCESS (0.017s)
[135.908591] Starting dynamic subtest: tile64-lmem0-smem
[135.961227] Dynamic subtest tile64-lmem0-smem: SUCCESS (0.063s)
[135.971208] Starting dynamic subtest: tile64-lmem0-lmem0
[136.022877] Dynamic subtest tile64-lmem0-lmem0: SUCCESS (0.061s)
[136.024700] Subtest fast-copy: SUCCESS (0.658s)
[136.196597] [033/130] (892s left) gem_exec_flush (basic-uc-rw-default)
[136.250209] Subtest basic-uc-rw-default: SKIP (0.000s)
[136.344907] [034/130] (892s left) gem_ctx_param (non-root-set)
[136.399609] Starting subtest: non-root-set
[136.404718] Subtest non-root-set: SUCCESS (0.017s)
[136.521457] [035/130] (892s left) kms_color (ctm-0-25)
[138.501696] Starting subtest: ctm-0-25
[138.503390] Starting dynamic subtest: pipe-A-HDMI-A-4
[140.066820] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (1.565s)
[140.077228] Starting dynamic subtest: pipe-B-HDMI-A-4
[141.461617] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (1.393s)
[141.472684] Starting dynamic subtest: pipe-C-HDMI-A-4
[142.851892] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (1.391s)
[142.863248] Starting dynamic subtest: pipe-D-HDMI-A-4
[144.249377] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (1.397s)
[144.251085] Subtest ctm-0-25: SUCCESS (5.747s)
[144.422809] [036/130] (884s left) gem_exec_schedule (preempt-hang)
[144.614725] Starting subtest: preempt-hang
[144.617476] Starting dynamic subtest: rcs0
[144.954945] Dynamic subtest rcs0: SUCCESS (0.343s)
[144.965749] Starting dynamic subtest: bcs0
[145.242513] Dynamic subtest bcs0: SUCCESS (0.287s)
[145.253215] Starting dynamic subtest: vcs0
[145.564644] Dynamic subtest vcs0: SUCCESS (0.321s)
[145.575491] Starting dynamic subtest: vcs1
[145.848828] Dynamic subtest vcs1: SUCCESS (0.284s)
[145.859432] Starting dynamic subtest: vecs0
[146.159640] Dynamic subtest vecs0: SUCCESS (0.310s)
[146.161540] Subtest preempt-hang: SUCCESS (1.548s)
[146.456886] [037/130] (882s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-move)
[148.457241] Starting subtest: fbc-2p-primscrn-spr-indfb-move
[148.460894] Subtest fbc-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[148.659684] [038/130] (880s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[150.655838] Starting subtest: plane-downscale-factor-0-75-with-rotation
[150.657467] Starting dynamic subtest: pipe-A
[151.012439] Dynamic subtest pipe-A: SKIP (0.356s)
[151.022500] Starting dynamic subtest: pipe-B
[151.402392] Dynamic subtest pipe-B: SKIP (0.388s)
[151.412880] Starting dynamic subtest: pipe-C
[151.794544] Dynamic subtest pipe-C: SKIP (0.390s)
[151.805103] Starting dynamic subtest: pipe-D
[152.166094] Dynamic subtest pipe-D: SKIP (0.371s)
[152.168961] Subtest plane-downscale-factor-0-75-with-rotation: SKIP (1.508s)
[152.333868] [039/130] (876s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180)
[154.355225] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180
[154.358827] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[154.546362] [040/130] (874s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[156.578344] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[157.151717] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.574s)
[157.410811] [041/130] (871s left) gem_ctx_bad_destroy (invalid-pad)
[157.460221] Starting subtest: invalid-pad
[157.461901] Subtest invalid-pad: SUCCESS (0.000s)
[157.568286] [042/130] (871s left) prime_busy (hang-wait)
[157.618896] Starting subtest: hang-wait
[157.620817] Starting dynamic subtest: rcs0
[183.412357] Dynamic subtest rcs0: SUCCESS (25.791s)
[183.422803] Starting dynamic subtest: bcs0
[190.564598] Dynamic subtest bcs0: SUCCESS (7.151s)
[190.575216] Starting dynamic subtest: vcs0
[197.539845] Dynamic subtest vcs0: SUCCESS (6.974s)
[197.550356] Starting dynamic subtest: vcs1
[204.582216] Dynamic subtest vcs1: SUCCESS (7.041s)
[204.592915] Starting dynamic subtest: vecs0
[211.555681] Dynamic subtest vecs0: SUCCESS (6.973s)
[211.557476] Subtest hang-wait: SUCCESS (53.935s)
[211.711763] [043/130] (817s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[213.707914] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-wc
[213.710773] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[213.882710] [044/130] (815s left) gem_exec_reloc (basic-write-gtt)
[213.943139] Subtest basic-write-gtt: SKIP (0.000s)
[214.068045] [045/130] (815s left) gem_exec_reloc (basic-concurrent0)
[214.117539] Subtest basic-concurrent0: SKIP (0.000s)
[214.252641] [046/130] (815s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render)
[216.253663] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render
[216.256668] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[216.449980] [047/130] (813s left) gem_exec_parallel (contexts)
[216.507134] Starting subtest: contexts
[216.508768] Starting dynamic subtest: rcs0
[221.027921] Dynamic subtest rcs0: SUCCESS (4.517s)
[221.038834] Starting dynamic subtest: bcs0
[225.692156] Dynamic subtest bcs0: SUCCESS (4.663s)
[225.706768] Starting dynamic subtest: vcs0
[230.466314] Dynamic subtest vcs0: SUCCESS (4.773s)
[230.477161] Starting dynamic subtest: vcs1
[235.092747] Dynamic subtest vcs1: SUCCESS (4.625s)
[235.103923] Starting dynamic subtest: vecs0
[239.232115] Dynamic subtest vecs0: SUCCESS (4.138s)
[239.233949] Subtest contexts: SUCCESS (22.721s)
[239.534516] [048/130] (790s left) kms_plane_lowres (tiling-x)
[241.531042] Starting subtest: tiling-x
[241.532616] Starting dynamic subtest: pipe-A-HDMI-A-4
[250.816037] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (9.285s)
[250.899377] Starting dynamic subtest: pipe-B-HDMI-A-4
[259.989665] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (9.101s)
[260.055932] Starting dynamic subtest: pipe-C-HDMI-A-4
[269.258055] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (9.211s)
[269.324490] Starting dynamic subtest: pipe-D-HDMI-A-4
[278.461789] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (9.147s)
[278.534094] Subtest tiling-x: SUCCESS (37.003s)
[278.752391] [049/130] (751s left) kms_frontbuffer_tracking (fbcpsr-stridechange)
[280.757241] Starting subtest: fbcpsr-stridechange
[280.760350] Subtest fbcpsr-stridechange: SKIP (0.000s)
[280.954789] [050/130] (749s left) gem_ctx_persistence (process)
[281.008513] Starting subtest: process
[281.184517] Subtest process: SUCCESS (0.175s)
[281.378741] [051/130] (748s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-pwrite)
[283.377357] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-pwrite
[286.391097] Subtest fbc-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (3.016s)
[286.586879] [052/130] (743s left) gem_exec_basic (basic)
[286.638029] Starting subtest: basic
[286.639475] Starting dynamic subtest: rcs0-smem
[286.643231] Dynamic subtest rcs0-smem: SUCCESS (0.003s)
[286.654465] Starting dynamic subtest: bcs0-smem
[286.655970] Dynamic subtest bcs0-smem: SUCCESS (0.001s)
[286.667175] Starting dynamic subtest: vcs0-smem
[286.668846] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[286.679719] Starting dynamic subtest: vcs1-smem
[286.681285] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[286.691766] Starting dynamic subtest: vecs0-smem
[286.693406] Dynamic subtest vecs0-smem: SUCCESS (0.001s)
[286.703973] Starting dynamic subtest: rcs0-lmem0
[286.705675] Dynamic subtest rcs0-lmem0: SUCCESS (0.001s)
[286.716186] Starting dynamic subtest: bcs0-lmem0
[286.717845] Dynamic subtest bcs0-lmem0: SUCCESS (0.000s)
[286.728246] Starting dynamic subtest: vcs0-lmem0
[286.729846] Dynamic subtest vcs0-lmem0: SUCCESS (0.000s)
[286.740325] Starting dynamic subtest: vcs1-lmem0
[286.741931] Dynamic subtest vcs1-lmem0: SUCCESS (0.000s)
[286.752439] Starting dynamic subtest: vecs0-lmem0
[286.754158] Dynamic subtest vecs0-lmem0: SUCCESS (0.000s)
[286.755867] Subtest basic: SUCCESS (0.022s)
[286.897203] [053/130] (743s left) i915_drm_fdinfo (all-busy-idle-check-all)
[286.949597] Starting subtest: all-busy-idle-check-all
[286.967182] Subtest all-busy-idle-check-all: SKIP (0.016s)
[287.084328] [054/130] (743s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area-big-fb)
[289.123779] Subtest pr-primary-plane-update-sf-dmg-area-big-fb: SKIP (0.000s)
[289.198400] [055/130] (741s left) kms_psr (pr-cursor-plane-move)
[291.208642] Subtest pr-cursor-plane-move: SKIP (0.000s)
[291.369455] [056/130] (739s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[293.362856] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[293.364166] Starting dynamic subtest: pipe-A-HDMI-A-4
[293.369483] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.000s)
[293.380170] Starting dynamic subtest: pipe-B-HDMI-A-4
[293.385545] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.000s)
[293.396038] Starting dynamic subtest: pipe-C-HDMI-A-4
[293.401529] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.000s)
[293.412113] Starting dynamic subtest: pipe-D-HDMI-A-4
[293.417690] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.000s)
[293.420513] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.010s)
[293.596294] [057/130] (737s left) api_intel_allocator (reopen-fork)
[293.643822] Starting subtest: reopen-fork
[296.921440] Subtest reopen-fork: SUCCESS (3.276s)
[297.068846] [058/130] (733s left) gem_exec_params (rel-constants-invalid-rel-gen5)
[297.118725] Starting subtest: rel-constants-invalid-rel-gen5
[297.120394] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s)
[297.303716] [059/130] (733s left) core_getversion (all-cards)
[297.351090] Starting subtest: all-cards
[297.367968] Subtest all-cards: SUCCESS (0.021s)
[297.445754] [060/130] (733s left) gem_mmap_offset (bad-object)
[297.492895] Starting subtest: bad-object
[297.494709] Subtest bad-object: SUCCESS (0.001s)
[297.649250] [061/130] (733s left) kms_flip (2x-flip-vs-rmfb)
[299.644878] Starting subtest: 2x-flip-vs-rmfb
[299.662207] Subtest 2x-flip-vs-rmfb: SKIP (0.018s)
[299.818603] [062/130] (731s left) kms_universal_plane (universal-plane-pageflip-windowed)
[301.823895] Starting subtest: universal-plane-pageflip-windowed
[301.825497] Starting dynamic subtest: pipe-A-HDMI-A-4
[302.443578] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.617s)
[302.457787] Starting dynamic subtest: pipe-B-HDMI-A-4
[302.825830] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.379s)
[302.838823] Starting dynamic subtest: pipe-C-HDMI-A-4
[303.259655] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.431s)
[303.272775] Starting dynamic subtest: pipe-D-HDMI-A-4
[303.699739] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.437s)
[303.701328] Subtest universal-plane-pageflip-windowed: SUCCESS (1.876s)
[303.898655] [063/130] (727s left) kms_vblank (wait-forked-busy-hang)
[305.892771] Starting subtest: wait-forked-busy-hang
[305.896944] Starting dynamic subtest: pipe-A-HDMI-A-4
[332.507898] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (26.612s)
[332.522135] Starting dynamic subtest: pipe-D-HDMI-A-4
[357.446149] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (24.933s)
[357.447587] Subtest wait-forked-busy-hang: SUCCESS (51.554s)
[357.607443] [064/130] (673s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-wc)
[359.633222] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-wc
[359.637262] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.001s)
[359.836473] [065/130] (671s left) kms_pipe_b_c_ivb (pipe-b-dpms-off-modeset-pipe-c)
[359.883162] Subtest pipe-B-dpms-off-modeset-pipe-C: SKIP (0.000s)
[359.972329] [066/130] (671s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[360.025813] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[360.027288] Starting dynamic subtest: smem
[360.120297] Dynamic subtest smem: SUCCESS (0.094s)
[360.131340] Starting dynamic subtest: lmem0
[361.055289] Dynamic subtest lmem0: SUCCESS (0.930s)
[361.056838] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SUCCESS (1.027s)
[361.314449] [067/130] (670s left) gem_softpin (evict-snoop)
[361.367208] Starting subtest: evict-snoop
[361.370209] Subtest evict-snoop: SKIP (0.000s)
[361.491977] [068/130] (670s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[363.495674] Starting subtest: addfb25-y-tiled-small-legacy
[363.498079] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.001s)
[363.702867] [069/130] (668s left) sw_sync (alloc_fence_invalid_timeline)
[363.747742] Starting subtest: alloc_fence_invalid_timeline
[363.749491] Subtest alloc_fence_invalid_timeline: SUCCESS (0.000s)
[363.863199] [070/130] (667s left) gem_pxp (protected-encrypted-src-copy-not-readible)
[366.465057] Starting subtest: protected-encrypted-src-copy-not-readible
[366.468461] Subtest protected-encrypted-src-copy-not-readible: SKIP (0.000s)
[366.587867] [071/130] (665s left) kms_rotation_crc (sprite-rotation-90-pos-100-0)
[368.582756] Starting subtest: sprite-rotation-90-pos-100-0
[375.673230] Subtest sprite-rotation-90-pos-100-0: SUCCESS (7.090s)
[375.920725] [072/130] (656s left) kms_big_fb (yf-tiled-16bpp-rotate-0)
[377.971470] Starting subtest: yf-tiled-16bpp-rotate-0
[377.974646] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s)
[378.177683] [073/130] (653s left) kms_plane_scaling (planes-upscale-factor-0-25)
[380.168553] Starting subtest: planes-upscale-factor-0-25
[380.170104] Starting dynamic subtest: pipe-A
[380.275148] Dynamic subtest pipe-A: SUCCESS (0.108s)
[380.286921] Starting dynamic subtest: pipe-B
[380.416222] Dynamic subtest pipe-B: SUCCESS (0.140s)
[380.427693] Starting dynamic subtest: pipe-C
[380.555778] Dynamic subtest pipe-C: SUCCESS (0.139s)
[380.566463] Starting dynamic subtest: pipe-D
[380.696885] Dynamic subtest pipe-D: SUCCESS (0.140s)
[380.698335] Subtest planes-upscale-factor-0-25: SUCCESS (0.532s)
[380.886771] [074/130] (651s left) kms_chamelium_edid (hdmi-edid-read)
[382.946031] Subtest hdmi-edid-read: SKIP (0.000s)
[383.052703] [075/130] (649s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-render)
[385.053399] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-render
[385.056235] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[385.256253] [076/130] (647s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-pwrite)
[387.272584] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-pwrite
[390.024481] Subtest fbc-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (2.752s)
[390.212174] [077/130] (642s left) syncobj_wait (wait-for-submit-snapshot)
[390.290954] Starting subtest: wait-for-submit-snapshot
[390.368901] Subtest wait-for-submit-snapshot: SUCCESS (0.084s)
[390.529909] [078/130] (642s left) gem_softpin (noreloc)
[390.583217] Starting subtest: noreloc
[396.044423] Subtest noreloc: SUCCESS (5.458s)
[396.210301] [079/130] (636s left) kms_selftest (drm_damage_helper)
[396.265284] Starting subtest: drm_damage_helper
[396.315045] Starting dynamic subtest: drm_test_damage_iter_no_damage
[396.461428] Dynamic subtest drm_test_damage_iter_no_damage: SUCCESS (0.141s)
[396.472591] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src
[396.552287] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src: SUCCESS (0.087s)
[396.598012] Starting dynamic subtest: drm_test_damage_iter_no_damage_src_moved
[396.657033] Dynamic subtest drm_test_damage_iter_no_damage_src_moved: SUCCESS (0.098s)
[396.699584] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src_moved
[396.763593] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src_moved: SUCCESS (0.099s)
[396.811789] Starting dynamic subtest: drm_test_damage_iter_no_damage_not_visible
[396.842349] Dynamic subtest drm_test_damage_iter_no_damage_not_visible: SUCCESS (0.074s)
[396.858367] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_crtc
[396.940635] Dynamic subtest drm_test_damage_iter_no_damage_no_crtc: SUCCESS (0.093s)
[396.987157] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_fb
[397.036534] Dynamic subtest drm_test_damage_iter_no_damage_no_fb: SUCCESS (0.091s)
[397.068685] Starting dynamic subtest: drm_test_damage_iter_simple_damage
[397.149555] Dynamic subtest drm_test_damage_iter_simple_damage: SUCCESS (0.107s)
[397.196673] Starting dynamic subtest: drm_test_damage_iter_single_damage
[397.256428] Dynamic subtest drm_test_damage_iter_single_damage: SUCCESS (0.101s)
[397.297696] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_src
[397.348595] Dynamic subtest drm_test_damage_iter_single_damage_intersect_src: SUCCESS (0.087s)
[397.392112] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_src
[397.442847] Dynamic subtest drm_test_damage_iter_single_damage_outside_src: SUCCESS (0.092s)
[397.462125] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src
[397.551506] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src: SUCCESS (0.103s)
[397.597933] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_fractional_src
[397.646709] Dynamic subtest drm_test_damage_iter_single_damage_intersect_fractional_src: SUCCESS (0.090s)
[397.679319] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_fractional_src
[397.732586] Dynamic subtest drm_test_damage_iter_single_damage_outside_fractional_src: SUCCESS (0.081s)
[397.778408] Starting dynamic subtest: drm_test_damage_iter_single_damage_src_moved
[397.824677] Dynamic subtest drm_test_damage_iter_single_damage_src_moved: SUCCESS (0.087s)
[397.857675] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src_moved
[397.920817] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src_moved: SUCCESS (0.091s)
[397.967243] Starting dynamic subtest: drm_test_damage_iter_damage
[398.021385] Dynamic subtest drm_test_damage_iter_damage: SUCCESS (0.096s)
[398.035744] Starting dynamic subtest: drm_test_damage_iter_damage_one_intersect
[398.114602] Dynamic subtest drm_test_damage_iter_damage_one_intersect: SUCCESS (0.086s)
[398.161888] Starting dynamic subtest: drm_test_damage_iter_damage_one_outside
[398.225712] Dynamic subtest drm_test_damage_iter_damage_one_outside: SUCCESS (0.104s)
[398.269484] Starting dynamic subtest: drm_test_damage_iter_damage_src_moved
[398.320250] Dynamic subtest drm_test_damage_iter_damage_src_moved: SUCCESS (0.089s)
[398.359572] Starting dynamic subtest: drm_test_damage_iter_damage_not_visible
[398.421991] Dynamic subtest drm_test_damage_iter_damage_not_visible: SUCCESS (0.095s)
[398.424984] Subtest drm_damage_helper: SUCCESS (2.164s)
[398.670138] [080/130] (634s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-sf)
[400.685789] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[400.752096] [081/130] (632s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[402.759683] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[402.762607] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[402.952646] [082/130] (629s left) perf_pmu (busy-hang)
[403.003977] Starting subtest: busy-hang
[403.005597] Starting dynamic subtest: rcs0
[404.256194] Dynamic subtest rcs0: SUCCESS (1.252s)
[404.267285] Starting dynamic subtest: bcs0
[405.451248] Dynamic subtest bcs0: SUCCESS (1.194s)
[405.462923] Starting dynamic subtest: vcs0
[406.656404] Dynamic subtest vcs0: SUCCESS (1.204s)
[406.669608] Starting dynamic subtest: vcs1
[407.854640] Dynamic subtest vcs1: SUCCESS (1.195s)
[407.868287] Starting dynamic subtest: vecs0
[409.060708] Dynamic subtest vecs0: SUCCESS (1.202s)
[409.064851] Subtest busy-hang: SUCCESS (6.058s)
[409.173684] [083/130] (623s left) kms_content_protection (content-type-change)
[411.228284] Starting subtest: content-type-change
[411.496237] Subtest content-type-change: SKIP (0.265s)
[411.710954] [084/130] (621s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs-cc)
[413.706944] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs-cc
[413.708506] Starting dynamic subtest: pipe-A-HDMI-A-4
[413.723683] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.000s)
[413.734905] Starting dynamic subtest: pipe-B-HDMI-A-4
[413.750329] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.000s)
[413.761045] Starting dynamic subtest: pipe-C-HDMI-A-4
[413.776607] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.000s)
[413.787514] Starting dynamic subtest: pipe-D-HDMI-A-4
[413.803970] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.000s)
[413.807255] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs-cc: SKIP (0.010s)
[413.937864] [085/130] (619s left) gem_exec_reloc (basic-range)
[413.991434] Subtest basic-range: SKIP (0.000s)
[414.084502] [086/130] (619s left) kms_chamelium_frames (hdmi-crc-multiple)
[416.155931] Subtest hdmi-crc-multiple: SKIP (0.000s)
[416.271759] [087/130] (616s left) kms_psr (psr-cursor-mmap-gtt)
[418.290545] Subtest psr-cursor-mmap-gtt: SKIP (0.000s)
[418.446563] [088/130] (614s left) kms_atomic (plane-primary-legacy)
[420.439892] Starting subtest: plane-primary-legacy
[420.444198] Starting dynamic subtest: pipe-A-HDMI-A-4
[421.047402] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.605s)
[421.049640] Subtest plane-primary-legacy: SUCCESS (0.608s)
[421.234475] [089/130] (612s left) kms_cursor_crc (cursor-onscreen-512x170)
[423.513678] Starting subtest: cursor-onscreen-512x170
[423.516498] Subtest cursor-onscreen-512x170: SKIP (0.001s)
[423.730597] [090/130] (609s left) syncobj_timeline (single-wait-for-submit-signaled)
[423.778828] Starting subtest: single-wait-for-submit-signaled
[423.780359] Subtest single-wait-for-submit-signaled: SUCCESS (0.000s)
[423.890195] [091/130] (609s left) gem_softpin (evict-active-interruptible)
[423.943380] Starting subtest: evict-active-interruptible
[423.955809] Subtest evict-active-interruptible: SUCCESS (0.012s)
[424.103339] [092/130] (609s left) gem_tiled_pread_pwrite
[424.233412] [093/130] (609s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[426.232332] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[426.235443] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[426.441174] [094/130] (607s left) kms_psr2_su (page_flip-p010)
[426.507922] Subtest page_flip-P010: SKIP (0.000s)
[426.578080] [095/130] (607s left) prime_mmap (test_forked)
[426.623818] Starting subtest: test_forked
[426.625538] Starting dynamic subtest: test_forked-smem
[426.697918] Dynamic subtest test_forked-smem: SUCCESS (0.075s)
[426.709239] Starting dynamic subtest: test_forked-lmem0
[426.772448] Dynamic subtest test_forked-lmem0: SUCCESS (0.073s)
[426.774184] Subtest test_forked: SUCCESS (0.151s)
[426.908202] [096/130] (607s left) i915_pm_freq_api (freq-suspend)
[426.967332] Starting subtest: freq-suspend
[426.968639] Starting dynamic subtest: gt0
[443.466563] Dynamic subtest gt0: SUCCESS (1.742s)
[443.470640] Subtest freq-suspend: SUCCESS (1.744s)
[448.998437] [097/130] (590s left) kms_invalid_mode (zero-vdisplay)
[450.832441] Starting subtest: zero-vdisplay
[450.834052] Starting dynamic subtest: pipe-A-HDMI-A-4
[450.872643] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.038s)
[450.885217] Starting dynamic subtest: pipe-B-HDMI-A-4
[450.887101] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.001s)
[450.899543] Starting dynamic subtest: pipe-C-HDMI-A-4
[450.901446] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.001s)
[450.915049] Starting dynamic subtest: pipe-D-HDMI-A-4
[450.916725] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.001s)
[450.918383] Subtest zero-vdisplay: SUCCESS (0.050s)
[451.055117] [098/130] (588s left) i915_pm_rps (engine-order)
[451.110919] Starting subtest: engine-order
[459.059155] Subtest engine-order: SUCCESS (7.820s)
[459.307812] [099/130] (579s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-pwrite)
[461.295798] Starting subtest: psr-2p-primscrn-cur-indfb-draw-pwrite
[461.298813] Subtest psr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[461.521811] [100/130] (577s left) kms_hdr (bpc-switch-dpms)
[463.518399] Starting subtest: bpc-switch-dpms
[463.522921] Subtest bpc-switch-dpms: SKIP (0.001s)
[463.637593] [101/130] (575s left) gem_exec_suspend (basic-s3-devices)
[463.713758] Starting subtest: basic-S3-devices
[463.715453] Starting dynamic subtest: smem
[473.756939] Dynamic subtest smem: SUCCESS (10.012s)
[473.769376] Starting dynamic subtest: lmem0
[483.893616] Dynamic subtest lmem0: SUCCESS (10.124s)
[483.895063] Subtest basic-S3-devices: SUCCESS (20.139s)
[489.163787] [102/130] (555s left) gem_render_copy (y-tiled-ccs-to-x-tiled)
[489.218271] Starting subtest: y-tiled-ccs-to-x-tiled
[489.219737] Starting dynamic subtest: smem
[489.309127] Dynamic subtest smem: SUCCESS (0.090s)
[489.321713] Starting dynamic subtest: lmem0
[490.246417] Dynamic subtest lmem0: SUCCESS (0.932s)
[490.248062] Subtest y-tiled-ccs-to-x-tiled: SUCCESS (1.025s)
[490.520020] [103/130] (554s left) gem_exec_fence (syncobj-invalid-flags)
[491.063884] Starting subtest: syncobj-invalid-flags
[491.065421] Subtest syncobj-invalid-flags: SUCCESS (0.000s)
[491.485307] [FACT gem_exec_fence (syncobj-invalid-flags)] new: kernel.kmod_is_loaded.vgem: true
[491.488862] [104/130] (553s left) sw_sync (sync_busy_fork)
[491.534437] Starting subtest: sync_busy_fork
[492.550829] Subtest sync_busy_fork: SUCCESS (1.015s)
[492.675749] [105/130] (552s left) kms_plane_alpha_blend (alpha-transparent-fb)
[494.665904] Starting subtest: alpha-transparent-fb
[494.929655] Starting dynamic subtest: pipe-A-HDMI-A-4
[495.393520] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.462s)
[495.406355] Starting dynamic subtest: pipe-D-HDMI-A-4
[495.890573] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.496s)
[495.891921] Subtest alpha-transparent-fb: SUCCESS (1.227s)
[496.084827] [106/130] (548s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-onoff)
[498.086762] Starting subtest: fbc-2p-primscrn-spr-indfb-onoff
[498.090088] Subtest fbc-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[498.288708] [107/130] (546s left) kms_chamelium_color (ctm-0-25)
[500.326616] Subtest ctm-0-25: SKIP (0.000s)
[500.402648] [108/130] (544s left) gem_wait (busy)
[500.465866] Starting subtest: busy
[500.467404] Starting dynamic subtest: all-engines
[501.066424] Dynamic subtest all-engines: SUCCESS (0.600s)
[501.079518] Starting dynamic subtest: rcs0
[501.608051] Dynamic subtest rcs0: SUCCESS (0.540s)
[501.620304] Starting dynamic subtest: bcs0
[502.147076] Dynamic subtest bcs0: SUCCESS (0.537s)
[502.159276] Starting dynamic subtest: vcs0
[502.686127] Dynamic subtest vcs0: SUCCESS (0.538s)
[502.698578] Starting dynamic subtest: vcs1
[503.225123] Dynamic subtest vcs1: SUCCESS (0.537s)
[503.237491] Starting dynamic subtest: vecs0
[503.763978] Dynamic subtest vecs0: SUCCESS (0.537s)
[503.765407] Subtest busy: SUCCESS (3.298s)
[504.040270] [109/130] (541s left) gem_exec_schedule (timeslicing)
[504.098490] Starting subtest: timeslicing
[504.099994] Starting dynamic subtest: rcs0
[504.118789] Dynamic subtest rcs0: SUCCESS (0.020s)
[504.131367] Starting dynamic subtest: bcs0
[504.140956] Dynamic subtest bcs0: SUCCESS (0.021s)
[504.153720] Starting dynamic subtest: vcs0
[504.164119] Dynamic subtest vcs0: SUCCESS (0.022s)
[504.176965] Starting dynamic subtest: vcs1
[504.185900] Dynamic subtest vcs1: SUCCESS (0.020s)
[504.199036] Starting dynamic subtest: vecs0
[504.207589] Dynamic subtest vecs0: SUCCESS (0.020s)
[504.209124] Subtest timeslicing: SUCCESS (0.110s)
[504.623981] [110/130] (540s left) kms_addfb_basic (bo-too-small)
[506.619698] Starting subtest: bo-too-small
[506.621250] Subtest bo-too-small: SUCCESS (0.000s)
[506.812116] [111/130] (538s left) gem_ctx_exec (basic)
[506.879785] Starting subtest: basic
[506.885065] Subtest basic: SUCCESS (0.006s)
[507.042272] [112/130] (538s left) gem_bad_reloc (negative-reloc-lut)
[507.093755] Subtest negative-reloc-lut: SKIP (0.000s)
[507.200349] [113/130] (538s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[509.197625] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[509.200657] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[509.406123] [114/130] (536s left) kms_dsc (dsc-fractional-bpp)
[511.402323] Starting subtest: dsc-fractional-bpp
[511.411403] Subtest dsc-fractional-bpp: SKIP (0.000s)
[511.554539] [115/130] (534s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-pwrite)
[513.577298] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-pwrite
[513.580278] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[513.795805] [116/130] (532s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-blt)
[515.789437] Starting subtest: psr-2p-primscrn-spr-indfb-draw-blt
[515.792324] Subtest psr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[515.991653] [117/130] (530s left) gem_exec_schedule (smoketest-all)
[516.053297] Starting subtest: smoketest-all
[548.364529] Subtest smoketest-all: SUCCESS (32.286s)
[548.830160] [118/130] (497s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-downscaling)
[550.825131] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-downscaling
[550.826598] Starting dynamic subtest: pipe-A-valid-mode
[550.877985] Dynamic subtest pipe-A-valid-mode: SKIP (0.050s)
[550.880949] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-downscaling: SKIP (0.053s)
[551.026003] [119/130] (495s left) kms_frontbuffer_tracking (psr-slowdraw)
[553.025640] Starting subtest: psr-slowdraw
[553.029039] Subtest psr-slowdraw: SKIP (0.000s)
[553.215461] [120/130] (493s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted)
[553.283694] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted
[553.386118] Subtest etime-multi-wait-all-for-submit-unsubmitted: SUCCESS (0.102s)
[553.560516] [121/130] (492s left) gem_eio (in-flight-1us)
[553.802431] Starting subtest: in-flight-1us
[558.139639] Subtest in-flight-1us: SUCCESS (4.336s)
[560.232095] [122/130] (486s left) i915_drm_fdinfo (virtual-busy-idle)
[560.299711] Starting subtest: virtual-busy-idle
[560.303266] Subtest virtual-busy-idle: SKIP (0.000s)
[560.404282] [123/130] (486s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[562.620622] Starting subtest: cursor-rapid-movement-256x256
[562.629483] Starting dynamic subtest: pipe-A-HDMI-A-4
[563.060508] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.432s)
[563.094692] Starting dynamic subtest: pipe-D-HDMI-A-4
[563.400059] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.317s)
[563.401472] Subtest cursor-rapid-movement-256x256: SUCCESS (0.779s)
[563.799017] [124/130] (482s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled)
[563.854099] Starting subtest: multi-wait-for-submit-submitted-signaled
[563.855954] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.001s)
[563.962628] [125/130] (482s left) kms_psr (pr-sprite-render)
[565.960335] Subtest pr-sprite-render: SKIP (0.000s)
[566.040171] [126/130] (480s left) kms_ccs (crc-sprite-planes-basic-yf-tiled-ccs)
[568.033458] Starting subtest: crc-sprite-planes-basic-yf-tiled-ccs
[568.037328] Starting dynamic subtest: pipe-A-HDMI-A-4
[568.073996] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.003s)
[568.086964] Starting dynamic subtest: pipe-B-HDMI-A-4
[568.125831] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.003s)
[568.138387] Starting dynamic subtest: pipe-C-HDMI-A-4
[568.179972] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.003s)
[568.192891] Starting dynamic subtest: pipe-D-HDMI-A-4
[568.240363] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.003s)
[568.245684] Subtest crc-sprite-planes-basic-yf-tiled-ccs: SKIP (0.020s)
[568.356823] [127/130] (478s left) kms_ccs (bad-rotation-90-4-tiled-lnl-ccs)
[570.350775] Starting subtest: bad-rotation-90-4-tiled-lnl-ccs
[570.354024] Subtest bad-rotation-90-4-tiled-lnl-ccs: SKIP (0.000s)
[570.546304] [128/130] (476s left) kms_big_fb (y-tiled-16bpp-rotate-180)
[572.561597] Starting subtest: y-tiled-16bpp-rotate-180
[574.409153] Subtest y-tiled-16bpp-rotate-180: SUCCESS (1.843s)
[574.612721] [129/130] (472s left) gem_request_retire (retire-vma-not-inactive)
[574.664726] Starting subtest: retire-vma-not-inactive
[574.700263] Subtest retire-vma-not-inactive: SUCCESS (0.036s)
[574.880803] [130/130] (472s left) kms_psr (fbc-psr2-suspend)
[576.876108] Subtest fbc-psr2-suspend: SKIP (0.000s)
[576.949409] Closing watchdogs
results: parsing output: 0/ for test: gem_fence_thrash
results: parsing output: 1/ for test: gem_ctx_bad_destroy
results: parsing output: 2/ for test: kms_cursor_legacy
results: parsing output: 3/ for test: perf_pmu
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: gem_render_copy
results: parsing output: 6/ for test: kms_big_fb
results: parsing output: 7/ for test: syncobj_wait
results: parsing output: 8/ for test: syncobj_timeline
results: parsing output: 9/ for test: gem_exec_balancer
results: parsing output: 10/ for test: kms_async_flips
results: parsing output: 11/ for test: gem_lmem_swapping
results: parsing output: 12/ for test: gem_exec_flush
results: parsing output: 13/ for test: gem_ccs
results: parsing output: 14/ for test: kms_lease
results: parsing output: 15/ for test: kms_psr2_sf
results: parsing output: 16/ for test: gem_softpin
results: parsing output: 17/ for test: kms_flip
results: parsing output: 18/ for test: prime_mmap
results: parsing output: 19/ for test: gem_mmap_wc
results: parsing output: 20/ for test: gem_exec_balancer
results: parsing output: 21/ for test: syncobj_timeline
results: parsing output: 22/ for test: gem_mmap_gtt
results: parsing output: 23/ for test: kms_debugfs
results: parsing output: 24/ for test: perf_pmu
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_pm_rpm
results: parsing output: 27/ for test: gem_ctx_isolation
results: parsing output: 28/ for test: gem_ctx_param
results: parsing output: 29/ for test: kms_frontbuffer_tracking
results: parsing output: 30/ for test: kms_big_fb
results: parsing output: 31/ for test: gem_exercise_blt
results: parsing output: 32/ for test: gem_exec_flush
results: parsing output: 33/ for test: gem_ctx_param
results: parsing output: 34/ for test: kms_color
results: parsing output: 35/ for test: gem_exec_schedule
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: kms_plane_scaling
results: parsing output: 38/ for test: kms_big_fb
results: parsing output: 39/ for test: kms_big_fb
results: parsing output: 40/ for test: gem_ctx_bad_destroy
results: parsing output: 41/ for test: prime_busy
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: gem_exec_reloc
results: parsing output: 44/ for test: gem_exec_reloc
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: gem_exec_parallel
results: parsing output: 47/ for test: kms_plane_lowres
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: gem_ctx_persistence
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: gem_exec_basic
results: parsing output: 52/ for test: i915_drm_fdinfo
results: parsing output: 53/ for test: kms_psr2_sf
results: parsing output: 54/ for test: kms_psr
results: parsing output: 55/ for test: kms_ccs
results: parsing output: 56/ for test: api_intel_allocator
results: parsing output: 57/ for test: gem_exec_params
results: parsing output: 58/ for test: core_getversion
results: parsing output: 59/ for test: gem_mmap_offset
results: parsing output: 60/ for test: kms_flip
results: parsing output: 61/ for test: kms_universal_plane
results: parsing output: 62/ for test: kms_vblank
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_pipe_b_c_ivb
results: parsing output: 65/ for test: gem_render_copy
results: parsing output: 66/ for test: gem_softpin
results: parsing output: 67/ for test: kms_addfb_basic
results: parsing output: 68/ for test: sw_sync
results: parsing output: 69/ for test: gem_pxp
results: parsing output: 70/ for test: kms_rotation_crc
results: parsing output: 71/ for test: kms_big_fb
results: parsing output: 72/ for test: kms_plane_scaling
results: parsing output: 73/ for test: kms_chamelium_edid
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: syncobj_wait
results: parsing output: 77/ for test: gem_softpin
results: parsing output: 78/ for test: kms_selftest
results: parsing output: 79/ for test: kms_psr2_sf
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: perf_pmu
results: parsing output: 82/ for test: kms_content_protection
results: parsing output: 83/ for test: kms_ccs
results: parsing output: 84/ for test: gem_exec_reloc
results: parsing output: 85/ for test: kms_chamelium_frames
results: parsing output: 86/ for test: kms_psr
results: parsing output: 87/ for test: kms_atomic
results: parsing output: 88/ for test: kms_cursor_crc
results: parsing output: 89/ for test: syncobj_timeline
results: parsing output: 90/ for test: gem_softpin
results: parsing output: 91/ for test: gem_tiled_pread_pwrite
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_psr2_su
results: parsing output: 94/ for test: prime_mmap
results: parsing output: 95/ for test: i915_pm_freq_api
results: parsing output: 96/ for test: kms_invalid_mode
results: parsing output: 97/ for test: i915_pm_rps
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: kms_hdr
results: parsing output: 100/ for test: gem_exec_suspend
results: parsing output: 101/ for test: gem_render_copy
results: parsing output: 102/ for test: gem_exec_fence
results: parsing output: 103/ for test: sw_sync
results: parsing output: 104/ for test: kms_plane_alpha_blend
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_chamelium_color
results: parsing output: 107/ for test: gem_wait
results: parsing output: 108/ for test: gem_exec_schedule
results: parsing output: 109/ for test: kms_addfb_basic
results: parsing output: 110/ for test: gem_ctx_exec
results: parsing output: 111/ for test: gem_bad_reloc
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_dsc
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: gem_exec_schedule
results: parsing output: 117/ for test: kms_flip_scaled_crc
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: syncobj_timeline
results: parsing output: 120/ for test: gem_eio
results: parsing output: 121/ for test: i915_drm_fdinfo
results: parsing output: 122/ for test: kms_cursor_crc
results: parsing output: 123/ for test: syncobj_timeline
results: parsing output: 124/ for test: kms_psr
results: parsing output: 125/ for test: kms_ccs
results: parsing output: 126/ for test: kms_ccs
results: parsing output: 127/ for test: kms_big_fb
results: parsing output: 128/ for test: gem_request_retire
results: parsing output: 129/ for test: kms_psr
Done.