[57.889609] Initializing watchdogs
[57.889657]   /dev/watchdog0
[57.903485] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[57.907911] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.910354] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.913775] [001/133] (960s left) syncobj_basic (create-signaled)
[57.995062] Starting subtest: create-signaled
[57.997451] Subtest create-signaled: SUCCESS (0.000s)
[58.129067] [002/133] (960s left) kms_ccs (bad-rotation-90-4-tiled-dg2-mc-ccs)
[58.234612] Starting subtest: bad-rotation-90-4-tiled-dg2-mc-ccs
[58.236902] Starting dynamic subtest: pipe-A-eDP-1
[58.259509] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[58.266487] Starting dynamic subtest: pipe-B-eDP-1
[58.288368] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[58.295095] Starting dynamic subtest: pipe-C-eDP-1
[58.316671] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[58.323734] Starting dynamic subtest: pipe-D-eDP-1
[58.347058] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[58.351283] Subtest bad-rotation-90-4-tiled-dg2-mc-ccs: SKIP (0.003s)
[60.497350] [003/133] (957s left) api_intel_bb (simple-bb-ctx)
[60.557561] Starting subtest: simple-bb-ctx
[60.568926] Subtest simple-bb-ctx: SUCCESS (0.013s)
[60.739374] [004/133] (957s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc)
[60.852409] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc
[60.856745] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[60.974570] [005/133] (957s left) gem_exec_suspend (basic-s3)
[61.036955] Starting subtest: basic-S3
[61.039336] Starting dynamic subtest: smem
[81.863988] Dynamic subtest smem: SUCCESS (6.881s)
[81.866597] Subtest basic-S3: SUCCESS (6.882s)
[82.081770] [006/133] (936s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-pwrite)
[82.307797] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-pwrite
[87.540588] Subtest fbc-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (5.227s)
[88.725266] [007/133] (929s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move)
[88.833997] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move
[88.838424] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[88.958462] [008/133] (929s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-render)
[89.055604] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-render
[93.204477] Subtest fbc-1p-offscreen-pri-shrfb-draw-render: SUCCESS (4.149s)
[94.332229] [009/133] (924s left) syncobj_timeline (etime-multi-wait-available-unsubmitted)
[94.403397] Starting subtest: etime-multi-wait-available-unsubmitted
[94.507522] Subtest etime-multi-wait-available-unsubmitted: SUCCESS (0.102s)
[94.603073] [010/133] (924s left) kms_getfb (getfb-handle-closed)
[94.703010] Starting subtest: getfb-handle-closed
[94.705452] Subtest getfb-handle-closed: SUCCESS (0.000s)
[94.835916] [011/133] (923s left) gem_softpin (full)
[94.903067] Starting subtest: full
[94.909649] Subtest full: SUCCESS (0.007s)
[95.062192] [012/133] (923s left) kms_lease (lease-unleased-crtc)
[95.161860] Starting subtest: lease-unleased-crtc
[95.164001] Starting dynamic subtest: pipe-A-eDP-1
[95.454474] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.293s)
[95.462990] Starting dynamic subtest: pipe-B-eDP-1
[96.175317] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.719s)
[96.184556] Starting dynamic subtest: pipe-C-eDP-1
[96.186498] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.005s)
[96.194542] Starting dynamic subtest: pipe-D-eDP-1
[96.196716] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.008s)
[96.198552] Subtest lease-unleased-crtc: SUCCESS (1.032s)
[96.568420] [013/133] (922s left) gem_exec_fence (syncobj-repeat)
[97.040737] Starting subtest: syncobj-repeat
[97.220445] Subtest syncobj-repeat: SUCCESS (0.179s)
[98.914034] [FACT gem_exec_fence (syncobj-repeat)] new: kernel.kmod_is_loaded.vgem: true
[98.917230] [014/133] (920s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[99.088309] Starting subtest: cursor-rapid-movement-32x10
[99.135763] Subtest cursor-rapid-movement-32x10: SKIP (0.043s)
[99.408218] [015/133] (919s left) kms_cursor_legacy (flip-vs-cursor-busy-crc-atomic)
[99.530288] Starting subtest: flip-vs-cursor-busy-crc-atomic
[100.377747] Subtest flip-vs-cursor-busy-crc-atomic: SUCCESS (0.846s)
[101.196686] [016/133] (917s left) kms_psr (pr-sprite-mmap-cpu)
[101.298254] Starting subtest: pr-sprite-mmap-cpu
[101.302421] Subtest pr-sprite-mmap-cpu: SKIP (0.000s)
[101.382992] [017/133] (917s left) kms_vblank (ts-continuation-modeset-rpm)
[101.467033] Starting subtest: ts-continuation-modeset-rpm
[101.469247] Starting dynamic subtest: pipe-A-eDP-1
[103.984364] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.516s)
[103.999082] Starting dynamic subtest: pipe-D-eDP-1
[106.250462] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.262s)
[106.252719] Subtest ts-continuation-modeset-rpm: SUCCESS (4.782s)
[107.138069] [018/133] (911s left) kms_cursor_crc (cursor-onscreen-64x64)
[107.332483] Starting subtest: cursor-onscreen-64x64
[107.337358] Starting dynamic subtest: pipe-A-eDP-1
[109.448853] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.111s)
[109.475192] Starting dynamic subtest: pipe-D-eDP-1
[112.222488] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.753s)
[112.224795] Subtest cursor-onscreen-64x64: SUCCESS (4.888s)
[113.131342] [019/133] (905s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff)
[113.225183] Starting subtest: psr-2p-primscrn-spr-indfb-onoff
[113.229651] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[113.361377] [020/133] (905s left) api_intel_allocator (simple-allocator)
[113.409132] Starting subtest: simple-allocator
[113.411502] Starting dynamic subtest: basic
[113.413837] Dynamic subtest basic: SUCCESS (0.003s)
[113.430595] Starting dynamic subtest: parallel-one
[113.618251] Dynamic subtest parallel-one: SUCCESS (0.206s)
[113.629289] Starting dynamic subtest: print
[113.631634] Dynamic subtest print: SUCCESS (0.000s)
[113.639910] Starting dynamic subtest: reuse
[113.641809] Dynamic subtest reuse: SUCCESS (0.000s)
[113.649520] Starting dynamic subtest: reserve
[113.651480] Dynamic subtest reserve: SUCCESS (0.000s)
[113.660225] Starting dynamic subtest: fork-reopen-allocator
[113.662146] Dynamic subtest fork-reopen-allocator: SUCCESS (0.012s)
[113.664085] Subtest simple-allocator: SUCCESS (0.225s)
[113.770310] [021/133] (905s left) gem_exec_schedule (lateslice)
[113.843060] Starting subtest: lateslice
[113.845383] Starting dynamic subtest: rcs0
[113.852028] Dynamic subtest rcs0: SUCCESS (0.020s)
[113.860350] Starting dynamic subtest: bcs0
[113.871813] Dynamic subtest bcs0: SUCCESS (0.020s)
[113.884408] Starting dynamic subtest: vcs0
[113.893217] Dynamic subtest vcs0: SUCCESS (0.021s)
[113.901210] Starting dynamic subtest: vcs1
[113.911597] Dynamic subtest vcs1: SUCCESS (0.018s)
[113.922245] Starting dynamic subtest: vecs0
[113.928836] Dynamic subtest vecs0: SUCCESS (0.017s)
[113.938037] Starting dynamic subtest: ccs0
[113.946003] Dynamic subtest ccs0: SUCCESS (0.017s)
[113.948336] Subtest lateslice: SUCCESS (0.115s)
[115.965089] [022/133] (903s left) gem_exec_reloc (basic-gtt-cpu)
[116.028521] Subtest basic-gtt-cpu: SKIP (0.000s)
[116.108938] [023/133] (903s left) gem_userptr_blits (forbidden-operations)
[116.171850] Starting subtest: forbidden-operations
[116.175933] Subtest forbidden-operations: SKIP (0.000s)
[116.315221] [024/133] (903s left) kms_flip (dpms-vs-vblank-race)
[116.408912] Starting subtest: dpms-vs-vblank-race
[116.411308] Starting dynamic subtest: A-eDP1
[121.383993] Dynamic subtest A-eDP1: SUCCESS (4.973s)
[121.394968] Starting dynamic subtest: B-eDP1
[124.900803] Dynamic subtest B-eDP1: SUCCESS (3.517s)
[124.910953] Starting dynamic subtest: C-eDP1
[129.532797] Dynamic subtest C-eDP1: SUCCESS (4.628s)
[129.542841] Starting dynamic subtest: D-eDP1
[134.181801] Dynamic subtest D-eDP1: SUCCESS (4.649s)
[134.184099] Subtest dpms-vs-vblank-race: SUCCESS (17.774s)
[135.059478] [025/133] (884s left) gem_exec_params (secure-non-master)
[135.128636] Starting subtest: secure-non-master
[135.133260] Subtest secure-non-master: SKIP (0.000s)
[135.247148] [026/133] (884s left) kms_big_fb (4-tiled-64bpp-rotate-270)
[135.349563] Starting subtest: 4-tiled-64bpp-rotate-270
[135.369364] Subtest 4-tiled-64bpp-rotate-270: SKIP (0.019s)
[135.516862] [027/133] (883s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-downscaling)
[135.607866] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-downscaling
[135.610132] Starting dynamic subtest: pipe-A-default-mode
[135.897669] Dynamic subtest pipe-A-default-mode: SKIP (0.286s)
[135.902263] Subtest flip-64bpp-yftile-to-16bpp-yftile-downscaling: SKIP (0.288s)
[136.788430] [028/133] (882s left) gem_exec_schedule (u-fairslice)
[136.871843] Starting subtest: u-fairslice
[136.874123] Starting dynamic subtest: rcs0
[138.883801] Dynamic subtest rcs0: SUCCESS (2.018s)
[138.893884] Starting dynamic subtest: bcs0
[140.931268] Dynamic subtest bcs0: SUCCESS (2.020s)
[140.942143] Starting dynamic subtest: vcs0
[142.924478] Dynamic subtest vcs0: SUCCESS (2.019s)
[142.934230] Starting dynamic subtest: vcs1
[144.944130] Dynamic subtest vcs1: SUCCESS (2.019s)
[144.952285] Starting dynamic subtest: vecs0
[146.967626] Dynamic subtest vecs0: SUCCESS (2.023s)
[146.978512] Starting dynamic subtest: ccs0
[148.989276] Dynamic subtest ccs0: SUCCESS (2.021s)
[148.991444] Subtest u-fairslice: SUCCESS (12.123s)
[149.306445] [029/133] (870s left) kms_plane (pixel-format-4-tiled-dg2-mc-ccs-modifier)
[149.423986] Starting subtest: pixel-format-4-tiled-dg2-mc-ccs-modifier
[149.451135] Starting dynamic subtest: pipe-A-plane-0
[149.455603] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[149.465527] Starting dynamic subtest: pipe-A-plane-3
[149.470026] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[149.478416] Starting dynamic subtest: pipe-A-plane-5
[149.482528] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[150.556466] Starting dynamic subtest: pipe-B-plane-0
[150.560815] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[150.568962] Starting dynamic subtest: pipe-B-plane-3
[150.573501] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[150.581254] Starting dynamic subtest: pipe-B-plane-5
[150.585514] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[150.873009] Subtest pixel-format-4-tiled-dg2-mc-ccs-modifier: SKIP (1.446s)
[151.760081] [030/133] (867s left) kms_flip (flip-vs-blocking-wf-vblank)
[151.860738] Starting subtest: flip-vs-blocking-wf-vblank
[151.863070] Starting dynamic subtest: A-eDP1
[160.782487] Dynamic subtest A-eDP1: SUCCESS (8.920s)
[160.795508] Starting dynamic subtest: B-eDP1
[169.713695] Dynamic subtest B-eDP1: SUCCESS (8.927s)
[169.723393] Starting dynamic subtest: C-eDP1
[178.629376] Dynamic subtest C-eDP1: SUCCESS (8.913s)
[178.639312] Starting dynamic subtest: D-eDP1
[187.557012] Dynamic subtest D-eDP1: SUCCESS (8.927s)
[187.559824] Subtest flip-vs-blocking-wf-vblank: SUCCESS (35.696s)
[188.798444] [031/133] (830s left) syncobj_timeline (wait-any-snapshot)
[188.872555] Starting subtest: wait-any-snapshot
[188.953902] Subtest wait-any-snapshot: SUCCESS (0.082s)
[189.055463] [032/133] (830s left) gem_exec_reloc (basic-write-gtt-active)
[189.120758] Subtest basic-write-gtt-active: SKIP (0.000s)
[189.187485] [033/133] (830s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-sf)
[194.272756] Starting subtest: fbc-psr2-cursor-plane-move-continuous-exceed-sf
[194.275105] Starting dynamic subtest: pipe-A-eDP-1
[195.056629] Dynamic subtest pipe-A-eDP-1: SKIP (0.779s)
[195.073230] Starting dynamic subtest: pipe-B-eDP-1
[196.193652] Dynamic subtest pipe-B-eDP-1: SKIP (1.137s)
[196.198215] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-sf: SKIP (1.921s)
[197.408454] [034/133] (822s left) gem_exec_reloc (basic-wc-active)
[197.478083] Subtest basic-wc-active: SKIP (0.000s)
[197.567478] [035/133] (822s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite)
[197.665801] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite
[206.315906] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.652s)
[206.474203] [036/133] (813s left) gem_mmap_wc (close)
[206.541376] Subtest close: SKIP (0.000s)
[206.610096] [037/133] (813s left) kms_pm_rpm (legacy-planes-dpms)
[208.137384] Starting subtest: legacy-planes-dpms
[208.140223] Starting dynamic subtest: plane-64
[216.453618] Dynamic subtest plane-64: SUCCESS (8.316s)
[216.464018] Starting dynamic subtest: plane-94
[224.731038] Dynamic subtest plane-94: SUCCESS (8.275s)
[224.741926] Starting dynamic subtest: plane-124
[233.172011] Dynamic subtest plane-124: SUCCESS (8.438s)
[233.183115] Starting dynamic subtest: plane-134
[241.478662] Dynamic subtest plane-134: SUCCESS (8.304s)
[241.481102] Subtest legacy-planes-dpms: SUCCESS (33.341s)
[241.874799] [038/133] (778s left) i915_query (query-regions-garbage-items)
[241.933788] Starting subtest: query-regions-garbage-items
[241.936081] Subtest query-regions-garbage-items: SUCCESS (0.000s)
[242.033352] [039/133] (777s left) dmabuf_sync_file (export-before-signal)
[242.082224] Starting subtest: export-before-signal
[242.084469] Subtest export-before-signal: SUCCESS (0.001s)
[242.149980] [040/133] (777s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[242.251487] Starting subtest: fbcpsr-indfb-scaledprimary
[248.063382] Subtest fbcpsr-indfb-scaledprimary: SUCCESS (5.813s)
[248.225953] [041/133] (771s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-gtt)
[248.331211] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-gtt
[248.335196] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[248.472251] [042/133] (771s left) kms_invalid_mode (zero-clock)
[248.571420] Starting subtest: zero-clock
[248.573716] Starting dynamic subtest: pipe-A-eDP-1
[248.854466] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[248.863267] Starting dynamic subtest: pipe-B-eDP-1
[248.865472] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[248.873573] Starting dynamic subtest: pipe-C-eDP-1
[248.875886] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[248.884311] Starting dynamic subtest: pipe-D-eDP-1
[248.886438] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[248.888584] Subtest zero-clock: SUCCESS (0.290s)
[249.720925] [043/133] (770s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode)
[250.116969] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s)
[250.905946] [044/133] (769s left) kms_cursor_legacy (cursorb-vs-flipb-toggle)
[251.032198] Starting subtest: cursorB-vs-flipB-toggle
[251.036910] Subtest cursorB-vs-flipB-toggle: SKIP (0.001s)
[251.190742] [045/133] (769s left) syncobj_basic (bad-handle-to-fd)
[251.255864] Starting subtest: bad-handle-to-fd
[251.257723] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[251.377199] [046/133] (768s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[251.489446] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[251.493860] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[251.619325] [047/133] (768s left) kms_plane_cursor (overlay)
[251.717064] Starting subtest: overlay
[251.721677] Starting dynamic subtest: pipe-A-eDP-1-size-64
[254.333717] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.616s)
[254.393753] Starting dynamic subtest: pipe-A-eDP-1-size-128
[256.970577] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.585s)
[257.029616] Starting dynamic subtest: pipe-A-eDP-1-size-256
[259.581727] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.561s)
[259.930357] Starting dynamic subtest: pipe-B-eDP-1-size-64
[263.222034] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.302s)
[263.281622] Starting dynamic subtest: pipe-B-eDP-1-size-128
[265.879222] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.604s)
[265.937775] Starting dynamic subtest: pipe-B-eDP-1-size-256
[268.503816] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.571s)
[268.853305] Starting dynamic subtest: pipe-C-eDP-1-size-64
[271.767595] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.925s)
[271.804757] Starting dynamic subtest: pipe-C-eDP-1-size-128
[273.990123] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.191s)
[274.034757] Starting dynamic subtest: pipe-C-eDP-1-size-256
[276.191282] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.169s)
[276.519069] Starting dynamic subtest: pipe-D-eDP-1-size-64
[279.377000] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.866s)
[279.413847] Starting dynamic subtest: pipe-D-eDP-1-size-128
[281.599716] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.192s)
[281.636613] Starting dynamic subtest: pipe-D-eDP-1-size-256
[283.899249] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.269s)
[284.218017] Subtest overlay: SUCCESS (32.497s)
[285.072669] [048/133] (735s left) kms_3d (basic)
[285.131731] Starting subtest: basic
[287.207729] Subtest basic: SUCCESS (2.075s)
[287.724613] [049/133] (732s left) gem_mmap_wc (bad-object)
[287.797997] Subtest bad-object: SKIP (0.000s)
[287.868507] [050/133] (732s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-plflip-blt)
[287.981131] Starting subtest: psr-2p-primscrn-shrfb-plflip-blt
[287.985440] Subtest psr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[288.110515] [051/133] (732s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs-cc)
[288.206280] Starting subtest: crc-primary-suspend-4-tiled-mtl-rc-ccs-cc
[288.208105] Starting dynamic subtest: pipe-A-eDP-1
[304.132783] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.431s)
[304.141674] Starting dynamic subtest: pipe-B-eDP-1
[321.087437] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.329s)
[321.101178] Starting dynamic subtest: pipe-C-eDP-1
[338.062617] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.327s)
[338.071860] Starting dynamic subtest: pipe-D-eDP-1
[355.092530] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.403s)
[355.094864] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs-cc: SUCCESS (8.496s)
[356.356651] [052/133] (664s left) kms_addfb_basic (too-high)
[356.461510] Starting subtest: too-high
[356.463788] Subtest too-high: SUCCESS (0.001s)
[356.594288] [053/133] (663s left) perf_pmu (busy-idle)
[356.637563] Starting subtest: busy-idle
[356.639900] Starting dynamic subtest: rcs0
[357.355240] Dynamic subtest rcs0: SUCCESS (0.719s)
[357.366833] Starting dynamic subtest: bcs0
[358.067727] Dynamic subtest bcs0: FAIL (0.658s)
[358.077478] Starting dynamic subtest: vcs0
[358.736579] Dynamic subtest vcs0: FAIL (0.655s)
[358.747423] Starting dynamic subtest: vcs1
[359.927814] Dynamic subtest vcs1: FAIL (1.188s)
[359.938200] Starting dynamic subtest: vecs0
[361.914966] Dynamic subtest vecs0: FAIL (1.981s)
[361.925210] Starting dynamic subtest: ccs0
[363.899531] Dynamic subtest ccs0: FAIL (1.979s)
[363.901826] Subtest busy-idle: FAIL (7.186s)
[363.961729] [054/133] (656s left) i915_drm_fdinfo (memory-info-resident)
[364.003307] Starting subtest: memory-info-resident
[364.005774] Starting dynamic subtest: smem0
[366.465551] Dynamic subtest smem0: SUCCESS (2.459s)
[366.467664] Subtest memory-info-resident: SUCCESS (2.460s)
[366.551967] [055/133] (654s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[366.662415] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-gtt
[366.666036] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[366.786509] [056/133] (653s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180)
[366.886303] Starting subtest: linear-max-hw-stride-64bpp-rotate-180
[367.910624] Subtest linear-max-hw-stride-64bpp-rotate-180: SUCCESS (1.023s)
[368.064478] [057/133] (652s left) kms_ccs (crc-primary-basic-4-tiled-dg2-mc-ccs)
[368.160642] Starting subtest: crc-primary-basic-4-tiled-dg2-mc-ccs
[368.162492] Starting dynamic subtest: pipe-A-eDP-1
[368.180844] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[368.190905] Starting dynamic subtest: pipe-B-eDP-1
[368.208573] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[368.217019] Starting dynamic subtest: pipe-C-eDP-1
[368.234232] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[368.242886] Starting dynamic subtest: pipe-D-eDP-1
[368.261841] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[368.265505] Subtest crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.006s)
[370.476249] [058/133] (650s left) kms_psr (fbc-psr-sprite-blt)
[370.583461] Starting subtest: fbc-psr-sprite-blt
[370.585742] Starting dynamic subtest: eDP-1
[370.589942] Dynamic subtest eDP-1: SKIP (0.000s)
[370.594115] Subtest fbc-psr-sprite-blt: SKIP (0.001s)
[370.671054] [059/133] (650s left) kms_plane (pixel-format-4-tiled-mtl-mc-ccs-modifier)
[370.765440] Starting subtest: pixel-format-4-tiled-mtl-mc-ccs-modifier
[370.791935] Starting dynamic subtest: pipe-A-plane-0
[371.214477] Dynamic subtest pipe-A-plane-0: SUCCESS (0.422s)
[371.226243] Starting dynamic subtest: pipe-A-plane-3
[371.469833] Dynamic subtest pipe-A-plane-3: SUCCESS (0.255s)
[371.478439] Starting dynamic subtest: pipe-A-plane-5
[371.481796] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[372.538178] Starting dynamic subtest: pipe-B-plane-0
[372.970772] Dynamic subtest pipe-B-plane-0: SUCCESS (0.444s)
[372.979779] Starting dynamic subtest: pipe-B-plane-3
[373.226730] Dynamic subtest pipe-B-plane-3: SUCCESS (0.255s)
[373.236978] Starting dynamic subtest: pipe-B-plane-5
[373.241529] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[373.541959] Subtest pixel-format-4-tiled-mtl-mc-ccs-modifier: SUCCESS (2.774s)
[374.379747] [060/133] (646s left) gem_exec_schedule (deep)
[374.565422] Starting subtest: deep
[374.567574] Starting dynamic subtest: rcs0
[379.519948] Dynamic subtest rcs0: SKIP (4.943s)
[379.530129] Starting dynamic subtest: vcs0
[389.698103] Dynamic subtest vcs0: SUCCESS (10.182s)
[389.709063] Starting dynamic subtest: vcs1
[401.636402] Dynamic subtest vcs1: SUCCESS (11.939s)
[401.647647] Starting dynamic subtest: vecs0
[413.100107] Dynamic subtest vecs0: SUCCESS (11.460s)
[413.109459] Starting dynamic subtest: ccs0
[424.971079] Dynamic subtest ccs0: SUCCESS (11.865s)
[424.974534] Subtest deep: SUCCESS (50.394s)
[425.972262] [061/133] (594s left) kms_addfb_basic (invalid-set-prop)
[426.034049] Starting subtest: invalid-set-prop
[426.036004] Subtest invalid-set-prop: SUCCESS (0.000s)
[426.215301] [062/133] (594s left) kms_cursor_crc (cursor-sliding-max-size)
[426.533169] Starting subtest: cursor-sliding-max-size
[426.539745] Subtest cursor-sliding-max-size: SKIP (0.000s)
[426.712008] [063/133] (594s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc)
[426.812687] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc
[426.814577] Starting dynamic subtest: pipe-A-eDP-1
[427.287715] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.452s)
[427.297890] Starting dynamic subtest: pipe-B-eDP-1
[428.747629] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.453s)
[428.758705] Starting dynamic subtest: pipe-C-eDP-1
[430.111419] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.362s)
[430.121351] Starting dynamic subtest: pipe-D-eDP-1
[431.557280] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.446s)
[431.559196] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc: SUCCESS (4.719s)
[432.800745] [064/133] (588s left) kms_rotation_crc (primary-yf-tiled-reflect-x-90)
[432.917647] Starting subtest: primary-yf-tiled-reflect-x-90
[432.921626] Subtest primary-yf-tiled-reflect-x-90: SKIP (0.001s)
[433.002115] [065/133] (588s left) kms_big_fb (y-tiled-16bpp-rotate-0)
[433.111715] Starting subtest: y-tiled-16bpp-rotate-0
[433.116191] Subtest y-tiled-16bpp-rotate-0: SKIP (0.000s)
[433.227646] [066/133] (587s left) gem_lmem_swapping (heavy-verify-random-ccs)
[433.271370] Subtest heavy-verify-random-ccs: SKIP (0.000s)
[433.315360] [067/133] (587s left) kms_async_flips (test-cursor)
[433.410723] Starting subtest: test-cursor
[433.415090] Subtest test-cursor: SKIP (0.000s)
[434.586938] [068/133] (586s left) gem_eio (create)
[434.814150] Starting subtest: create
[435.151677] Subtest create: SUCCESS (0.339s)
[435.326476] [069/133] (585s left) gem_watchdog (default-virtual)
[435.402683] Starting subtest: default-virtual
[441.678322] Subtest default-virtual: SUCCESS (6.282s)
[441.772699] [070/133] (579s left) gem_ccs (block-copy-uncompressed)
[441.838860] Starting subtest: block-copy-uncompressed
[441.841183] Starting dynamic subtest: linear-uncompressed-compfmt0-smem-smem
[441.870413] Dynamic subtest linear-uncompressed-compfmt0-smem-smem: SUCCESS (0.030s)
[441.879307] Starting dynamic subtest: xmajor-uncompressed-compfmt0-smem-smem
[441.889728] Dynamic subtest xmajor-uncompressed-compfmt0-smem-smem: SUCCESS (0.018s)
[441.898382] Starting dynamic subtest: tile4-uncompressed-compfmt0-smem-smem
[441.908783] Dynamic subtest tile4-uncompressed-compfmt0-smem-smem: SUCCESS (0.018s)
[441.919544] Starting dynamic subtest: tile64-uncompressed-compfmt0-smem-smem
[441.928493] Dynamic subtest tile64-uncompressed-compfmt0-smem-smem: SUCCESS (0.019s)
[441.930744] Subtest block-copy-uncompressed: SUCCESS (0.090s)
[442.067972] [071/133] (579s left) gem_exec_balancer (full)
[442.136810] Starting subtest: full
[447.161175] Subtest full: SUCCESS (5.022s)
[447.533749] [072/133] (573s left) kms_psr (fbc-psr2-cursor-mmap-cpu)
[447.634145] Starting subtest: fbc-psr2-cursor-mmap-cpu
[447.636604] Starting dynamic subtest: eDP-1
[447.641121] Dynamic subtest eDP-1: SKIP (0.000s)
[447.645687] Subtest fbc-psr2-cursor-mmap-cpu: SKIP (0.001s)
[447.718603] [073/133] (573s left) gem_mmap_gtt (basic-small-copy-odd)
[447.772977] Subtest basic-small-copy-odd: SKIP (0.000s)
[447.841399] [074/133] (573s left) kms_frontbuffer_tracking (fbc-abgr161616f-draw-pwrite)
[447.951749] Starting subtest: fbc-abgr161616f-draw-pwrite
[447.955886] Subtest fbc-abgr161616f-draw-pwrite: SKIP (0.000s)
[448.079693] [075/133] (573s left) kms_flip (2x-flip-vs-expired-vblank-interruptible)
[448.191143] Starting subtest: 2x-flip-vs-expired-vblank-interruptible
[448.203059] Subtest 2x-flip-vs-expired-vblank-interruptible: SKIP (0.011s)
[448.343573] [076/133] (573s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-ccs)
[448.409885] Starting subtest: y-tiled-ccs-to-yf-tiled-ccs
[448.413565] Subtest y-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[448.606506] [077/133] (572s left) kms_flip_scaled_crc (flip-32bpp-linear-to-32bpp-linear-reflect-x)
[448.693958] Starting subtest: flip-32bpp-linear-to-32bpp-linear-reflect-x
[448.696299] Starting dynamic subtest: pipe-A-default-mode
[449.800453] Dynamic subtest pipe-A-default-mode: SKIP (1.103s)
[449.804814] Subtest flip-32bpp-linear-to-32bpp-linear-reflect-x: SKIP (1.105s)
[449.984928] [078/133] (571s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-blt)
[450.092215] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-blt
[453.717235] Subtest fbc-1p-primscrn-cur-indfb-draw-blt: SUCCESS (3.630s)
[454.901054] [079/133] (566s left) gem_partial_pwrite_pread (write-snoop)
[454.960417] Subtest write-snoop: SKIP (0.000s)
[455.037363] [080/133] (566s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs)
[455.148478] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs
[455.150796] Starting dynamic subtest: pipe-A-eDP-1
[455.898270] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.739s)
[455.907489] Starting dynamic subtest: pipe-B-eDP-1
[457.677988] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.781s)
[457.688203] Starting dynamic subtest: pipe-C-eDP-1
[459.484348] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.806s)
[459.494449] Starting dynamic subtest: pipe-D-eDP-1
[461.265512] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.780s)
[461.267377] Subtest random-ccs-data-4-tiled-mtl-rc-ccs: SUCCESS (6.112s)
[462.483471] [081/133] (559s left) kms_psr2_sf (fbc-psr2-overlay-primary-update-sf-dmg-area)
[467.529971] Starting subtest: fbc-psr2-overlay-primary-update-sf-dmg-area
[467.532416] Starting dynamic subtest: pipe-A-eDP-1
[468.315663] Dynamic subtest pipe-A-eDP-1: SKIP (0.781s)
[468.326599] Starting dynamic subtest: pipe-B-eDP-1
[469.511760] Dynamic subtest pipe-B-eDP-1: SKIP (1.194s)
[469.516330] Subtest fbc-psr2-overlay-primary-update-sf-dmg-area: SKIP (1.980s)
[470.712321] [082/133] (551s left) prime_vgem (basic-read)
[470.802739] Starting subtest: basic-read
[470.828328] Subtest basic-read: SKIP (0.026s)
[470.976506] [083/133] (550s left) gem_exec_parallel (basic)
[471.042641] Starting subtest: basic
[471.044941] Starting dynamic subtest: rcs0
[472.517323] Dynamic subtest rcs0: SUCCESS (1.474s)
[472.527463] Starting dynamic subtest: bcs0
[473.990953] Dynamic subtest bcs0: SUCCESS (1.472s)
[474.003259] Starting dynamic subtest: vcs0
[476.170845] Dynamic subtest vcs0: SUCCESS (2.176s)
[476.183660] Starting dynamic subtest: vcs1
[478.217412] Dynamic subtest vcs1: SUCCESS (2.044s)
[478.229809] Starting dynamic subtest: vecs0
[480.201181] Dynamic subtest vecs0: SUCCESS (1.981s)
[480.213238] Starting dynamic subtest: ccs0
[481.687704] Dynamic subtest ccs0: SUCCESS (1.486s)
[481.690015] Subtest basic: SUCCESS (10.647s)
[481.887017] [084/133] (539s left) syncobj_timeline (multi-wait-available-submitted-signaled)
[481.962130] Starting subtest: multi-wait-available-submitted-signaled
[481.964587] Subtest multi-wait-available-submitted-signaled: SUCCESS (0.000s)
[482.081818] [085/133] (539s left) kms_dp_linktrain_fallback (dp-fallback)
[482.187537] Starting subtest: dp-fallback
[482.194077] Subtest dp-fallback: SKIP (0.000s)
[482.274888] [086/133] (539s left) kms_atomic_interruptible (universal-setplane-cursor)
[482.373588] Starting subtest: universal-setplane-cursor
[482.375831] Starting dynamic subtest: pipe-A-eDP-1
[489.748086] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.372s)
[489.750228] Subtest universal-setplane-cursor: SUCCESS (7.373s)
[490.588863] [087/133] (531s left) kms_feature_discovery (display-2x)
[490.697668] Starting subtest: display-2x
[490.702013] Subtest display-2x: SKIP (0.000s)
[490.787215] [088/133] (531s left) vgem_basic (dmabuf-mmap)
[490.825127] Starting subtest: dmabuf-mmap
[490.860534] Subtest dmabuf-mmap: SUCCESS (0.038s)
[490.942720] [089/133] (531s left) gem_exec_create (legacy)
[491.003816] Starting subtest: legacy
[491.006192] Starting dynamic subtest: smem
[493.084977] Dynamic subtest smem: SUCCESS (2.083s)
[493.087482] Subtest legacy: SUCCESS (2.085s)
[493.294653] [090/133] (528s left) kms_pm_rpm (modeset-stress-extra-wait)
[495.447414] Starting subtest: modeset-stress-extra-wait
[549.727054] Subtest modeset-stress-extra-wait: SUCCESS (54.271s)
[549.832252] [091/133] (472s left) kms_big_fb (yf-tiled-16bpp-rotate-270)
[549.953501] Starting subtest: yf-tiled-16bpp-rotate-270
[549.957471] Subtest yf-tiled-16bpp-rotate-270: SKIP (0.000s)
[550.088288] [092/133] (472s left) kms_psr (psr2-primary-mmap-gtt)
[550.197913] Starting subtest: psr2-primary-mmap-gtt
[550.200226] Starting dynamic subtest: eDP-1
[551.626231] Dynamic subtest eDP-1: SKIP (1.432s)
[551.630765] Subtest psr2-primary-mmap-gtt: SKIP (1.434s)
[551.831314] [093/133] (470s left) kms_frontbuffer_tracking (fbcpsr-abgr161616f-draw-render)
[551.932619] Starting subtest: fbcpsr-abgr161616f-draw-render
[551.937182] Subtest fbcpsr-abgr161616f-draw-render: SKIP (0.000s)
[552.072527] [094/133] (470s left) syncobj_timeline (invalid-transfer-non-existent-point)
[552.129047] Starting subtest: invalid-transfer-non-existent-point
[552.131497] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[552.256240] [095/133] (470s left) gen9_exec_parse (bb-start-out)
[552.311726] Subtest bb-start-out: SKIP (0.000s)
[552.388565] [096/133] (469s left) kms_sequence (queue-idle)
[552.485656] Starting subtest: queue-idle
[552.487970] Starting dynamic subtest: pipe-A-eDP-1
[554.295523] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.811s)
[554.305973] Starting dynamic subtest: pipe-B-eDP-1
[556.813981] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.513s)
[556.824419] Starting dynamic subtest: pipe-C-eDP-1
[559.290765] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.475s)
[559.301573] Starting dynamic subtest: pipe-D-eDP-1
[561.797100] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.503s)
[561.798992] Subtest queue-idle: SUCCESS (9.309s)
[562.681020] [097/133] (459s left) gem_mmap_offset (open-flood)
[562.740838] Starting subtest: open-flood
[584.230117] Subtest open-flood: SUCCESS (21.489s)
[584.366703] [098/133] (438s left) gem_flink_basic (double-flink)
[584.424640] Starting subtest: double-flink
[584.426517] Subtest double-flink: SUCCESS (0.000s)
[584.528709] [099/133] (437s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[584.659844] Starting subtest: cursor-vs-flip-atomic
[614.052199] Subtest cursor-vs-flip-atomic: SUCCESS (29.393s)
[614.868528] [100/133] (407s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-onoff)
[614.976625] Starting subtest: fbc-2p-scndscrn-spr-indfb-onoff
[614.980742] Subtest fbc-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[615.111440] [101/133] (407s left) gem_mmap_wc (write-read)
[615.174913] Subtest write-read: SKIP (0.000s)
[615.246408] [102/133] (407s left) perf_pmu (rc6-all-gts)
[615.282517] Starting subtest: rc6-all-gts
[621.663058] Subtest rc6-all-gts: SUCCESS (6.379s)
[622.546589] [103/133] (400s left) i915_pm_rps (min-max-config-loaded)
[622.609881] Starting subtest: min-max-config-loaded
[622.613846] Subtest min-max-config-loaded: SKIP (0.001s)
[622.730503] [104/133] (399s left) gem_ctx_persistence (process)
[622.790835] Starting subtest: process
[623.046127] Subtest process: SUCCESS (0.255s)
[623.138970] [105/133] (399s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[623.198330] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[623.200231] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[623.320672] [106/133] (399s left) gem_create (create-ext-cpu-access-big)
[623.490422] Starting subtest: create-ext-cpu-access-big
[623.495035] Subtest create-ext-cpu-access-big: SKIP (0.002s)
[623.579586] [107/133] (399s left) kms_content_protection (uevent)
[623.724537] Starting subtest: uevent
[623.728690] Subtest uevent: SKIP (0.000s)
[623.866536] [108/133] (398s left) kms_hdr (static-swap)
[623.965534] Starting subtest: static-swap
[623.972184] Subtest static-swap: SKIP (0.001s)
[624.064879] [109/133] (398s left) gem_exec_flush (basic-batch-kernel-default-wb)
[624.122713] Starting subtest: basic-batch-kernel-default-wb
[631.521219] Subtest basic-batch-kernel-default-wb: SUCCESS (7.400s)
[631.717450] [110/133] (391s left) syncobj_wait (invalid-reset-one-illegal-handle)
[631.778316] Starting subtest: invalid-reset-one-illegal-handle
[631.780555] Subtest invalid-reset-one-illegal-handle: SUCCESS (0.000s)
[631.900872] [111/133] (391s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-msflip-blt)
[632.006882] Starting subtest: fbc-2p-primscrn-shrfb-msflip-blt
[632.011340] Subtest fbc-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[632.137507] [112/133] (390s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180)
[632.249774] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180
[632.254183] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[632.367606] [113/133] (390s left) syncobj_wait (multi-wait-submitted-signaled)
[632.416152] Starting subtest: multi-wait-submitted-signaled
[632.418310] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[632.542023] [114/133] (390s left) kms_big_fb (linear-32bpp-rotate-0)
[632.646719] Starting subtest: linear-32bpp-rotate-0
[634.237230] Subtest linear-32bpp-rotate-0: SUCCESS (1.591s)
[634.402540] [115/133] (388s left) kms_plane_scaling (plane-scaler-unity-scaling-with-rotation)
[634.499594] Starting subtest: plane-scaler-unity-scaling-with-rotation
[634.501501] Starting dynamic subtest: pipe-A
[634.727136] Dynamic subtest pipe-A: SUCCESS (0.229s)
[634.737575] Starting dynamic subtest: pipe-B
[636.017451] Dynamic subtest pipe-B: SUCCESS (1.289s)
[636.028096] Starting dynamic subtest: pipe-C
[637.312793] Dynamic subtest pipe-C: SUCCESS (1.294s)
[637.324375] Starting dynamic subtest: pipe-D
[638.610482] Dynamic subtest pipe-D: SUCCESS (1.297s)
[638.612730] Subtest plane-scaler-unity-scaling-with-rotation: SUCCESS (4.113s)
[639.778661] [116/133] (383s left) syncobj_eventfd (binary-wait-signaled)
[639.836464] Starting subtest: binary-wait-signaled
[639.839069] Subtest binary-wait-signaled: SUCCESS (0.000s)
[639.968301] [117/133] (383s left) gem_mmap_gtt (cpuset-basic-small-copy)
[640.041917] Subtest cpuset-basic-small-copy: SKIP (0.000s)
[640.114061] [118/133] (383s left) kms_color (ctm-green-to-red)
[640.223548] Starting subtest: ctm-green-to-red
[640.225707] Starting dynamic subtest: pipe-A-eDP-1
[640.936675] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.715s)
[640.949568] Starting dynamic subtest: pipe-B-eDP-1
[642.339670] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.402s)
[642.349509] Starting dynamic subtest: pipe-C-eDP-1
[643.704334] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.363s)
[643.714468] Starting dynamic subtest: pipe-D-eDP-1
[645.084174] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.379s)
[645.086331] Subtest ctm-green-to-red: SUCCESS (4.863s)
[645.975825] [119/133] (377s left) kms_flip (flip-vs-rmfb)
[646.065625] Starting subtest: flip-vs-rmfb
[646.067795] Starting dynamic subtest: A-eDP1
[654.710481] Dynamic subtest A-eDP1: SUCCESS (8.643s)
[654.721026] Starting dynamic subtest: B-eDP1
[663.421135] Dynamic subtest B-eDP1: SUCCESS (8.708s)
[663.431731] Starting dynamic subtest: C-eDP1
[672.023368] Dynamic subtest C-eDP1: SUCCESS (8.600s)
[672.033947] Starting dynamic subtest: D-eDP1
[680.707695] Dynamic subtest D-eDP1: SUCCESS (8.681s)
[680.712645] Subtest flip-vs-rmfb: SUCCESS (34.643s)
[681.970492] [120/133] (341s left) kms_draw_crc (fill-fb)
[682.064895] Starting subtest: fill-fb
[682.549202] Subtest fill-fb: SUCCESS (0.487s)
[682.679767] [121/133] (340s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[682.786489] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[690.077571] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.292s)
[690.230259] [122/133] (333s left) gem_exec_whisper (basic-contexts)
[690.307513] Starting subtest: basic-contexts
[697.290859] Subtest basic-contexts: SUCCESS (6.981s)
[697.486657] [123/133] (325s left) gem_render_copy (yf-tiled)
[697.575413] Starting subtest: yf-tiled
[697.579774] Subtest yf-tiled: SKIP (0.000s)
[697.801785] [124/133] (325s left) kms_psr (fbc-pr-primary-blt)
[697.894440] Starting subtest: fbc-pr-primary-blt
[697.898900] Subtest fbc-pr-primary-blt: SKIP (0.000s)
[697.986012] [125/133] (325s left) kms_plane_scaling (plane-upscale-20x20-with-pixel-format)
[698.104645] Starting subtest: plane-upscale-20x20-with-pixel-format
[698.106994] Starting dynamic subtest: pipe-A
[699.152095] Dynamic subtest pipe-A: SUCCESS (1.050s)
[699.161317] Starting dynamic subtest: pipe-B
[701.239551] Dynamic subtest pipe-B: SUCCESS (2.086s)
[701.250727] Starting dynamic subtest: pipe-C
[702.393635] Dynamic subtest pipe-C: SUCCESS (1.153s)
[702.404098] Starting dynamic subtest: pipe-D
[703.594269] Dynamic subtest pipe-D: SUCCESS (1.200s)
[703.596554] Subtest plane-upscale-20x20-with-pixel-format: SUCCESS (5.492s)
[704.764380] [126/133] (318s left) syncobj_basic (bad-flags-handle-to-fd)
[704.828651] Starting subtest: bad-flags-handle-to-fd
[704.830853] Subtest bad-flags-handle-to-fd: SUCCESS (0.000s)
[704.955741] [127/133] (318s left) kms_chamelium_frames (dp-frame-dump)
[705.357977] Subtest dp-frame-dump: SKIP (0.000s)
[706.138648] [128/133] (317s left) perf_pmu (interrupts)
[706.189648] Starting subtest: interrupts
[707.316305] Subtest interrupts: SUCCESS (1.126s)
[707.494339] [129/133] (316s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs-cc)
[707.603543] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs-cc
[707.605845] Starting dynamic subtest: pipe-A-eDP-1
[707.626309] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[707.638654] Starting dynamic subtest: pipe-B-eDP-1
[707.658825] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[707.669690] Starting dynamic subtest: pipe-C-eDP-1
[707.689364] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[707.698382] Starting dynamic subtest: pipe-D-eDP-1
[707.717856] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[707.719805] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.008s)
[709.870834] [130/133] (313s left) gem_ctx_param (invalid-get-engines)
[709.926197] Starting subtest: invalid-get-engines
[709.928478] Subtest invalid-get-engines: SUCCESS (0.001s)
[710.059841] [131/133] (313s left) i915_module_load (reload)
[710.094842] Starting subtest: reload
[715.153152] Subtest reload: SUCCESS (5.060s)
[715.224525] [132/133] (308s left) kms_psr (psr-sprite-mmap-gtt)
[716.243492] Starting subtest: psr-sprite-mmap-gtt
[716.245773] Starting dynamic subtest: eDP-1
[717.726746] Dynamic subtest eDP-1: SKIP (1.480s)
[717.731622] Subtest psr-sprite-mmap-gtt: SKIP (1.482s)
[717.933638] [133/133] (305s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-fullscreen)
[718.030034] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-fullscreen
[718.034628] Subtest fbcpsr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[718.157209] Closing watchdogs
results: parsing output: 0/ for test: syncobj_basic
results: parsing output: 1/ for test: kms_ccs
results: parsing output: 2/ for test: api_intel_bb
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: gem_exec_suspend
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: syncobj_timeline
results: parsing output: 9/ for test: kms_getfb
results: parsing output: 10/ for test: gem_softpin
results: parsing output: 11/ for test: kms_lease
results: parsing output: 12/ for test: gem_exec_fence
results: parsing output: 13/ for test: kms_cursor_crc
results: parsing output: 14/ for test: kms_cursor_legacy
results: parsing output: 15/ for test: kms_psr
results: parsing output: 16/ for test: kms_vblank
results: parsing output: 17/ for test: kms_cursor_crc
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: api_intel_allocator
results: parsing output: 20/ for test: gem_exec_schedule
results: parsing output: 21/ for test: gem_exec_reloc
results: parsing output: 22/ for test: gem_userptr_blits
results: parsing output: 23/ for test: kms_flip
results: parsing output: 24/ for test: gem_exec_params
results: parsing output: 25/ for test: kms_big_fb
results: parsing output: 26/ for test: kms_flip_scaled_crc
results: parsing output: 27/ for test: gem_exec_schedule
results: parsing output: 28/ for test: kms_plane
results: parsing output: 29/ for test: kms_flip
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: gem_exec_reloc
results: parsing output: 32/ for test: kms_psr2_sf
results: parsing output: 33/ for test: gem_exec_reloc
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: gem_mmap_wc
results: parsing output: 36/ for test: kms_pm_rpm
results: parsing output: 37/ for test: i915_query
results: parsing output: 38/ for test: dmabuf_sync_file
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: kms_invalid_mode
results: parsing output: 42/ for test: kms_chamelium_hpd
results: parsing output: 43/ for test: kms_cursor_legacy
results: parsing output: 44/ for test: syncobj_basic
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: kms_plane_cursor
results: parsing output: 47/ for test: kms_3d
results: parsing output: 48/ for test: gem_mmap_wc
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: kms_ccs
results: parsing output: 51/ for test: kms_addfb_basic
results: parsing output: 52/ for test: perf_pmu
results: parsing output: 53/ for test: i915_drm_fdinfo
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_big_fb
results: parsing output: 56/ for test: kms_ccs
results: parsing output: 57/ for test: kms_psr
results: parsing output: 58/ for test: kms_plane
results: parsing output: 59/ for test: gem_exec_schedule
results: parsing output: 60/ for test: kms_addfb_basic
results: parsing output: 61/ for test: kms_cursor_crc
results: parsing output: 62/ for test: kms_ccs
results: parsing output: 63/ for test: kms_rotation_crc
results: parsing output: 64/ for test: kms_big_fb
results: parsing output: 65/ for test: gem_lmem_swapping
results: parsing output: 66/ for test: kms_async_flips
results: parsing output: 67/ for test: gem_eio
results: parsing output: 68/ for test: gem_watchdog
results: parsing output: 69/ for test: gem_ccs
results: parsing output: 70/ for test: gem_exec_balancer
results: parsing output: 71/ for test: kms_psr
results: parsing output: 72/ for test: gem_mmap_gtt
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_flip
results: parsing output: 75/ for test: gem_render_copy
results: parsing output: 76/ for test: kms_flip_scaled_crc
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: gem_partial_pwrite_pread
results: parsing output: 79/ for test: kms_ccs
results: parsing output: 80/ for test: kms_psr2_sf
results: parsing output: 81/ for test: prime_vgem
results: parsing output: 82/ for test: gem_exec_parallel
results: parsing output: 83/ for test: syncobj_timeline
results: parsing output: 84/ for test: kms_dp_linktrain_fallback
results: parsing output: 85/ for test: kms_atomic_interruptible
results: parsing output: 86/ for test: kms_feature_discovery
results: parsing output: 87/ for test: vgem_basic
results: parsing output: 88/ for test: gem_exec_create
results: parsing output: 89/ for test: kms_pm_rpm
results: parsing output: 90/ for test: kms_big_fb
results: parsing output: 91/ for test: kms_psr
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: syncobj_timeline
results: parsing output: 94/ for test: gen9_exec_parse
results: parsing output: 95/ for test: kms_sequence
results: parsing output: 96/ for test: gem_mmap_offset
results: parsing output: 97/ for test: gem_flink_basic
results: parsing output: 98/ for test: kms_cursor_legacy
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: gem_mmap_wc
results: parsing output: 101/ for test: perf_pmu
results: parsing output: 102/ for test: i915_pm_rps
results: parsing output: 103/ for test: gem_ctx_persistence
results: parsing output: 104/ for test: syncobj_timeline
results: parsing output: 105/ for test: gem_create
results: parsing output: 106/ for test: kms_content_protection
results: parsing output: 107/ for test: kms_hdr
results: parsing output: 108/ for test: gem_exec_flush
results: parsing output: 109/ for test: syncobj_wait
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_big_fb
results: parsing output: 112/ for test: syncobj_wait
results: parsing output: 113/ for test: kms_big_fb
results: parsing output: 114/ for test: kms_plane_scaling
results: parsing output: 115/ for test: syncobj_eventfd
results: parsing output: 116/ for test: gem_mmap_gtt
results: parsing output: 117/ for test: kms_color
results: parsing output: 118/ for test: kms_flip
results: parsing output: 119/ for test: kms_draw_crc
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: gem_exec_whisper
results: parsing output: 122/ for test: gem_render_copy
results: parsing output: 123/ for test: kms_psr
results: parsing output: 124/ for test: kms_plane_scaling
results: parsing output: 125/ for test: syncobj_basic
results: parsing output: 126/ for test: kms_chamelium_frames
results: parsing output: 127/ for test: perf_pmu
results: parsing output: 128/ for test: kms_ccs
results: parsing output: 129/ for test: gem_ctx_param
results: parsing output: 130/ for test: i915_module_load
results: parsing output: 131/ for test: kms_psr
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.