[67.514731] Initializing watchdogs
[67.514813]   /dev/watchdog0
[67.545551] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:4905 Intel Dg1 (Gen12) DG1 [Iris Xe MAX Graphics]
[67.560886] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[67.565855] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[67.568663] [001/133] (960s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-wc)
[69.061619] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-wc
[69.063269] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[69.202739] [002/133] (958s left) gem_flink_basic (bad-open)
[69.266482] Starting subtest: bad-open
[69.267293] Subtest bad-open: SUCCESS (0.000s)
[69.385187] [003/133] (958s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-move)
[70.872827] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-move
[70.874783] Subtest fbcpsr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[71.074833] [004/133] (957s left) gem_ppgtt (shrink-vs-evict-pinned)
[71.341802] Starting subtest: shrink-vs-evict-pinned
[78.916402] Subtest shrink-vs-evict-pinned: SUCCESS (7.575s)
[79.018143] [005/133] (949s left) gem_exec_schedule (implicit-boths)
[79.074518] Starting subtest: implicit-boths
[79.075325] Starting dynamic subtest: rcs0
[79.276878] Dynamic subtest rcs0: SUCCESS (0.199s)
[79.285115] Starting dynamic subtest: bcs0
[79.412472] Dynamic subtest bcs0: SUCCESS (0.138s)
[79.420978] Starting dynamic subtest: vcs0
[79.550507] Dynamic subtest vcs0: SUCCESS (0.138s)
[79.558672] Starting dynamic subtest: vcs1
[79.699252] Dynamic subtest vcs1: SUCCESS (0.148s)
[79.707325] Starting dynamic subtest: vecs0
[79.847514] Dynamic subtest vecs0: SUCCESS (0.148s)
[79.848435] Subtest implicit-boths: SUCCESS (0.773s)
[80.315766] [006/133] (948s left) vgem_slow (nohang)
[80.414395] Starting subtest: nohang
[90.699286] Subtest nohang: SUCCESS (10.284s)
[90.792584] [FACT vgem_slow (nohang)] new: kernel.kmod_is_loaded.vgem: true
[90.794873] [007/133] (937s left) gem_exec_schedule (u-submit-late-slice)
[90.853947] Starting subtest: u-submit-late-slice
[90.855175] Starting dynamic subtest: rcs0
[90.914507] Dynamic subtest rcs0: SUCCESS (0.060s)
[90.923104] Starting dynamic subtest: bcs0
[90.956987] Dynamic subtest bcs0: SUCCESS (0.042s)
[90.965512] Starting dynamic subtest: vcs0
[90.998160] Dynamic subtest vcs0: SUCCESS (0.041s)
[91.007401] Starting dynamic subtest: vcs1
[91.038349] Dynamic subtest vcs1: SUCCESS (0.040s)
[91.047314] Starting dynamic subtest: vecs0
[91.079793] Dynamic subtest vecs0: SUCCESS (0.041s)
[91.080662] Subtest u-submit-late-slice: SUCCESS (0.226s)
[91.540796] [008/133] (937s left) kms_ccs (missing-ccs-buffer-y-tiled-gen12-rc-ccs)
[93.024852] Starting subtest: missing-ccs-buffer-y-tiled-gen12-rc-ccs
[93.027371] Starting dynamic subtest: pipe-A-HDMI-A-4
[93.034991] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.001s)
[93.043676] Starting dynamic subtest: pipe-B-HDMI-A-4
[93.050910] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.001s)
[93.059190] Starting dynamic subtest: pipe-C-HDMI-A-4
[93.066813] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.001s)
[93.074785] Starting dynamic subtest: pipe-D-HDMI-A-4
[93.082412] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.001s)
[93.083287] Subtest missing-ccs-buffer-y-tiled-gen12-rc-ccs: SUCCESS (0.008s)
[93.289269] [009/133] (935s left) kms_cursor_legacy (torture-move)
[94.773452] Starting subtest: torture-move
[94.774323] Starting dynamic subtest: pipe-A
[100.282306] Dynamic subtest pipe-A: SUCCESS (5.505s)
[100.291301] Starting dynamic subtest: pipe-B
[105.756183] Dynamic subtest pipe-B: SUCCESS (5.475s)
[105.764945] Starting dynamic subtest: pipe-C
[111.248377] Dynamic subtest pipe-C: SUCCESS (5.492s)
[111.257192] Starting dynamic subtest: pipe-D
[116.807172] Dynamic subtest pipe-D: SUCCESS (5.559s)
[116.815783] Starting dynamic subtest: all-pipes
[122.282473] Dynamic subtest all-pipes: SUCCESS (5.475s)
[122.283391] Subtest torture-move: SUCCESS (27.508s)
[122.410480] [010/133] (906s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[123.941868] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-cpu
[123.943828] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[124.188095] [011/133] (904s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-wc)
[125.675304] Starting subtest: psr-rgb101010-draw-mmap-wc
[125.676925] Subtest psr-rgb101010-draw-mmap-wc: SKIP (0.000s)
[125.826657] [012/133] (903s left) i915_drm_fdinfo (virtual-busy-idle)
[125.884882] Starting subtest: virtual-busy-idle
[125.886684] Subtest virtual-busy-idle: SKIP (0.000s)
[126.002841] [013/133] (903s left) kms_vblank (ts-continuation-modeset)
[127.483987] Starting subtest: ts-continuation-modeset
[127.486188] Starting dynamic subtest: pipe-A-HDMI-A-4
[127.923828] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.438s)
[127.936871] Starting dynamic subtest: pipe-D-HDMI-A-4
[128.191175] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.264s)
[128.191905] Subtest ts-continuation-modeset: SUCCESS (0.708s)
[128.355438] [014/133] (900s left) i915_pm_rps (thresholds-idle)
[128.408623] Starting subtest: thresholds-idle
[128.410224] Subtest thresholds-idle: SKIP (0.000s)
[128.531459] [015/133] (900s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs-cc)
[130.013947] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs-cc
[130.014971] Starting dynamic subtest: pipe-A-HDMI-A-4
[130.022616] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.001s)
[130.031390] Starting dynamic subtest: pipe-B-HDMI-A-4
[130.038943] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.001s)
[130.047397] Starting dynamic subtest: pipe-C-HDMI-A-4
[130.055010] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.001s)
[130.063327] Starting dynamic subtest: pipe-D-HDMI-A-4
[130.071511] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.001s)
[130.072467] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs-cc: SUCCESS (0.009s)
[130.248912] [016/133] (899s left) gem_ctx_bad_destroy (invalid-default-ctx)
[130.292918] Starting subtest: invalid-default-ctx
[130.293753] Subtest invalid-default-ctx: SUCCESS (0.000s)
[130.414476] [017/133] (898s left) gem_fence_thrash (bo-write-verify-threaded-y)
[130.454196] Starting subtest: bo-write-verify-threaded-y
[130.458476] Subtest bo-write-verify-threaded-y: SKIP (0.002s)
[130.526674] [018/133] (898s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt)
[132.013827] Starting subtest: fbcpsr-farfromfence-mmap-gtt
[132.015515] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s)
[132.202079] [019/133] (897s left) kms_color_pipeline (plane-lut1d-lut1d)
[133.689509] Starting subtest: plane-lut1d-lut1d
[133.887474] Starting dynamic subtest: pipe-A-plane-0
[134.137516] Dynamic subtest pipe-A-plane-0: SUCCESS (0.250s)
[134.174061] Starting dynamic subtest: pipe-A-plane-1
[134.354218] Dynamic subtest pipe-A-plane-1: SUCCESS (0.215s)
[134.374034] Starting dynamic subtest: pipe-A-plane-2
[134.554220] Dynamic subtest pipe-A-plane-2: SUCCESS (0.199s)
[134.827512] Starting dynamic subtest: pipe-B-plane-0
[134.984399] Dynamic subtest pipe-B-plane-0: SUCCESS (0.167s)
[135.016925] Starting dynamic subtest: pipe-B-plane-1
[135.184391] Dynamic subtest pipe-B-plane-1: SUCCESS (0.199s)
[135.214154] Starting dynamic subtest: pipe-B-plane-2
[135.401196] Dynamic subtest pipe-B-plane-2: SUCCESS (0.215s)
[135.687266] Starting dynamic subtest: pipe-C-plane-0
[135.839848] Dynamic subtest pipe-C-plane-0: SUCCESS (0.183s)
[135.869157] Starting dynamic subtest: pipe-C-plane-1
[136.056650] Dynamic subtest pipe-C-plane-1: SUCCESS (0.215s)
[136.081594] Starting dynamic subtest: pipe-C-plane-2
[136.273368] Dynamic subtest pipe-C-plane-2: SUCCESS (0.215s)
[136.585880] Starting dynamic subtest: pipe-D-plane-0
[136.778134] Dynamic subtest pipe-D-plane-0: SUCCESS (0.216s)
[136.805359] Starting dynamic subtest: pipe-D-plane-1
[136.994617] Dynamic subtest pipe-D-plane-1: SUCCESS (0.215s)
[137.024320] Starting dynamic subtest: pipe-D-plane-2
[137.211245] Dynamic subtest pipe-D-plane-2: SUCCESS (0.215s)
[137.265727] Subtest plane-lut1d-lut1d: SUCCESS (3.577s)
[137.445157] [020/133] (892s left) gem_ctx_shared (create-shared-gtt)
[137.501870] Starting subtest: create-shared-gtt
[139.656840] Subtest create-shared-gtt: SUCCESS (2.152s)
[140.465284] [021/133] (889s left) gem_exec_create (basic)
[140.519908] Starting subtest: basic
[140.520860] Starting dynamic subtest: smem
[142.620866] Dynamic subtest smem: SUCCESS (2.101s)
[142.631265] Starting dynamic subtest: lmem0
[144.719415] Dynamic subtest lmem0: SUCCESS (2.098s)
[144.720505] Subtest basic: SUCCESS (4.200s)
[144.983516] [022/133] (884s left) syncobj_timeline (single-wait-signaled)
[145.029248] Starting subtest: single-wait-signaled
[145.030077] Subtest single-wait-signaled: SUCCESS (0.001s)
[145.147108] [023/133] (884s left) kms_chamelium_audio (dp-audio)
[146.669027] Subtest dp-audio: SKIP (0.000s)
[146.777411] [024/133] (883s left) gem_pwrite_snooped
[146.926212] [025/133] (883s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-render)
[148.412487] Starting subtest: fbc-rgb101010-draw-render
[151.383835] Subtest fbc-rgb101010-draw-render: SUCCESS (2.971s)
[151.553070] [026/133] (878s left) perf (gen12-invalid-class-instance)
[151.683159] Starting subtest: gen12-invalid-class-instance
[151.704526] Subtest gen12-invalid-class-instance: SUCCESS (0.022s)
[151.778711] [027/133] (878s left) kms_psr (fbc-psr-primary-page-flip)
[153.265592] Subtest fbc-psr-primary-page-flip: SKIP (0.000s)
[153.343573] [028/133] (876s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[154.850701] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip
[155.986993] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.132s)
[156.155737] [029/133] (874s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-fullscreen)
[157.643263] Starting subtest: fbc-2p-primscrn-spr-indfb-fullscreen
[157.645280] Subtest fbc-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[157.834255] [030/133] (872s left) gem_exec_params (sol-reset-invalid)
[157.883903] Starting subtest: sol-reset-invalid
[157.886993] Subtest sol-reset-invalid: SUCCESS (0.002s)
[158.082590] [031/133] (872s left) gem_mmap_gtt (zero-extend)
[158.126761] Subtest zero-extend: SKIP (0.000s)
[158.207013] [032/133] (872s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0)
[159.708571] Starting subtest: linear-max-hw-stride-64bpp-rotate-0
[160.803762] Subtest linear-max-hw-stride-64bpp-rotate-0: SUCCESS (1.091s)
[160.992769] [033/133] (869s left) kms_rotation_crc (primary-x-tiled-reflect-x-0)
[162.474273] Starting subtest: primary-x-tiled-reflect-x-0
[173.112486] Subtest primary-x-tiled-reflect-x-0: SUCCESS (10.637s)
[173.342471] [034/133] (857s left) kms_big_fb (linear-32bpp-rotate-0)
[174.844539] Starting subtest: linear-32bpp-rotate-0
[176.849197] Subtest linear-32bpp-rotate-0: SUCCESS (2.001s)
[177.028799] [035/133] (853s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling)
[178.511109] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling
[178.513357] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SKIP (0.000s)
[178.648966] [036/133] (852s left) kms_ccs (crc-primary-basic-yf-tiled-ccs)
[180.142331] Starting subtest: crc-primary-basic-yf-tiled-ccs
[180.143391] Starting dynamic subtest: pipe-A-HDMI-A-4
[180.152904] Dynamic subtest pipe-A-HDMI-A-4: SKIP (0.001s)
[180.162400] Starting dynamic subtest: pipe-B-HDMI-A-4
[180.171992] Dynamic subtest pipe-B-HDMI-A-4: SKIP (0.001s)
[180.181317] Starting dynamic subtest: pipe-C-HDMI-A-4
[180.191177] Dynamic subtest pipe-C-HDMI-A-4: SKIP (0.001s)
[180.200105] Starting dynamic subtest: pipe-D-HDMI-A-4
[180.210150] Dynamic subtest pipe-D-HDMI-A-4: SKIP (0.001s)
[180.212191] Subtest crc-primary-basic-yf-tiled-ccs: SKIP (0.010s)
[180.387934] [037/133] (850s left) kms_plane (pixel-format-x-tiled-modifier)
[181.870486] Starting subtest: pixel-format-x-tiled-modifier
[181.907251] Starting dynamic subtest: pipe-A-plane-0
[183.007723] Dynamic subtest pipe-A-plane-0: SUCCESS (1.100s)
[183.046424] Starting dynamic subtest: pipe-A-plane-3
[183.857176] Dynamic subtest pipe-A-plane-3: SUCCESS (0.848s)
[183.866461] Starting dynamic subtest: pipe-A-plane-5
[184.557963] Dynamic subtest pipe-A-plane-5: SUCCESS (0.700s)
[184.584803] Starting dynamic subtest: pipe-A-plane-7
[184.587816] Dynamic subtest pipe-A-plane-7: SKIP (0.000s)
[184.732408] Starting dynamic subtest: pipe-B-plane-0
[185.708208] Dynamic subtest pipe-B-plane-0: SUCCESS (0.983s)
[185.749986] Starting dynamic subtest: pipe-B-plane-3
[186.590558] Dynamic subtest pipe-B-plane-3: SUCCESS (0.881s)
[186.601160] Starting dynamic subtest: pipe-B-plane-5
[187.274483] Dynamic subtest pipe-B-plane-5: SUCCESS (0.683s)
[187.287678] Starting dynamic subtest: pipe-B-plane-7
[187.289693] Dynamic subtest pipe-B-plane-7: SKIP (0.000s)
[187.312541] Subtest pixel-format-x-tiled-modifier: SUCCESS (5.442s)
[187.528992] [038/133] (843s left) kms_psr (psr2-primary-render)
[189.013161] Subtest psr2-primary-render: SKIP (0.000s)
[189.088905] [039/133] (841s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[190.572743] Starting subtest: cursor-vs-flip-atomic
[222.336525] Subtest cursor-vs-flip-atomic: SUCCESS (31.764s)
[222.504702] [040/133] (808s left) gem_ctx_freq (sysfs)
[222.556916] Starting subtest: sysfs
[222.557844] Starting dynamic subtest: gt0
[228.196761] Dynamic subtest gt0: SUCCESS (5.639s)
[228.199179] Subtest sysfs: SUCCESS (5.642s)
[228.382646] [041/133] (802s left) gem_lmem_swapping (heavy-verify-multi)
[232.507673] Starting subtest: heavy-verify-multi
[232.508525] Starting dynamic subtest: lmem0
[247.365396] Dynamic subtest lmem0: SUCCESS (14.854s)
[247.366387] Subtest heavy-verify-multi: SUCCESS (14.855s)
[248.553176] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[248.554379] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: kernel.kmod_is_loaded.i915: true
[248.556918] [042/133] (782s left) kms_plane_multiple (tiling-none)
[253.253541] Starting subtest: tiling-none
[253.254483] Starting dynamic subtest: pipe-A-HDMI-A-4
[254.093049] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.838s)
[254.104331] Starting dynamic subtest: pipe-B-HDMI-A-4
[254.844416] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.750s)
[254.857700] Starting dynamic subtest: pipe-C-HDMI-A-4
[255.615557] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.770s)
[255.627063] Starting dynamic subtest: pipe-D-HDMI-A-4
[256.329141] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.711s)
[256.329983] Subtest tiling-none: SUCCESS (3.076s)
[256.566427] [FACT kms_plane_multiple (tiling-none)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[256.569714] [FACT kms_plane_multiple (tiling-none)] new: kernel.kmod_is_loaded.i915: true
[256.573256] [043/133] (774s left) gem_partial_pwrite_pread (reads)
[256.630213] Subtest reads: SKIP (0.000s)
[256.721329] [044/133] (774s left) kms_ccs (crc-primary-suspend-4-tiled-lnl-ccs)
[258.205135] Starting subtest: crc-primary-suspend-4-tiled-lnl-ccs
[258.206902] Subtest crc-primary-suspend-4-tiled-lnl-ccs: SKIP (0.000s)
[258.398938] [045/133] (773s left) core_getclient (basic)
[258.477030] Starting subtest: basic
[258.477906] Subtest basic: SUCCESS (0.000s)
[258.590497] [046/133] (772s left) gem_eio (create)
[258.752863] Starting subtest: create
[258.980616] Subtest create: SUCCESS (0.229s)
[260.566407] [047/133] (771s left) gem_exec_schedule (smoketest)
[260.789775] Starting subtest: smoketest
[260.791139] Starting dynamic subtest: rcs0
[266.262844] Dynamic subtest rcs0: SUCCESS (5.463s)
[266.275233] Starting dynamic subtest: bcs0
[271.701290] Dynamic subtest bcs0: SUCCESS (5.437s)
[271.712939] Starting dynamic subtest: vcs0
[277.138740] Dynamic subtest vcs0: SUCCESS (5.440s)
[277.149454] Starting dynamic subtest: vcs1
[282.588761] Dynamic subtest vcs1: SUCCESS (5.444s)
[282.599578] Starting dynamic subtest: vecs0
[288.034980] Dynamic subtest vecs0: SUCCESS (5.445s)
[288.036289] Subtest smoketest: SUCCESS (27.236s)
[288.356852] [048/133] (743s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[289.841055] Starting subtest: basic-flip-after-cursor-legacy
[290.811993] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.972s)
[291.001376] [049/133] (740s left) kms_cursor_edge_walk (64x64-top-edge)
[292.484137] Starting subtest: 64x64-top-edge
[292.486309] Starting dynamic subtest: pipe-A-HDMI-A-4
[295.784410] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (3.299s)
[295.797094] Starting dynamic subtest: pipe-D-HDMI-A-4
[299.000896] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (3.214s)
[299.001869] Subtest 64x64-top-edge: SUCCESS (6.518s)
[299.178161] [050/133] (732s left) syncobj_eventfd (binary-wait-before-signal)
[299.223732] Starting subtest: binary-wait-before-signal
[299.254445] Subtest binary-wait-before-signal: SUCCESS (0.031s)
[299.409432] [051/133] (732s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled)
[299.454862] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[299.455831] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[299.562788] [052/133] (732s left) core_auth (basic-auth)
[299.607464] Starting subtest: basic-auth
[299.608289] Subtest basic-auth: SUCCESS (0.001s)
[299.738435] [053/133] (732s left) kms_flip (flip-vs-panning)
[301.222858] Starting subtest: flip-vs-panning
[301.229466] Starting dynamic subtest: A-HDMI-A4
[308.989216] Dynamic subtest A-HDMI-A4: SUCCESS (7.758s)
[309.032212] Starting dynamic subtest: B-HDMI-A4
[316.716220] Dynamic subtest B-HDMI-A4: SUCCESS (7.720s)
[316.729217] Starting dynamic subtest: C-HDMI-A4
[324.411283] Dynamic subtest C-HDMI-A4: SUCCESS (7.692s)
[324.456126] Starting dynamic subtest: D-HDMI-A4
[332.141198] Dynamic subtest D-HDMI-A4: SUCCESS (7.722s)
[332.148919] Subtest flip-vs-panning: SUCCESS (30.922s)
[332.360092] [054/133] (699s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[333.844503] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[333.848172] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.003s)
[333.966389] [055/133] (698s left) gem_cs_tlb (engines)
[334.023778] Starting subtest: engines
[334.024679] Starting dynamic subtest: rcs0
[336.181318] Dynamic subtest rcs0: SUCCESS (2.153s)
[336.193169] Starting dynamic subtest: bcs0
[338.336177] Dynamic subtest bcs0: SUCCESS (2.153s)
[338.347045] Starting dynamic subtest: vcs0
[340.490665] Dynamic subtest vcs0: SUCCESS (2.153s)
[340.501640] Starting dynamic subtest: vcs1
[342.645857] Dynamic subtest vcs1: SUCCESS (2.154s)
[342.656626] Starting dynamic subtest: vecs0
[344.799702] Dynamic subtest vecs0: SUCCESS (2.152s)
[344.800774] Subtest engines: SUCCESS (10.773s)
[344.961880] [056/133] (687s left) gem_vm_create (isolation)
[345.013169] Starting subtest: isolation
[345.022401] Subtest isolation: SUCCESS (0.010s)
[345.189457] [057/133] (687s left) kms_frontbuffer_tracking (psr-1p-pri-indfb-multidraw)
[346.676272] Starting subtest: psr-1p-pri-indfb-multidraw
[346.677967] Subtest psr-1p-pri-indfb-multidraw: SKIP (0.000s)
[346.857589] [058/133] (685s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc)
[348.348259] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc
[348.352234] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[348.508416] [059/133] (684s left) kms_content_protection (dp-mst-type-0-suspend-resume)
[350.053314] Starting subtest: dp-mst-type-0-suspend-resume
[350.055036] Subtest dp-mst-type-0-suspend-resume: SKIP (0.000s)
[350.269662] [060/133] (682s left) gen9_exec_parse (bb-start-param)
[350.319373] Subtest bb-start-param: SKIP (0.000s)
[350.405578] [061/133] (682s left) kms_flip (flip-vs-dpms-off-vs-modeset)
[351.889346] Starting subtest: flip-vs-dpms-off-vs-modeset
[351.896421] Starting dynamic subtest: A-HDMI-A4
[352.614931] Dynamic subtest A-HDMI-A4: SUCCESS (0.718s)
[352.625922] Starting dynamic subtest: B-HDMI-A4
[353.297730] Dynamic subtest B-HDMI-A4: SUCCESS (0.682s)
[353.310807] Starting dynamic subtest: C-HDMI-A4
[353.999792] Dynamic subtest C-HDMI-A4: SUCCESS (0.700s)
[354.012423] Starting dynamic subtest: D-HDMI-A4
[354.704663] Dynamic subtest D-HDMI-A4: SUCCESS (0.701s)
[354.705647] Subtest flip-vs-dpms-off-vs-modeset: SUCCESS (2.816s)
[354.896659] [062/133] (677s left) kms_psr (fbc-psr2-cursor-mmap-gtt)
[356.381386] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.000s)
[356.454823] [063/133] (676s left) core_getversion (all-cards)
[356.498928] Starting subtest: all-cards
[356.525601] Subtest all-cards: SUCCESS (0.027s)
[356.608076] [064/133] (676s left) gem_ringfill (legacy-basic)
[357.017034] Starting subtest: legacy-basic
[357.024926] Starting dynamic subtest: default
[357.106777] Dynamic subtest default: SUCCESS (0.086s)
[357.139141] Starting dynamic subtest: render
[357.155515] Dynamic subtest render: SUCCESS (0.045s)
[357.185303] Starting dynamic subtest: bsd
[357.205100] Dynamic subtest bsd: SUCCESS (0.045s)
[357.224328] Starting dynamic subtest: bsd1
[357.246917] Dynamic subtest bsd1: SUCCESS (0.040s)
[357.261586] Starting dynamic subtest: bsd2
[357.290141] Dynamic subtest bsd2: SUCCESS (0.041s)
[357.309214] Starting dynamic subtest: blt
[357.335165] Dynamic subtest blt: SUCCESS (0.043s)
[357.356736] Starting dynamic subtest: vebox
[357.379971] Dynamic subtest vebox: SUCCESS (0.042s)
[357.383292] Subtest legacy-basic: SUCCESS (0.365s)
[357.565821] [065/133] (675s left) gem_media_fill (media-fill)
[357.618045] Starting subtest: media-fill
[357.618924] Starting dynamic subtest: smem
[357.640281] Dynamic subtest smem: SUCCESS (0.022s)
[357.654448] Starting dynamic subtest: lmem0
[357.655284] Dynamic subtest lmem0: SUCCESS (0.010s)
[357.656184] Subtest media-fill: SUCCESS (0.035s)
[357.952329] [066/133] (675s left) perf_pmu (render-node-busy)
[358.004810] Starting subtest: render-node-busy
[358.005731] Starting dynamic subtest: rcs0
[358.603914] Dynamic subtest rcs0: SUCCESS (0.598s)
[358.619679] Starting dynamic subtest: bcs0
[359.169962] Dynamic subtest bcs0: SUCCESS (0.564s)
[359.185356] Starting dynamic subtest: vcs0
[359.728815] Dynamic subtest vcs0: SUCCESS (0.557s)
[359.744198] Starting dynamic subtest: vcs1
[360.290512] Dynamic subtest vcs1: SUCCESS (0.558s)
[360.306529] Starting dynamic subtest: vecs0
[360.857518] Dynamic subtest vecs0: SUCCESS (0.561s)
[360.862883] Subtest render-node-busy: SUCCESS (2.856s)
[361.012077] [067/133] (672s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-plflip-blt)
[362.500159] Starting subtest: fbc-2p-primscrn-indfb-plflip-blt
[362.501968] Subtest fbc-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[362.651718] [068/133] (670s left) gem_partial_pwrite_pread (write-display)
[362.710917] Subtest write-display: SKIP (0.000s)
[362.805776] [069/133] (670s left) gem_userptr_blits (dmabuf-sync)
[362.867704] Starting subtest: dmabuf-sync
[362.870215] Subtest dmabuf-sync: SKIP (0.003s)
[363.098182] [070/133] (670s left) i915_pm_rps (basic-api)
[363.152366] Starting subtest: basic-api
[363.154228] Subtest basic-api: SKIP (0.001s)
[363.271494] [071/133] (670s left) syncobj_basic (bad-handle-to-fd)
[363.316830] Starting subtest: bad-handle-to-fd
[363.317786] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[363.430193] [072/133] (670s left) sysfs_preempt_timeout (idempotent)
[363.479687] Starting subtest: idempotent
[363.482309] Starting dynamic subtest: vecs0
[363.483267] Dynamic subtest vecs0: SUCCESS (0.001s)
[363.494545] Starting dynamic subtest: vcs0
[363.495485] Dynamic subtest vcs0: SUCCESS (0.001s)
[363.506693] Starting dynamic subtest: bcs0
[363.507651] Dynamic subtest bcs0: SUCCESS (0.001s)
[363.519051] Starting dynamic subtest: rcs0
[363.520352] Dynamic subtest rcs0: SUCCESS (0.001s)
[363.531540] Starting dynamic subtest: vcs1
[363.532798] Dynamic subtest vcs1: SUCCESS (0.001s)
[363.534116] Subtest idempotent: SUCCESS (0.013s)
[363.608318] [073/133] (670s left) gem_pxp (reject-modify-context-protection-off-2)
[366.177286] Starting subtest: reject-modify-context-protection-off-2
[366.179484] Subtest reject-modify-context-protection-off-2: SKIP (0.000s)
[366.306296] [074/133] (667s left) gem_exec_reloc (basic-wc-gtt-noreloc)
[366.356043] Subtest basic-wc-gtt-noreloc: SKIP (0.000s)
[366.454976] [075/133] (667s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted)
[366.502468] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted
[366.609555] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.104s)
[366.758132] [076/133] (667s left) syncobj_basic (bad-flags-handle-to-fd)
[366.803113] Starting subtest: bad-flags-handle-to-fd
[366.804087] Subtest bad-flags-handle-to-fd: SUCCESS (0.000s)
[366.909911] [077/133] (667s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[368.397927] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[368.402197] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[368.559827] [078/133] (665s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0)
[370.067120] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0
[371.309905] Subtest x-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.242s)
[371.517589] [079/133] (662s left) gem_exec_balancer (sliced)
[371.576879] Starting subtest: sliced
[371.578989] Subtest sliced: SKIP (0.000s)
[372.008738] [080/133] (662s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[373.494461] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (0.000s)
[373.571990] [081/133] (660s left) syncobj_timeline (multi-wait-for-submit-signaled)
[373.617535] Starting subtest: multi-wait-for-submit-signaled
[373.618487] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[373.726972] [082/133] (660s left) syncobj_wait (multi-wait-signaled)
[373.772135] Starting subtest: multi-wait-signaled
[373.773164] Subtest multi-wait-signaled: SUCCESS (0.000s)
[373.918985] [083/133] (660s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-pwrite)
[375.406925] Starting subtest: fbcpsr-rgb101010-draw-pwrite
[375.408792] Subtest fbcpsr-rgb101010-draw-pwrite: SKIP (0.000s)
[375.588903] [084/133] (659s left) kms_big_fb (yf-tiled-32bpp-rotate-90)
[377.093256] Starting subtest: yf-tiled-32bpp-rotate-90
[377.094911] Subtest yf-tiled-32bpp-rotate-90: SKIP (0.000s)
[377.260224] [085/133] (657s left) kms_big_fb (y-tiled-8bpp-rotate-270)
[378.765760] Starting subtest: y-tiled-8bpp-rotate-270
[378.860892] Subtest y-tiled-8bpp-rotate-270: SKIP (0.094s)
[379.009582] [086/133] (655s left) gem_exec_reloc (basic-write-read-noreloc)
[379.061378] Subtest basic-write-read-noreloc: SKIP (0.000s)
[379.154908] [087/133] (655s left) kms_dsc (dsc-with-output-formats)
[380.639265] Starting subtest: dsc-with-output-formats
[380.647423] Subtest dsc-with-output-formats: SKIP (0.001s)
[380.781339] [088/133] (654s left) kms_chamelium_color (gamma)
[382.275500] Subtest gamma: SKIP (0.000s)
[382.354665] [089/133] (652s left) kms_psr (psr-suspend)
[383.841043] Subtest psr-suspend: SKIP (0.000s)
[383.920465] [090/133] (651s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[385.409100] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc
[385.410843] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[385.588467] [091/133] (649s left) kms_vblank (accuracy-idle)
[387.073262] Starting subtest: accuracy-idle
[387.074200] Starting dynamic subtest: pipe-A-HDMI-A-4
[389.431040] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (2.356s)
[389.445938] Starting dynamic subtest: pipe-D-HDMI-A-4
[391.605995] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (2.170s)
[391.606926] Subtest accuracy-idle: SUCCESS (4.535s)
[391.804154] [092/133] (643s left) kms_async_flips (async-flip-suspend-resume)
[393.289740] Starting subtest: async-flip-suspend-resume
[393.495045] Starting dynamic subtest: pipe-A-HDMI-A-4
[415.419781] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (11.459s)
[415.598181] Starting dynamic subtest: pipe-B-HDMI-A-4
[438.376000] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (10.911s)
[438.534356] Starting dynamic subtest: pipe-C-HDMI-A-4
[461.377835] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (11.016s)
[461.544973] Starting dynamic subtest: pipe-D-HDMI-A-4
[484.395305] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (10.915s)
[484.396651] Subtest async-flip-suspend-resume: SUCCESS (44.981s)
[490.749735] [093/133] (550s left) kms_psr (psr2-cursor-blt)
[492.891229] Subtest psr2-cursor-blt: SKIP (0.000s)
[492.980956] [094/133] (548s left) kms_plane (plane-position-covered)
[494.465867] Starting subtest: plane-position-covered
[494.939738] Starting dynamic subtest: pipe-A-plane-1
[495.315388] Dynamic subtest pipe-A-plane-1: SUCCESS (0.375s)
[495.328964] Starting dynamic subtest: pipe-A-plane-2
[495.676297] Dynamic subtest pipe-A-plane-2: SUCCESS (0.360s)
[495.690414] Starting dynamic subtest: pipe-A-plane-3
[496.036223] Dynamic subtest pipe-A-plane-3: SUCCESS (0.358s)
[496.050350] Starting dynamic subtest: pipe-A-plane-4
[496.413023] Dynamic subtest pipe-A-plane-4: SUCCESS (0.376s)
[496.428742] Starting dynamic subtest: pipe-A-plane-5
[496.790816] Dynamic subtest pipe-A-plane-5: SUCCESS (0.375s)
[496.804332] Starting dynamic subtest: pipe-A-plane-6
[497.168109] Dynamic subtest pipe-A-plane-6: SUCCESS (0.376s)
[497.182427] Starting dynamic subtest: pipe-A-plane-7
[497.190361] Dynamic subtest pipe-A-plane-7: SUCCESS (0.021s)
[497.481423] Starting dynamic subtest: pipe-B-plane-1
[497.841155] Dynamic subtest pipe-B-plane-1: SUCCESS (0.373s)
[497.855217] Starting dynamic subtest: pipe-B-plane-2
[498.203495] Dynamic subtest pipe-B-plane-2: SUCCESS (0.361s)
[498.218481] Starting dynamic subtest: pipe-B-plane-3
[498.563581] Dynamic subtest pipe-B-plane-3: SUCCESS (0.358s)
[498.578489] Starting dynamic subtest: pipe-B-plane-4
[498.926351] Dynamic subtest pipe-B-plane-4: SUCCESS (0.361s)
[498.944314] Starting dynamic subtest: pipe-B-plane-5
[499.301149] Dynamic subtest pipe-B-plane-5: SUCCESS (0.372s)
[499.314956] Starting dynamic subtest: pipe-B-plane-6
[499.674301] Dynamic subtest pipe-B-plane-6: SUCCESS (0.372s)
[499.688303] Starting dynamic subtest: pipe-B-plane-7
[499.700926] Dynamic subtest pipe-B-plane-7: SUCCESS (0.024s)
[499.701878] Subtest plane-position-covered: SUCCESS (5.235s)
[499.918668] [095/133] (541s left) kms_joiner (basic-force-big-joiner)
[501.407962] Starting subtest: basic-force-big-joiner
[501.409826] Subtest basic-force-big-joiner: SKIP (0.000s)
[501.522807] [096/133] (540s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic)
[503.013706] Starting subtest: 2x-cursor-vs-flip-atomic
[503.016704] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.003s)
[503.151574] [097/133] (538s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[504.692640] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[504.804632] [098/133] (537s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-render)
[506.294491] Starting subtest: psr-1p-offscreen-pri-indfb-draw-render
[506.296212] Subtest psr-1p-offscreen-pri-indfb-draw-render: SKIP (0.000s)
[506.469565] [099/133] (535s left) kms_pipe_stress (stress-xrgb8888-4tiled)
[507.960481] Starting subtest: stress-xrgb8888-4tiled
[507.962467] Subtest stress-xrgb8888-4tiled: SKIP (0.000s)
[508.053703] [100/133] (533s left) kms_pm_dc (dc6-psr)
[510.547233] Starting subtest: dc6-psr
[510.549264] Subtest dc6-psr: SKIP (0.000s)
[510.665876] [101/133] (531s left) kms_cursor_crc (cursor-alpha-transparent)
[512.158410] Starting subtest: cursor-alpha-transparent
[512.160761] Starting dynamic subtest: pipe-A-HDMI-A-4
[512.861362] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.701s)
[512.876437] Starting dynamic subtest: pipe-D-HDMI-A-4
[513.303107] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.439s)
[513.304244] Subtest cursor-alpha-transparent: SUCCESS (1.146s)
[514.004494] [102/133] (528s left) i915_drm_fdinfo (virtual-busy-hang)
[514.056830] Starting subtest: virtual-busy-hang
[514.058779] Subtest virtual-busy-hang: SKIP (0.000s)
[514.177684] [103/133] (528s left) kms_psr2_su (page_flip-xrgb8888)
[514.222171] Subtest page_flip-XRGB8888: SKIP (0.000s)
[514.298547] [104/133] (528s left) kms_force_connector_basic (force-connector-state)
[514.427837] Starting subtest: force-connector-state
[516.185998] Subtest force-connector-state: SUCCESS (1.757s)
[517.888108] [105/133] (524s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-downscaling)
[519.375852] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-downscaling
[519.377550] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-downscaling: SKIP (0.000s)
[519.489681] [106/133] (522s left) gem_tiled_blits (basic)
[519.542956] Subtest basic: SKIP (0.000s)
[519.632522] [107/133] (522s left) gem_userptr_blits (access-control)
[519.702895] Starting subtest: access-control
[519.704916] Subtest access-control: SKIP (0.000s)
[519.905014] [108/133] (522s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[521.394450] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu
[521.396040] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[521.593814] [109/133] (521s left) gem_exec_fence (syncobj-timeline-chain-engines)
[522.153552] Starting subtest: syncobj-timeline-chain-engines
[522.287578] Subtest syncobj-timeline-chain-engines: SUCCESS (0.134s)
[522.643421] [110/133] (520s left) gem_ccs (block-copy-uncompressed)
[522.693511] Starting subtest: block-copy-uncompressed
[522.695930] Starting dynamic subtest: linear-uncompressed-compfmt0-smem-smem
[522.729603] Dynamic subtest linear-uncompressed-compfmt0-smem-smem: SUCCESS (0.035s)
[522.745114] Starting dynamic subtest: linear-uncompressed-compfmt0-smem-lmem0
[522.747140] Dynamic subtest linear-uncompressed-compfmt0-smem-lmem0: SUCCESS (0.016s)
[522.762721] Starting dynamic subtest: linear-uncompressed-compfmt0-lmem0-smem
[522.810189] Dynamic subtest linear-uncompressed-compfmt0-lmem0-smem: SUCCESS (0.062s)
[522.825532] Starting dynamic subtest: linear-uncompressed-compfmt0-lmem0-lmem0
[522.871358] Dynamic subtest linear-uncompressed-compfmt0-lmem0-lmem0: SUCCESS (0.060s)
[522.886855] Starting dynamic subtest: ymajor-uncompressed-compfmt0-smem-smem
[522.889375] Dynamic subtest ymajor-uncompressed-compfmt0-smem-smem: SUCCESS (0.016s)
[522.904728] Starting dynamic subtest: ymajor-uncompressed-compfmt0-smem-lmem0
[522.905631] Dynamic subtest ymajor-uncompressed-compfmt0-smem-lmem0: SUCCESS (0.014s)
[522.920998] Starting dynamic subtest: ymajor-uncompressed-compfmt0-lmem0-smem
[522.967164] Dynamic subtest ymajor-uncompressed-compfmt0-lmem0-smem: SUCCESS (0.060s)
[522.982426] Starting dynamic subtest: ymajor-uncompressed-compfmt0-lmem0-lmem0
[523.027726] Dynamic subtest ymajor-uncompressed-compfmt0-lmem0-lmem0: SUCCESS (0.059s)
[523.028624] Subtest block-copy-uncompressed: SUCCESS (0.335s)
[523.235852] [111/133] (519s left) kms_big_fb (4-tiled-64bpp-rotate-270)
[524.739104] Starting subtest: 4-tiled-64bpp-rotate-270
[524.741255] Subtest 4-tiled-64bpp-rotate-270: SKIP (0.000s)
[524.913990] [112/133] (518s left) gem_exec_schedule (preemptive-hang)
[525.110131] Starting subtest: preemptive-hang
[525.112110] Starting dynamic subtest: rcs0
[534.185334] Dynamic subtest rcs0: SUCCESS (9.075s)
[534.199287] Starting dynamic subtest: bcs0
[543.204658] Dynamic subtest bcs0: SUCCESS (9.018s)
[543.218579] Starting dynamic subtest: vcs0
[552.172352] Dynamic subtest vcs0: SUCCESS (8.967s)
[552.187853] Starting dynamic subtest: vcs1
[561.197479] Dynamic subtest vcs1: SUCCESS (9.023s)
[561.211572] Starting dynamic subtest: vecs0
[570.213545] Dynamic subtest vecs0: SUCCESS (9.015s)
[570.214322] Subtest preemptive-hang: SUCCESS (45.108s)
[570.531557] [113/133] (472s left) kms_pm_rpm (universal-planes)
[574.149832] Starting subtest: universal-planes
[574.157275] Starting dynamic subtest: plane-34
[581.164404] Dynamic subtest plane-34: SUCCESS (7.010s)
[581.242431] Starting dynamic subtest: plane-64
[588.107537] Dynamic subtest plane-64: SUCCESS (6.935s)
[588.193704] Starting dynamic subtest: plane-94
[595.124282] Dynamic subtest plane-94: SUCCESS (7.009s)
[595.201256] Starting dynamic subtest: plane-124
[602.023532] Dynamic subtest plane-124: SUCCESS (6.891s)
[602.100375] Starting dynamic subtest: plane-134
[608.960796] Dynamic subtest plane-134: SUCCESS (6.929s)
[609.037584] Starting dynamic subtest: plane-144
[615.866742] Dynamic subtest plane-144: SUCCESS (6.898s)
[615.945154] Starting dynamic subtest: plane-154
[622.820596] Dynamic subtest plane-154: SUCCESS (6.946s)
[622.898044] Starting dynamic subtest: plane-164
[629.798033] Dynamic subtest plane-164: SUCCESS (6.970s)
[629.807125] Subtest universal-planes: SUCCESS (55.652s)
[630.786187] [114/133] (412s left) gem_spin_batch (spin-all-new)
[630.844502] Starting subtest: spin-all-new
[630.883617] Subtest spin-all-new: SUCCESS (0.039s)
[631.232612] [115/133] (412s left) gem_exec_reloc (basic-gtt-read-active)
[631.283691] Subtest basic-gtt-read-active: SKIP (0.000s)
[631.401357] [116/133] (412s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[631.447327] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[631.448247] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[631.575731] [117/133] (411s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic)
[633.060415] Starting subtest: 2x-long-flip-vs-cursor-atomic
[633.063724] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.003s)
[633.204302] [118/133] (410s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen)
[634.706555] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen
[634.708506] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[634.905360] [119/133] (408s left) perf_pmu (semaphore-busy)
[634.954638] Starting subtest: semaphore-busy
[634.955486] Starting dynamic subtest: rcs0
[636.611285] Dynamic subtest rcs0: SUCCESS (1.651s)
[636.625581] Starting dynamic subtest: bcs0
[638.262742] Dynamic subtest bcs0: SUCCESS (1.646s)
[638.277030] Starting dynamic subtest: vcs0
[639.911668] Dynamic subtest vcs0: SUCCESS (1.643s)
[639.925881] Starting dynamic subtest: vcs1
[641.561796] Dynamic subtest vcs1: SUCCESS (1.645s)
[641.576172] Starting dynamic subtest: vecs0
[643.212799] Dynamic subtest vecs0: SUCCESS (1.646s)
[643.213897] Subtest semaphore-busy: SUCCESS (8.258s)
[643.383627] [120/133] (400s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area)
[644.870823] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[644.947370] [121/133] (398s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-blt)
[646.436941] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-blt
[646.438806] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[646.606949] [122/133] (397s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen)
[648.097572] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen
[648.099189] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[648.279953] [123/133] (395s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted)
[648.325897] Starting subtest: multi-wait-all-for-submit-available-submitted
[648.326905] Subtest multi-wait-all-for-submit-available-submitted: SUCCESS (0.001s)
[648.434687] [124/133] (395s left) api_intel_allocator (two-level-inception)
[648.479123] Starting subtest: two-level-inception
[653.914109] Subtest two-level-inception: SUCCESS (5.432s)
[654.122406] [125/133] (390s left) kms_async_flips (test-time-stamp)
[655.607554] Starting subtest: test-time-stamp
[655.830023] Starting dynamic subtest: pipe-A-HDMI-A-4
[656.216643] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.386s)
[656.431777] Starting dynamic subtest: pipe-B-HDMI-A-4
[656.515611] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.096s)
[656.710044] Starting dynamic subtest: pipe-C-HDMI-A-4
[656.797891] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.100s)
[657.002263] Starting dynamic subtest: pipe-D-HDMI-A-4
[657.086119] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.096s)
[657.087029] Subtest test-time-stamp: SUCCESS (1.480s)
[657.489290] [126/133] (386s left) drm_read (empty-nonblock)
[659.035665] Starting subtest: empty-nonblock
[659.036584] Subtest empty-nonblock: SUCCESS (0.000s)
[659.292725] [127/133] (385s left) kms_lease (lease-again)
[660.777084] Starting subtest: lease-again
[660.778104] Starting dynamic subtest: pipe-A-HDMI-A-4
[660.780952] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.003s)
[660.797699] Starting dynamic subtest: pipe-B-HDMI-A-4
[660.798634] Dynamic subtest pipe-B-HDMI-A-4: SUCCESS (0.002s)
[660.812986] Starting dynamic subtest: pipe-C-HDMI-A-4
[660.814134] Dynamic subtest pipe-C-HDMI-A-4: SUCCESS (0.002s)
[660.828351] Starting dynamic subtest: pipe-D-HDMI-A-4
[660.829450] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.003s)
[660.830544] Subtest lease-again: SUCCESS (0.021s)
[661.016953] [128/133] (383s left) gem_exec_balancer (indices)
[661.073938] Starting subtest: indices
[663.161326] Subtest indices: SUCCESS (2.087s)
[663.602213] [129/133] (381s left) kms_cursor_crc (cursor-rapid-movement-256x85)
[665.332241] Starting subtest: cursor-rapid-movement-256x85
[665.338529] Starting dynamic subtest: pipe-A-HDMI-A-4
[665.772815] Dynamic subtest pipe-A-HDMI-A-4: SUCCESS (0.433s)
[665.809998] Starting dynamic subtest: pipe-D-HDMI-A-4
[666.116413] Dynamic subtest pipe-D-HDMI-A-4: SUCCESS (0.319s)
[666.117252] Subtest cursor-rapid-movement-256x85: SUCCESS (0.783s)
[666.458409] [130/133] (378s left) gem_basic (create-fd-close)
[666.504772] Starting subtest: create-fd-close
[666.506226] Subtest create-fd-close: SUCCESS (0.000s)
[666.672507] [131/133] (378s left) core_auth (many-magics)
[666.715799] Starting subtest: many-magics
[667.700073] Subtest many-magics: SUCCESS (0.984s)
[668.043560] [132/133] (376s left) kms_flip (2x-absolute-wf_vblank-interruptible)
[669.533272] Starting subtest: 2x-absolute-wf_vblank-interruptible
[669.550342] Subtest 2x-absolute-wf_vblank-interruptible: SKIP (0.017s)
[669.765301] [133/133] (375s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers)
[671.249473] Starting subtest: plane-upscale-factor-0-25-with-modifiers
[671.250473] Starting dynamic subtest: pipe-A
[672.004234] Dynamic subtest pipe-A: SUCCESS (0.756s)
[672.024273] Starting dynamic subtest: pipe-B
[672.762474] Dynamic subtest pipe-B: SUCCESS (0.756s)
[672.780640] Starting dynamic subtest: pipe-C
[673.520208] Dynamic subtest pipe-C: SUCCESS (0.756s)
[673.536853] Starting dynamic subtest: pipe-D
[674.276457] Dynamic subtest pipe-D: SUCCESS (0.755s)
[674.277629] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (3.029s)
[674.482771] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: gem_flink_basic
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: gem_ppgtt
results: parsing output: 4/ for test: gem_exec_schedule
results: parsing output: 5/ for test: vgem_slow
results: parsing output: 6/ for test: gem_exec_schedule
results: parsing output: 7/ for test: kms_ccs
results: parsing output: 8/ for test: kms_cursor_legacy
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: i915_drm_fdinfo
results: parsing output: 12/ for test: kms_vblank
results: parsing output: 13/ for test: i915_pm_rps
results: parsing output: 14/ for test: kms_ccs
results: parsing output: 15/ for test: gem_ctx_bad_destroy
results: parsing output: 16/ for test: gem_fence_thrash
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: kms_color_pipeline
results: parsing output: 19/ for test: gem_ctx_shared
results: parsing output: 20/ for test: gem_exec_create
results: parsing output: 21/ for test: syncobj_timeline
results: parsing output: 22/ for test: kms_chamelium_audio
results: parsing output: 23/ for test: gem_pwrite_snooped
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: perf
results: parsing output: 26/ for test: kms_psr
results: parsing output: 27/ for test: kms_big_fb
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: gem_exec_params
results: parsing output: 30/ for test: gem_mmap_gtt
results: parsing output: 31/ for test: kms_big_fb
results: parsing output: 32/ for test: kms_rotation_crc
results: parsing output: 33/ for test: kms_big_fb
results: parsing output: 34/ for test: kms_flip_scaled_crc
results: parsing output: 35/ for test: kms_ccs
results: parsing output: 36/ for test: kms_plane
results: parsing output: 37/ for test: kms_psr
results: parsing output: 38/ for test: kms_cursor_legacy
results: parsing output: 39/ for test: gem_ctx_freq
results: parsing output: 40/ for test: gem_lmem_swapping
results: parsing output: 41/ for test: kms_plane_multiple
results: parsing output: 42/ for test: gem_partial_pwrite_pread
results: parsing output: 43/ for test: kms_ccs
results: parsing output: 44/ for test: core_getclient
results: parsing output: 45/ for test: gem_eio
results: parsing output: 46/ for test: gem_exec_schedule
results: parsing output: 47/ for test: kms_cursor_legacy
results: parsing output: 48/ for test: kms_cursor_edge_walk
results: parsing output: 49/ for test: syncobj_eventfd
results: parsing output: 50/ for test: syncobj_wait
results: parsing output: 51/ for test: core_auth
results: parsing output: 52/ for test: kms_flip
results: parsing output: 53/ for test: kms_cursor_legacy
results: parsing output: 54/ for test: gem_cs_tlb
results: parsing output: 55/ for test: gem_vm_create
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: kms_content_protection
results: parsing output: 59/ for test: gen9_exec_parse
results: parsing output: 60/ for test: kms_flip
results: parsing output: 61/ for test: kms_psr
results: parsing output: 62/ for test: core_getversion
results: parsing output: 63/ for test: gem_ringfill
results: parsing output: 64/ for test: gem_media_fill
results: parsing output: 65/ for test: perf_pmu
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: gem_partial_pwrite_pread
results: parsing output: 68/ for test: gem_userptr_blits
results: parsing output: 69/ for test: i915_pm_rps
results: parsing output: 70/ for test: syncobj_basic
results: parsing output: 71/ for test: sysfs_preempt_timeout
results: parsing output: 72/ for test: gem_pxp
results: parsing output: 73/ for test: gem_exec_reloc
results: parsing output: 74/ for test: syncobj_timeline
results: parsing output: 75/ for test: syncobj_basic
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_big_fb
results: parsing output: 78/ for test: gem_exec_balancer
results: parsing output: 79/ for test: kms_psr2_sf
results: parsing output: 80/ for test: syncobj_timeline
results: parsing output: 81/ for test: syncobj_wait
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: kms_big_fb
results: parsing output: 84/ for test: kms_big_fb
results: parsing output: 85/ for test: gem_exec_reloc
results: parsing output: 86/ for test: kms_dsc
results: parsing output: 87/ for test: kms_chamelium_color
results: parsing output: 88/ for test: kms_psr
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_vblank
results: parsing output: 91/ for test: kms_async_flips
results: parsing output: 92/ for test: kms_psr
results: parsing output: 93/ for test: kms_plane
results: parsing output: 94/ for test: kms_joiner
results: parsing output: 95/ for test: kms_cursor_legacy
results: parsing output: 96/ for test: kms_chamelium_hpd
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_pipe_stress
results: parsing output: 99/ for test: kms_pm_dc
results: parsing output: 100/ for test: kms_cursor_crc
results: parsing output: 101/ for test: i915_drm_fdinfo
results: parsing output: 102/ for test: kms_psr2_su
results: parsing output: 103/ for test: kms_force_connector_basic
results: parsing output: 104/ for test: kms_flip_scaled_crc
results: parsing output: 105/ for test: gem_tiled_blits
results: parsing output: 106/ for test: gem_userptr_blits
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: gem_exec_fence
results: parsing output: 109/ for test: gem_ccs
results: parsing output: 110/ for test: kms_big_fb
results: parsing output: 111/ for test: gem_exec_schedule
results: parsing output: 112/ for test: kms_pm_rpm
results: parsing output: 113/ for test: gem_spin_batch
results: parsing output: 114/ for test: gem_exec_reloc
results: parsing output: 115/ for test: syncobj_wait
results: parsing output: 116/ for test: kms_cursor_legacy
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: perf_pmu
results: parsing output: 119/ for test: kms_psr2_sf
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: syncobj_timeline
results: parsing output: 123/ for test: api_intel_allocator
results: parsing output: 124/ for test: kms_async_flips
results: parsing output: 125/ for test: drm_read
results: parsing output: 126/ for test: kms_lease
results: parsing output: 127/ for test: gem_exec_balancer
results: parsing output: 128/ for test: kms_cursor_crc
results: parsing output: 129/ for test: gem_basic
results: parsing output: 130/ for test: core_auth
results: parsing output: 131/ for test: kms_flip
results: parsing output: 132/ for test: kms_plane_scaling
Done.