[59.774065] Initializing watchdogs
[59.774135]   /dev/watchdog0
[59.794072] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[59.805535] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[59.809515] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.811897] [001/131] (960s left) kms_psr (psr-cursor-blt)
[60.004072] Subtest psr-cursor-blt: SKIP (0.000s)
[60.057544] [002/131] (960s left) kms_plane (plane-position-covered)
[60.245176] Starting subtest: plane-position-covered
[60.701818] Starting dynamic subtest: pipe-A-plane-1
[61.156494] Dynamic subtest pipe-A-plane-1: SUCCESS (0.453s)
[61.166366] Starting dynamic subtest: pipe-A-plane-2
[61.626449] Dynamic subtest pipe-A-plane-2: SUCCESS (0.467s)
[61.634074] Starting dynamic subtest: pipe-A-plane-3
[62.101107] Dynamic subtest pipe-A-plane-3: SUCCESS (0.473s)
[62.110643] Starting dynamic subtest: pipe-A-plane-4
[62.583644] Dynamic subtest pipe-A-plane-4: SUCCESS (0.481s)
[62.592589] Starting dynamic subtest: pipe-A-plane-5
[62.606079] Dynamic subtest pipe-A-plane-5: SUCCESS (0.021s)
[62.949045] Starting dynamic subtest: pipe-B-plane-1
[63.382264] Dynamic subtest pipe-B-plane-1: SUCCESS (0.439s)
[63.389934] Starting dynamic subtest: pipe-B-plane-2
[63.817457] Dynamic subtest pipe-B-plane-2: SUCCESS (0.433s)
[63.833238] Starting dynamic subtest: pipe-B-plane-3
[64.274573] Dynamic subtest pipe-B-plane-3: SUCCESS (0.455s)
[64.288663] Starting dynamic subtest: pipe-B-plane-4
[64.714516] Dynamic subtest pipe-B-plane-4: SUCCESS (0.440s)
[64.731524] Starting dynamic subtest: pipe-B-plane-5
[64.748270] Dynamic subtest pipe-B-plane-5: SUCCESS (0.033s)
[64.749160] Subtest plane-position-covered: SUCCESS (4.489s)
[65.044255] [003/131] (955s left) kms_flip (wf_vblank-ts-check)
[65.235958] Starting subtest: wf_vblank-ts-check
[65.239631] Starting dynamic subtest: A-DP3
[73.399267] Dynamic subtest A-DP3: SUCCESS (8.149s)
[73.408467] Starting dynamic subtest: B-DP3
[81.460568] Dynamic subtest B-DP3: SUCCESS (8.057s)
[81.468786] Starting dynamic subtest: C-DP3
[89.516770] Dynamic subtest C-DP3: SUCCESS (8.053s)
[89.525506] Starting dynamic subtest: D-DP3
[97.575392] Dynamic subtest D-DP3: SUCCESS (8.057s)
[97.577392] Subtest wf_vblank-ts-check: SUCCESS (32.323s)
[97.884161] [004/131] (922s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[98.076083] Subtest addfb25-x-tiled-legacy: SKIP (0.000s)
[98.211644] [005/131] (922s left) gem_exec_params (rel-constants-invalid-rel-gen5)
[98.298103] Starting subtest: rel-constants-invalid-rel-gen5
[98.299015] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s)
[98.464453] [006/131] (922s left) kms_pm_rpm (basic-pci-d3-state)
[100.088342] Starting subtest: basic-pci-d3-state
[101.064422] Subtest basic-pci-d3-state: SUCCESS (0.976s)
[101.313344] [007/131] (919s left) gem_mmap_gtt (fault-concurrent)
[101.383976] Subtest fault-concurrent: SKIP (0.000s)
[101.496096] [008/131] (919s left) kms_frontbuffer_tracking (psr-modesetfrombusy)
[101.688479] Starting subtest: psr-modesetfrombusy
[101.690180] Subtest psr-modesetfrombusy: SKIP (0.000s)
[101.807630] [009/131] (919s left) gem_exec_params (sol-reset-invalid)
[101.883579] Starting subtest: sol-reset-invalid
[101.885716] Subtest sol-reset-invalid: SUCCESS (0.002s)
[102.052997] [010/131] (918s left) kms_psr (fbc-pr-cursor-plane-move)
[102.241522] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s)
[102.300361] [011/131] (918s left) kms_vblank (query-busy-hang)
[102.493184] Starting subtest: query-busy-hang
[102.495076] Starting dynamic subtest: pipe-A-DP-3
[128.556128] Dynamic subtest pipe-A-DP-3: SUCCESS (26.059s)
[128.565582] Starting dynamic subtest: pipe-D-DP-3
[153.583780] Dynamic subtest pipe-D-DP-3: SUCCESS (25.024s)
[153.584552] Subtest query-busy-hang: SUCCESS (51.087s)
[153.821906] [012/131] (867s left) sw_sync (sync_random_merge)
[153.866331] Starting subtest: sync_random_merge
[153.928527] Subtest sync_random_merge: SUCCESS (0.062s)
[153.998305] [013/131] (867s left) kms_atomic_interruptible (legacy-dpms)
[154.185939] Starting subtest: legacy-dpms
[154.186862] Starting dynamic subtest: pipe-A-DP-3
[160.525243] Dynamic subtest pipe-A-DP-3: SUCCESS (6.338s)
[160.526134] Subtest legacy-dpms: SUCCESS (6.339s)
[160.752738] [014/131] (860s left) gem_exec_schedule (u-semaphore-resolve)
[160.840818] Starting subtest: u-semaphore-resolve
[160.924922] Subtest u-semaphore-resolve: SUCCESS (0.084s)
[161.302109] [015/131] (859s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-upscaling)
[161.500539] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-upscaling
[161.502946] Starting dynamic subtest: pipe-A-valid-mode
[161.584270] Dynamic subtest pipe-A-valid-mode: SKIP (0.082s)
[161.586010] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-upscaling: SKIP (0.083s)
[161.793092] [016/131] (859s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt)
[161.988613] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt
[161.990279] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[162.137701] [017/131] (859s left) syncobj_timeline (single-wait-available-signaled)
[162.207012] Starting subtest: single-wait-available-signaled
[162.208072] Subtest single-wait-available-signaled: SUCCESS (0.000s)
[162.364997] [018/131] (859s left) gem_mmap_gtt (basic-small-bo)
[162.443800] Subtest basic-small-bo: SKIP (0.000s)
[162.511334] [019/131] (859s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-pwrite)
[162.703615] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-pwrite
[162.705267] Subtest fbc-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[162.849417] [020/131] (858s left) gem_softpin (noreloc-s3)
[162.929430] Starting subtest: noreloc-S3
[183.789487] Subtest noreloc-S3: SUCCESS (5.466s)
[183.920825] [021/131] (837s left) kms_flip (2x-flip-vs-dpms-on-nop)
[184.107606] Starting subtest: 2x-flip-vs-dpms-on-nop
[184.122139] Subtest 2x-flip-vs-dpms-on-nop: SKIP (0.014s)
[184.226732] [022/131] (837s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[184.412886] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[184.413795] Starting dynamic subtest: pipe-A-valid-mode
[186.257804] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.844s)
[186.258809] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (1.845s)
[186.520013] [023/131] (835s left) kms_async_flips (async-flip-suspend-resume)
[186.706920] Starting subtest: async-flip-suspend-resume
[186.936939] Starting dynamic subtest: pipe-A-DP-3
[207.391857] Dynamic subtest pipe-A-DP-3: SUCCESS (4.908s)
[207.588544] Starting dynamic subtest: pipe-B-DP-3
[227.624108] Dynamic subtest pipe-B-DP-3: SUCCESS (4.498s)
[227.800183] Starting dynamic subtest: pipe-C-DP-3
[247.844267] Dynamic subtest pipe-C-DP-3: SUCCESS (4.566s)
[248.020721] Starting dynamic subtest: pipe-D-DP-3
[267.090228] Dynamic subtest pipe-D-DP-3: SUCCESS (3.798s)
[267.091068] Subtest async-flip-suspend-resume: SUCCESS (18.527s)
[267.491825] [024/131] (754s left) kms_lease (lease-revoke)
[267.678170] Starting subtest: lease-revoke
[267.679103] Starting dynamic subtest: pipe-A-DP-3
[267.781853] Dynamic subtest pipe-A-DP-3: SUCCESS (0.103s)
[267.792717] Starting dynamic subtest: pipe-B-DP-3
[267.865869] Dynamic subtest pipe-B-DP-3: SUCCESS (0.075s)
[267.875981] Starting dynamic subtest: pipe-C-DP-3
[267.934734] Dynamic subtest pipe-C-DP-3: SUCCESS (0.075s)
[267.944423] Starting dynamic subtest: pipe-D-DP-3
[268.011407] Dynamic subtest pipe-D-DP-3: SUCCESS (0.076s)
[268.012309] Subtest lease-revoke: SUCCESS (0.334s)
[268.170469] [025/131] (753s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite)
[268.363922] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite
[268.365730] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[268.502296] [026/131] (753s left) gem_ccs (block-multicopy-inplace)
[268.585421] Starting subtest: block-multicopy-inplace
[268.586342] Starting dynamic subtest: linear-compressed-compfmt0-smem-lmem0-multicopy
[268.630267] Dynamic subtest linear-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.044s)
[268.640285] Starting dynamic subtest: linear-compressed-compfmt0-lmem0-lmem0-multicopy
[268.728512] Dynamic subtest linear-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.098s)
[268.738436] Starting dynamic subtest: xmajor-compressed-compfmt0-smem-lmem0-multicopy
[268.745061] Dynamic subtest xmajor-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.016s)
[268.754999] Starting dynamic subtest: xmajor-compressed-compfmt0-lmem0-lmem0-multicopy
[268.851678] Dynamic subtest xmajor-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.106s)
[268.861767] Starting dynamic subtest: tile4-compressed-compfmt0-smem-lmem0-multicopy
[268.866768] Dynamic subtest tile4-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.014s)
[268.876688] Starting dynamic subtest: tile4-compressed-compfmt0-lmem0-lmem0-multicopy
[268.970421] Dynamic subtest tile4-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.103s)
[268.980480] Starting dynamic subtest: tile64-compressed-compfmt0-smem-lmem0-multicopy
[268.985508] Dynamic subtest tile64-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.014s)
[268.995412] Starting dynamic subtest: tile64-compressed-compfmt0-lmem0-lmem0-multicopy
[269.083927] Dynamic subtest tile64-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.098s)
[269.084828] Subtest block-multicopy-inplace: SUCCESS (0.499s)
[269.237521] [027/131] (752s left) kms_plane_cursor (viewport)
[269.426265] Starting subtest: viewport
[269.428092] Starting dynamic subtest: pipe-A-DP-3-size-64
[272.979304] Dynamic subtest pipe-A-DP-3-size-64: SUCCESS (3.552s)
[273.057449] Starting dynamic subtest: pipe-A-DP-3-size-128
[276.562968] Dynamic subtest pipe-A-DP-3-size-128: SUCCESS (3.516s)
[276.643583] Starting dynamic subtest: pipe-A-DP-3-size-256
[280.179935] Dynamic subtest pipe-A-DP-3-size-256: SUCCESS (3.549s)
[280.352494] Starting dynamic subtest: pipe-B-DP-3-size-64
[283.926056] Dynamic subtest pipe-B-DP-3-size-64: SUCCESS (3.585s)
[283.986533] Starting dynamic subtest: pipe-B-DP-3-size-128
[287.476427] Dynamic subtest pipe-B-DP-3-size-128: SUCCESS (3.500s)
[287.560651] Starting dynamic subtest: pipe-B-DP-3-size-256
[291.076551] Dynamic subtest pipe-B-DP-3-size-256: SUCCESS (3.549s)
[291.201290] Starting dynamic subtest: pipe-C-DP-3-size-64
[294.678300] Dynamic subtest pipe-C-DP-3-size-64: SUCCESS (3.490s)
[294.737955] Starting dynamic subtest: pipe-C-DP-3-size-128
[298.245044] Dynamic subtest pipe-C-DP-3-size-128: SUCCESS (3.516s)
[298.308024] Starting dynamic subtest: pipe-C-DP-3-size-256
[301.811349] Dynamic subtest pipe-C-DP-3-size-256: SUCCESS (3.516s)
[301.966181] Starting dynamic subtest: pipe-D-DP-3-size-64
[305.506969] Dynamic subtest pipe-D-DP-3-size-64: SUCCESS (3.551s)
[305.593215] Starting dynamic subtest: pipe-D-DP-3-size-128
[309.039853] Dynamic subtest pipe-D-DP-3-size-128: SUCCESS (3.482s)
[309.101193] Starting dynamic subtest: pipe-D-DP-3-size-256
[312.606290] Dynamic subtest pipe-D-DP-3-size-256: SUCCESS (3.516s)
[312.719072] Subtest viewport: SUCCESS (43.291s)
[312.996354] [028/131] (709s left) kms_rotation_crc (cursor-rotation-180)
[313.185386] Starting subtest: cursor-rotation-180
[314.021158] Subtest cursor-rotation-180: SUCCESS (0.835s)
[314.350408] [029/131] (707s left) sysfs_heartbeat_interval (nopreempt)
[314.429871] Starting subtest: nopreempt
[314.430874] Starting dynamic subtest: vecs0
[318.749187] Dynamic subtest vecs0: SUCCESS (4.318s)
[318.760420] Starting dynamic subtest: ccs0
[323.021033] Dynamic subtest ccs0: SUCCESS (4.271s)
[323.032449] Starting dynamic subtest: vcs0
[327.215031] Dynamic subtest vcs0: SUCCESS (4.193s)
[327.225973] Starting dynamic subtest: bcs0
[331.413188] Dynamic subtest bcs0: SUCCESS (4.197s)
[331.424091] Starting dynamic subtest: vecs1
[335.628203] Dynamic subtest vecs1: SUCCESS (4.214s)
[335.639390] Starting dynamic subtest: rcs0
[339.962080] Dynamic subtest rcs0: SUCCESS (4.333s)
[339.974532] Starting dynamic subtest: vcs1
[344.186186] Dynamic subtest vcs1: SUCCESS (4.223s)
[344.187105] Subtest nopreempt: SUCCESS (29.756s)
[344.361721] [030/131] (677s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic)
[344.546799] Starting subtest: 2x-cursor-vs-flip-atomic
[344.550150] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.002s)
[344.636800] [031/131] (677s left) gem_eio (in-flight-internal-10ms)
[344.941244] Starting subtest: in-flight-internal-10ms
[346.105381] Subtest in-flight-internal-10ms: SUCCESS (1.164s)
[346.324962] [032/131] (676s left) kms_ccs (crc-primary-basic-y-tiled-gen12-mc-ccs)
[346.511366] Starting subtest: crc-primary-basic-y-tiled-gen12-mc-ccs
[346.513788] Starting dynamic subtest: pipe-A-DP-3
[346.522154] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[346.533118] Starting dynamic subtest: pipe-B-DP-3
[346.541385] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[346.551866] Starting dynamic subtest: pipe-C-DP-3
[346.560028] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[346.570522] Starting dynamic subtest: pipe-D-DP-3
[346.580651] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[346.582771] Subtest crc-primary-basic-y-tiled-gen12-mc-ccs: SKIP (0.009s)
[346.965058] [033/131] (675s left) gem_exec_schedule (preempt-queue)
[347.054838] Subtest preempt-queue: SKIP (0.000s)
[347.391462] [034/131] (675s left) gem_mmap (basic-small-bo)
[347.463065] Subtest basic-small-bo: SKIP (0.000s)
[347.527097] [035/131] (675s left) gen9_exec_parse (bb-chained)
[347.606337] Subtest bb-chained: SKIP (0.000s)
[347.676327] [036/131] (674s left) gem_fence_thrash (bo-write-verify-threaded-x)
[347.720814] Starting subtest: bo-write-verify-threaded-x
[347.749163] Subtest bo-write-verify-threaded-x: SKIP (0.028s)
[347.865288] [037/131] (674s left) syncobj_wait (multi-wait-all-for-submit-submitted-signaled)
[347.936404] Starting subtest: multi-wait-all-for-submit-submitted-signaled
[348.056043] Subtest multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.108s)
[348.172881] [038/131] (674s left) kms_vblank (wait-forked-busy)
[348.361406] Starting subtest: wait-forked-busy
[348.363799] Starting dynamic subtest: pipe-A-DP-3
[350.885456] Dynamic subtest pipe-A-DP-3: SUCCESS (2.520s)
[350.912386] Starting dynamic subtest: pipe-D-DP-3
[353.358306] Dynamic subtest pipe-D-DP-3: SUCCESS (2.465s)
[353.359226] Subtest wait-forked-busy: SUCCESS (4.997s)
[353.596665] [039/131] (669s left) kms_frontbuffer_tracking (fbcpsr-2p-indfb-fliptrack-mmap-gtt)
[353.790019] Starting subtest: fbcpsr-2p-indfb-fliptrack-mmap-gtt
[353.791754] Subtest fbcpsr-2p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[353.925263] [040/131] (669s left) gem_tiled_fence_blits (basic)
[353.999966] Subtest basic: SKIP (0.000s)
[354.081973] [041/131] (668s left) gem_exec_balancer (parallel-contexts)
[354.472792] Starting subtest: parallel-contexts
[361.079706] Subtest parallel-contexts: SUCCESS (6.607s)
[361.185376] [042/131] (661s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-blt)
[361.375124] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-blt
[361.376857] Subtest fbc-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[361.509476] [043/131] (661s left) gem_set_tiling_vs_blt (untiled-to-tiled)
[361.587492] Subtest untiled-to-tiled: SKIP (0.000s)
[361.664610] [044/131] (661s left) gem_render_copy (y-tiled-ccs-to-yf-tiled)
[361.742300] Starting subtest: y-tiled-ccs-to-yf-tiled
[361.744407] Subtest y-tiled-ccs-to-yf-tiled: SKIP (0.000s)
[361.969297] [045/131] (661s left) prime_vgem (fence-flip-hang)
[362.144080] Subtest fence-flip-hang: SKIP (0.000s)
[362.292553] [FACT prime_vgem (fence-flip-hang)] new: kernel.kmod_is_loaded.vgem: true
[362.294701] [046/131] (661s left) gem_ctx_param (invalid-ctx-get)
[362.372627] Starting subtest: invalid-ctx-get
[362.373517] Subtest invalid-ctx-get: SUCCESS (0.000s)
[362.493584] [047/131] (660s left) kms_cursor_legacy (cursorb-vs-flipa-varying-size)
[362.689834] Starting subtest: cursorB-vs-flipA-varying-size
[362.693163] Subtest cursorB-vs-flipA-varying-size: SKIP (0.002s)
[362.794723] [048/131] (660s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[362.999647] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu
[363.001266] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[363.173529] [049/131] (660s left) syncobj_eventfd (timeline-wait-signaled)
[363.255183] Starting subtest: timeline-wait-signaled
[363.256200] Subtest timeline-wait-signaled: SUCCESS (0.000s)
[363.381664] [050/131] (660s left) gem_exec_whisper (basic-queues-all)
[363.474416] Starting subtest: basic-queues-all
[385.284648] Subtest basic-queues-all: SUCCESS (21.809s)
[385.531013] [051/131] (638s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-plflip-blt)
[385.731886] Starting subtest: fbcpsr-2p-scndscrn-indfb-plflip-blt
[385.733506] Subtest fbcpsr-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s)
[385.882566] [052/131] (637s left) perf (sysctl-defaults)
[385.972892] Starting subtest: sysctl-defaults
[385.973809] Subtest sysctl-defaults: SUCCESS (0.000s)
[386.303453] [053/131] (637s left) gem_mmap_gtt (hang-user)
[386.386064] Subtest hang-user: SKIP (0.000s)
[386.449800] [054/131] (637s left) core_hotunplug (unbind-rebind)
[386.588487] Starting subtest: unbind-rebind
[390.260974] Subtest unbind-rebind: SUCCESS (3.672s)
[390.312291] [055/131] (633s left) api_intel_allocator (two-level-inception)
[390.389180] Starting subtest: two-level-inception
[395.799788] Subtest two-level-inception: SUCCESS (5.410s)
[395.976435] [056/131] (628s left) perf (blocking-parameterized)
[396.365809] Starting subtest: blocking-parameterized
[416.399274] Subtest blocking-parameterized: SUCCESS (20.034s)
[416.513233] [057/131] (607s left) kms_selftest (drm_format_helper)
[416.575157] Starting subtest: drm_format_helper
[416.589789] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8
[416.676382] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8: SUCCESS (0.086s)
[416.715672] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332
[416.759354] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332: SUCCESS (0.079s)
[416.792321] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565
[416.850616] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565: SUCCESS (0.089s)
[416.892393] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555
[416.925040] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555: SUCCESS (0.071s)
[416.944313] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555
[417.006785] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555: SUCCESS (0.080s)
[417.047022] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551
[417.113358] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551: SUCCESS (0.103s)
[417.155460] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888
[417.198203] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888: SUCCESS (0.081s)
[417.230784] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888
[417.280401] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888: SUCCESS (0.081s)
[417.323847] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888
[417.361840] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888: SUCCESS (0.076s)
[417.386472] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010
[417.456441] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010: SUCCESS (0.090s)
[417.496311] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010
[417.532545] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010: SUCCESS (0.075s)
[417.553286] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_mono
[417.614482] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_mono: SUCCESS (0.079s)
[417.656195] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_swab
[417.687095] Dynamic subtest drm_format_helper_test-drm_test_fb_swab: SUCCESS (0.070s)
[417.704736] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888
[417.773462] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888: SUCCESS (0.083s)
[417.815783] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888
[417.851626] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888: SUCCESS (0.075s)
[417.872350] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_clip_offset
[417.936068] Dynamic subtest drm_format_helper_test-drm_test_fb_clip_offset: SUCCESS (0.081s)
[417.983696] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_memcpy
[418.018181] Dynamic subtest drm_format_helper_test-drm_test_fb_memcpy: SUCCESS (0.079s)
[418.019100] Subtest drm_format_helper: SUCCESS (1.443s)
[418.223971] [058/131] (605s left) kms_flip (modeset-vs-vblank-race)
[418.425964] Starting subtest: modeset-vs-vblank-race
[418.430390] Starting dynamic subtest: A-DP3
[421.612028] Dynamic subtest A-DP3: SUCCESS (3.181s)
[421.657121] Starting dynamic subtest: B-DP3
[424.819886] Dynamic subtest B-DP3: SUCCESS (3.202s)
[424.864782] Starting dynamic subtest: C-DP3
[428.070040] Dynamic subtest C-DP3: SUCCESS (3.244s)
[428.113822] Starting dynamic subtest: D-DP3
[431.172748] Dynamic subtest D-DP3: SUCCESS (3.097s)
[431.181256] Subtest modeset-vs-vblank-race: SUCCESS (12.754s)
[431.555362] [059/131] (592s left) kms_chamelium_frames (dp-crc-multiple)
[431.832426] Subtest dp-crc-multiple: SKIP (0.000s)
[431.984424] [060/131] (592s left) gem_exec_reloc (basic-concurrent16)
[432.071146] Subtest basic-concurrent16: SKIP (0.000s)
[432.154158] [061/131] (592s left) kms_cursor_crc (cursor-offscreen-512x512)
[432.620403] Starting subtest: cursor-offscreen-512x512
[432.622166] Subtest cursor-offscreen-512x512: SKIP (0.001s)
[432.891881] [062/131] (591s left) kms_pipe_stress (stress-xrgb8888-4tiled)
[433.092689] Starting subtest: stress-xrgb8888-4tiled
[441.320432] Subtest stress-xrgb8888-4tiled: SUCCESS (8.231s)
[441.573775] [063/131] (583s left) kms_big_fb (linear-64bpp-rotate-0)
[441.788138] Starting subtest: linear-64bpp-rotate-0
[443.684720] Subtest linear-64bpp-rotate-0: SUCCESS (1.895s)
[443.889810] [064/131] (580s left) prime_mmap (test_aperture_limit)
[443.970269] Starting subtest: test_aperture_limit
[443.971180] Starting dynamic subtest: test_aperture_limit-smem
[443.982575] Dynamic subtest test_aperture_limit-smem: SKIP (0.011s)
[443.984359] Subtest test_aperture_limit: SKIP (0.012s)
[444.095594] [065/131] (580s left) gem_ctx_shared (detached-shared-gtt)
[444.185374] Starting subtest: detached-shared-gtt
[446.336050] Subtest detached-shared-gtt: SUCCESS (2.150s)
[449.090797] [066/131] (575s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[449.298062] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip
[449.299834] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[449.448970] [067/131] (575s left) kms_big_fb (4-tiled-8bpp-rotate-0)
[449.656881] Starting subtest: 4-tiled-8bpp-rotate-0
[451.201843] Subtest 4-tiled-8bpp-rotate-0: SUCCESS (1.544s)
[451.418872] [068/131] (573s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-sf)
[451.617284] Subtest psr2-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[451.705355] [069/131] (573s left) kms_properties (invalid-properties-legacy)
[451.905405] Starting subtest: invalid-properties-legacy
[452.060727] Subtest invalid-properties-legacy: SUCCESS (0.155s)
[452.151800] [070/131] (572s left) gem_ctx_engines (none)
[452.243740] Starting subtest: none
[452.246170] Subtest none: SUCCESS (0.002s)
[452.488706] [071/131] (572s left) kms_flip (dpms-off-confusion-interruptible)
[452.687843] Starting subtest: dpms-off-confusion-interruptible
[452.692505] Starting dynamic subtest: A-DP3
[460.505331] Dynamic subtest A-DP3: SUCCESS (7.812s)
[460.519823] Starting dynamic subtest: B-DP3
[468.254289] Dynamic subtest B-DP3: SUCCESS (7.747s)
[468.269486] Starting dynamic subtest: C-DP3
[476.004019] Dynamic subtest C-DP3: SUCCESS (7.747s)
[476.046742] Starting dynamic subtest: D-DP3
[483.762698] Dynamic subtest D-DP3: SUCCESS (7.754s)
[483.765080] Subtest dpms-off-confusion-interruptible: SUCCESS (31.075s)
[484.081639] [072/131] (541s left) gem_vm_create (execbuf)
[484.167378] Starting subtest: execbuf
[484.176040] Subtest execbuf: SUCCESS (0.010s)
[484.320444] [073/131] (540s left) kms_ccs (bad-pixel-format-4-tiled-dg2-mc-ccs)
[484.512404] Starting subtest: bad-pixel-format-4-tiled-dg2-mc-ccs
[484.514739] Starting dynamic subtest: pipe-A-DP-3
[484.522380] Dynamic subtest pipe-A-DP-3: SUCCESS (0.002s)
[484.534579] Starting dynamic subtest: pipe-B-DP-3
[484.542216] Dynamic subtest pipe-B-DP-3: SUCCESS (0.002s)
[484.554225] Starting dynamic subtest: pipe-C-DP-3
[484.561849] Dynamic subtest pipe-C-DP-3: SUCCESS (0.002s)
[484.573364] Starting dynamic subtest: pipe-D-DP-3
[484.581891] Dynamic subtest pipe-D-DP-3: SUCCESS (0.002s)
[484.582871] Subtest bad-pixel-format-4-tiled-dg2-mc-ccs: SUCCESS (0.015s)
[484.981533] [074/131] (540s left) prime_self_import (reimport-vs-gem_close-race)
[485.029388] Starting subtest: reimport-vs-gem_close-race
[490.122166] Subtest reimport-vs-gem_close-race: SUCCESS (5.093s)
[490.239378] [075/131] (535s left) syncobj_timeline (invalid-transfer-illegal-handle)
[490.349270] Starting subtest: invalid-transfer-illegal-handle
[490.350778] Subtest invalid-transfer-illegal-handle: SUCCESS (0.000s)
[490.524298] [076/131] (535s left) kms_invalid_mode (bad-hsync-start)
[490.723973] Starting subtest: bad-hsync-start
[490.724860] Starting dynamic subtest: pipe-A-DP-3
[490.802163] Dynamic subtest pipe-A-DP-3: SUCCESS (0.077s)
[490.818847] Starting dynamic subtest: pipe-B-DP-3
[490.820090] Dynamic subtest pipe-B-DP-3: SUCCESS (0.001s)
[490.834530] Starting dynamic subtest: pipe-C-DP-3
[490.835424] Dynamic subtest pipe-C-DP-3: SUCCESS (0.001s)
[490.847454] Starting dynamic subtest: pipe-D-DP-3
[490.848342] Dynamic subtest pipe-D-DP-3: SUCCESS (0.001s)
[490.849196] Subtest bad-hsync-start: SUCCESS (0.087s)
[491.048837] [077/131] (534s left) gem_exec_nop (basic-series)
[491.139181] Starting subtest: basic-series
[495.486018] Subtest basic-series: SUCCESS (4.346s)
[495.749492] [078/131] (529s left) kms_big_fb (yf-tiled-8bpp-rotate-0)
[495.955171] Starting subtest: yf-tiled-8bpp-rotate-0
[495.957007] Subtest yf-tiled-8bpp-rotate-0: SKIP (0.000s)
[496.102243] [079/131] (529s left) kms_big_fb (x-tiled-addfb)
[496.307091] Starting subtest: x-tiled-addfb
[496.307966] Subtest x-tiled-addfb: SUCCESS (0.000s)
[496.442620] [080/131] (529s left) vgem_basic (dmabuf-fence-before)
[496.502468] Starting subtest: dmabuf-fence-before
[496.503345] Subtest dmabuf-fence-before: SUCCESS (0.001s)
[496.600290] [081/131] (529s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[496.915992] Starting subtest: cursor-rapid-movement-32x10
[496.965428] Subtest cursor-rapid-movement-32x10: SKIP (0.047s)
[497.394512] [082/131] (528s left) gen9_exec_parse (allowed-single)
[497.481337] Subtest allowed-single: SKIP (0.000s)
[497.564205] [083/131] (528s left) gem_workarounds (suspend-resume-fd)
[497.668929] Starting subtest: suspend-resume-fd
[516.310096] Subtest suspend-resume-fd: SUCCESS (3.731s)
[516.429002] [084/131] (509s left) gem_mmap_offset (partial-mmap)
[516.507720] Starting subtest: partial-mmap
[516.508662] Starting dynamic subtest: lmem0
[516.513997] Dynamic subtest lmem0: SUCCESS (0.006s)
[516.528036] Starting dynamic subtest: smem0
[516.529044] Dynamic subtest smem0: SUCCESS (0.004s)
[516.529883] Subtest partial-mmap: SUCCESS (0.012s)
[516.708359] [085/131] (509s left) kms_cursor_legacy (long-nonblocking-modeset-vs-cursor-atomic)
[516.911275] Starting subtest: long-nonblocking-modeset-vs-cursor-atomic
[520.182902] Subtest long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (3.270s)
[520.458407] [086/131] (505s left) syncobj_timeline (signal-array)
[520.536784] Starting subtest: signal-array
[520.537813] Subtest signal-array: SUCCESS (0.000s)
[520.675519] [087/131] (505s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[520.875394] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[520.877396] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[521.025273] [088/131] (505s left) kms_psr (psr2-cursor-mmap-gtt)
[521.222659] Subtest psr2-cursor-mmap-gtt: SKIP (0.000s)
[521.291498] [089/131] (505s left) kms_cursor_edge_walk (64x64-right-edge)
[521.489025] Starting subtest: 64x64-right-edge
[521.491572] Starting dynamic subtest: pipe-A-DP-3
[524.959766] Dynamic subtest pipe-A-DP-3: SUCCESS (3.468s)
[524.983040] Starting dynamic subtest: pipe-D-DP-3
[528.324517] Dynamic subtest pipe-D-DP-3: SUCCESS (3.361s)
[528.326017] Subtest 64x64-right-edge: SUCCESS (6.836s)
[528.589564] [090/131] (497s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted)
[528.665800] Starting subtest: invalid-multi-wait-all-unsubmitted
[528.666743] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[528.842270] [091/131] (497s left) gem_pxp (dmabuf-shared-protected-dst-is-context-refcounted)
[531.447540] Starting subtest: dmabuf-shared-protected-dst-is-context-refcounted
[531.449595] Subtest dmabuf-shared-protected-dst-is-context-refcounted: SKIP (0.000s)
[531.550912] [092/131] (495s left) gem_lmem_swapping (heavy-random)
[534.177317] Starting subtest: heavy-random
[534.178160] Starting dynamic subtest: lmem0
[538.913175] Dynamic subtest lmem0: SUCCESS (4.735s)
[538.914049] Subtest heavy-random: SUCCESS (4.736s)
[540.109522] [FACT gem_lmem_swapping (heavy-random)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[540.110574] [FACT gem_lmem_swapping (heavy-random)] deleted: kernel.kmod_is_loaded.i915: true
[540.112514] [093/131] (486s left) kms_color (ctm-blue-to-red)
[541.745949] Starting subtest: ctm-blue-to-red
[541.746861] Starting dynamic subtest: pipe-A-DP-3
[542.448027] Dynamic subtest pipe-A-DP-3: SUCCESS (0.700s)
[542.472484] Starting dynamic subtest: pipe-B-DP-3
[543.084320] Dynamic subtest pipe-B-DP-3: SUCCESS (0.633s)
[543.105996] Starting dynamic subtest: pipe-C-DP-3
[543.721240] Dynamic subtest pipe-C-DP-3: SUCCESS (0.633s)
[543.745212] Starting dynamic subtest: pipe-D-DP-3
[544.380793] Dynamic subtest pipe-D-DP-3: SUCCESS (0.656s)
[544.382598] Subtest ctm-blue-to-red: SUCCESS (2.636s)
[544.602554] [FACT kms_color (ctm-blue-to-red)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[544.604860] [FACT kms_color (ctm-blue-to-red)] new: kernel.kmod_is_loaded.i915: true
[544.607716] [094/131] (482s left) gem_exec_reloc (basic-gtt-active)
[544.697614] Subtest basic-gtt-active: SKIP (0.000s)
[544.780685] [095/131] (482s left) kms_ccs (ccs-on-another-bo-yf-tiled-ccs)
[544.973973] Starting subtest: ccs-on-another-bo-yf-tiled-ccs
[544.976500] Starting dynamic subtest: pipe-A-DP-3
[544.985032] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[544.995350] Starting dynamic subtest: pipe-B-DP-3
[545.003624] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[545.013944] Starting dynamic subtest: pipe-C-DP-3
[545.023848] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[545.034106] Starting dynamic subtest: pipe-D-DP-3
[545.044285] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[545.046465] Subtest ccs-on-another-bo-yf-tiled-ccs: SKIP (0.007s)
[545.428359] [096/131] (481s left) gem_exec_params (invalid-batch-start-offset)
[545.516829] Starting subtest: invalid-batch-start-offset
[545.519180] Subtest invalid-batch-start-offset: SUCCESS (0.002s)
[545.703943] [097/131] (481s left) kms_chamelium_frames (vga-frame-dump)
[545.980073] Subtest vga-frame-dump: SKIP (0.000s)
[546.131886] [098/131] (480s left) i915_pm_rpm (gem-idle)
[548.181354] Starting subtest: gem-idle
[553.687928] Subtest gem-idle: SUCCESS (5.504s)
[553.987742] [099/131] (473s left) kms_atomic_transition (plane-use-after-nonblocking-unbind)
[554.189110] Starting subtest: plane-use-after-nonblocking-unbind
[554.191598] Starting dynamic subtest: pipe-A-DP-3
[554.278504] Dynamic subtest pipe-A-DP-3: SUCCESS (0.087s)
[554.408825] Starting dynamic subtest: pipe-B-DP-3
[554.612227] Dynamic subtest pipe-B-DP-3: SUCCESS (0.222s)
[554.686404] Subtest plane-use-after-nonblocking-unbind: SUCCESS (0.497s)
[554.932592] [100/131] (472s left) kms_fbcon_fbt (psr)
[555.014915] Starting subtest: psr
[555.016810] Subtest psr: SKIP (0.000s)
[555.189114] [101/131] (472s left) dumb_buffer (invalid-bpp)
[555.266775] Starting subtest: invalid-bpp
[555.267729] Subtest invalid-bpp: SUCCESS (0.000s)
[555.396936] [102/131] (472s left) kms_flip (flip-vs-dpms-off-vs-modeset-interruptible)
[555.604445] Starting subtest: flip-vs-dpms-off-vs-modeset-interruptible
[555.606849] Starting dynamic subtest: A-DP3
[556.566387] Dynamic subtest A-DP3: SUCCESS (0.959s)
[556.579633] Starting dynamic subtest: B-DP3
[557.309191] Dynamic subtest B-DP3: SUCCESS (0.741s)
[557.320469] Starting dynamic subtest: C-DP3
[558.004989] Dynamic subtest C-DP3: SUCCESS (0.695s)
[558.017541] Starting dynamic subtest: D-DP3
[558.725482] Dynamic subtest D-DP3: SUCCESS (0.718s)
[558.726359] Subtest flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (3.123s)
[558.996623] [103/131] (468s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc)
[559.196997] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc
[559.199357] Starting dynamic subtest: pipe-A-DP-3
[559.207680] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[559.218335] Starting dynamic subtest: pipe-B-DP-3
[559.226552] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[559.237109] Starting dynamic subtest: pipe-C-DP-3
[559.245292] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[559.256157] Starting dynamic subtest: pipe-D-DP-3
[559.266830] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[559.268953] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SKIP (0.007s)
[559.663357] [104/131] (467s left) sw_sync (sync_busy_fork)
[559.711979] Starting subtest: sync_busy_fork
[560.737579] Subtest sync_busy_fork: SUCCESS (1.024s)
[560.880773] [105/131] (466s left) gem_softpin (safe-alignment)
[560.968155] Starting subtest: safe-alignment
[561.030163] Subtest safe-alignment: SUCCESS (0.062s)
[561.194176] [106/131] (466s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[561.403722] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-cpu
[561.405435] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[561.571799] [107/131] (466s left) i915_pm_rps (thresholds-idle-park)
[561.662603] Starting subtest: thresholds-idle-park
[561.664549] Subtest thresholds-idle-park: SKIP (0.000s)
[561.806648] [108/131] (466s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[561.890849] Subtest no-spare-fences-interruptible: SKIP (0.000s)
[561.958201] [109/131] (465s left) kms_psr (pr-cursor-render)
[562.155608] Subtest pr-cursor-render: SKIP (0.000s)
[562.225462] [110/131] (465s left) gem_exec_fence (nb-await)
[562.469849] Starting subtest: nb-await
[562.470905] Starting dynamic subtest: rcs0
[562.573484] Dynamic subtest rcs0: SUCCESS (0.105s)
[562.589827] Starting dynamic subtest: bcs0
[562.639026] Dynamic subtest bcs0: SUCCESS (0.064s)
[562.655785] Starting dynamic subtest: vcs0
[562.705824] Dynamic subtest vcs0: SUCCESS (0.064s)
[562.730595] Starting dynamic subtest: vcs1
[562.780605] Dynamic subtest vcs1: SUCCESS (0.072s)
[562.823588] Starting dynamic subtest: vecs0
[562.875768] Dynamic subtest vecs0: SUCCESS (0.090s)
[562.918949] Starting dynamic subtest: vecs1
[562.968469] Dynamic subtest vecs1: SUCCESS (0.088s)
[562.985675] Starting dynamic subtest: ccs0
[563.035395] Dynamic subtest ccs0: SUCCESS (0.065s)
[563.036496] Subtest nb-await: SUCCESS (0.568s)
[563.778053] [111/131] (464s left) kms_psr2_sf (fbc-pr-primary-plane-update-sf-dmg-area)
[563.997466] Subtest fbc-pr-primary-plane-update-sf-dmg-area: SKIP (0.000s)
[564.058843] [112/131] (464s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt)
[564.258436] Starting subtest: fbcpsr-rgb101010-draw-blt
[564.260163] Subtest fbcpsr-rgb101010-draw-blt: SKIP (0.000s)
[564.423648] [113/131] (463s left) kms_content_protection (dp-mst-type-1)
[564.694976] Starting subtest: dp-mst-type-1
[564.696653] Subtest dp-mst-type-1: SKIP (0.000s)
[564.875352] [114/131] (463s left) perf (stress-open-close)
[565.225457] Starting subtest: stress-open-close
[565.226327] Starting dynamic subtest: 0-rcs0
[567.488331] Dynamic subtest 0-rcs0: SUCCESS (2.263s)
[567.489579] Subtest stress-open-close: SUCCESS (2.264s)
[567.555345] [115/131] (460s left) kms_plane_scaling (plane-upscale-factor-0-25-with-rotation)
[567.751943] Starting subtest: plane-upscale-factor-0-25-with-rotation
[567.752856] Starting dynamic subtest: pipe-A
[568.114797] Dynamic subtest pipe-A: SUCCESS (0.362s)
[568.130604] Starting dynamic subtest: pipe-B
[568.597007] Dynamic subtest pipe-B: SUCCESS (0.481s)
[568.613488] Starting dynamic subtest: pipe-C
[569.062448] Dynamic subtest pipe-C: SUCCESS (0.463s)
[569.087576] Starting dynamic subtest: pipe-D
[569.561022] Dynamic subtest pipe-D: SUCCESS (0.496s)
[569.562140] Subtest plane-upscale-factor-0-25-with-rotation: SUCCESS (1.809s)
[569.910918] [116/131] (458s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-pwrite)
[570.113407] Starting subtest: psr-1p-primscrn-cur-indfb-draw-pwrite
[570.115111] Subtest psr-1p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[570.256907] [117/131] (458s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff)
[570.456264] Starting subtest: psr-2p-primscrn-spr-indfb-onoff
[570.457915] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[570.614353] [118/131] (457s left) gem_eio (wait-immediate)
[570.905875] Starting subtest: wait-immediate
[571.487784] Subtest wait-immediate: SUCCESS (0.582s)
[571.704590] [119/131] (456s left) sw_sync (alloc_fence)
[571.753742] Starting subtest: alloc_fence
[571.754623] Subtest alloc_fence: SUCCESS (0.000s)
[571.829533] [120/131] (456s left) kms_chamelium_color (ctm-0-25)
[572.025592] Subtest ctm-0-25: SKIP (0.000s)
[572.092217] [121/131] (456s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt)
[572.292455] Starting subtest: psr-1p-primscrn-indfb-plflip-blt
[572.294237] Subtest psr-1p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[572.448458] [122/131] (456s left) kms_pm_rpm (modeset-non-lpsp-stress)
[574.275147] Starting subtest: modeset-non-lpsp-stress
[579.566505] Subtest modeset-non-lpsp-stress: SUCCESS (5.291s)
[579.823647] [123/131] (449s left) i915_hangman (detector)
[579.920507] Starting subtest: detector
[579.921419] Starting dynamic subtest: rcs0
[589.367010] Dynamic subtest rcs0: SUCCESS (9.446s)
[589.381014] Starting dynamic subtest: bcs0
[599.328792] Dynamic subtest bcs0: SUCCESS (9.960s)
[599.342283] Starting dynamic subtest: vcs0
[609.371911] Dynamic subtest vcs0: SUCCESS (10.041s)
[609.384305] Starting dynamic subtest: vcs1
[619.393700] Dynamic subtest vcs1: SUCCESS (10.021s)
[619.407112] Starting dynamic subtest: vecs0
[629.337814] Dynamic subtest vecs0: SUCCESS (9.943s)
[629.351155] Starting dynamic subtest: vecs1
[639.353003] Dynamic subtest vecs1: SUCCESS (10.014s)
[639.367964] Starting dynamic subtest: ccs0
[649.303782] Dynamic subtest ccs0: SUCCESS (9.949s)
[649.304726] Subtest detector: SUCCESS (69.382s)
[649.447467] [124/131] (379s left) kms_dp_link_training (uhbr-mst)
[649.641958] Starting subtest: uhbr-mst
[649.643708] Subtest uhbr-mst: SKIP (0.000s)
[649.736328] [125/131] (379s left) gem_eio (context-create)
[650.094365] Starting subtest: context-create
[650.551798] Subtest context-create: SUCCESS (0.458s)
[650.773718] [126/131] (378s left) perf_pmu (init-busy)
[650.844890] Starting subtest: init-busy
[650.847750] Starting dynamic subtest: rcs0
[650.848630] Dynamic subtest rcs0: SUCCESS (0.003s)
[650.861971] Starting dynamic subtest: bcs0
[650.862835] Dynamic subtest bcs0: SUCCESS (0.001s)
[650.874872] Starting dynamic subtest: vcs0
[650.876123] Dynamic subtest vcs0: SUCCESS (0.001s)
[650.890226] Starting dynamic subtest: vcs1
[650.891370] Dynamic subtest vcs1: SUCCESS (0.000s)
[650.903435] Starting dynamic subtest: vecs0
[650.904603] Dynamic subtest vecs0: SUCCESS (0.000s)
[650.916602] Starting dynamic subtest: vecs1
[650.917510] Dynamic subtest vecs1: SUCCESS (0.000s)
[650.929292] Starting dynamic subtest: ccs0
[650.930282] Dynamic subtest ccs0: SUCCESS (0.001s)
[650.931513] Subtest init-busy: SUCCESS (0.013s)
[650.982317] [127/131] (378s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[651.186811] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[652.449535] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.262s)
[652.667294] [128/131] (376s left) kms_psr (fbc-psr2-primary-mmap-cpu)
[652.865657] Subtest fbc-psr2-primary-mmap-cpu: SKIP (0.000s)
[652.954182] [129/131] (376s left) kms_big_fb (y-tiled-8bpp-rotate-0)
[653.160680] Starting subtest: y-tiled-8bpp-rotate-0
[653.162425] Subtest y-tiled-8bpp-rotate-0: SKIP (0.000s)
[653.332236] [130/131] (375s left) gem_ctx_persistence (hang)
[653.417793] Starting subtest: hang
[653.419996] Subtest hang: SKIP (0.000s)
[653.565882] [131/131] (375s left) syncobj_wait (single-wait-for-submit-unsubmitted)
[653.644894] Starting subtest: single-wait-for-submit-unsubmitted
[653.746859] Subtest single-wait-for-submit-unsubmitted: SUCCESS (0.101s)
[653.881988] Closing watchdogs
results: parsing output: 0/ for test: kms_psr
results: parsing output: 1/ for test: kms_plane
results: parsing output: 2/ for test: kms_flip
results: parsing output: 3/ for test: kms_addfb_basic
results: parsing output: 4/ for test: gem_exec_params
results: parsing output: 5/ for test: kms_pm_rpm
results: parsing output: 6/ for test: gem_mmap_gtt
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: gem_exec_params
results: parsing output: 9/ for test: kms_psr
results: parsing output: 10/ for test: kms_vblank
results: parsing output: 11/ for test: sw_sync
results: parsing output: 12/ for test: kms_atomic_interruptible
results: parsing output: 13/ for test: gem_exec_schedule
results: parsing output: 14/ for test: kms_flip_scaled_crc
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: syncobj_timeline
results: parsing output: 17/ for test: gem_mmap_gtt
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: gem_softpin
results: parsing output: 20/ for test: kms_flip
results: parsing output: 21/ for test: kms_flip_scaled_crc
results: parsing output: 22/ for test: kms_async_flips
results: parsing output: 23/ for test: kms_lease
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: gem_ccs
results: parsing output: 26/ for test: kms_plane_cursor
results: parsing output: 27/ for test: kms_rotation_crc
results: parsing output: 28/ for test: sysfs_heartbeat_interval
results: parsing output: 29/ for test: kms_cursor_legacy
results: parsing output: 30/ for test: gem_eio
results: parsing output: 31/ for test: kms_ccs
results: parsing output: 32/ for test: gem_exec_schedule
results: parsing output: 33/ for test: gem_mmap
results: parsing output: 34/ for test: gen9_exec_parse
results: parsing output: 35/ for test: gem_fence_thrash
results: parsing output: 36/ for test: syncobj_wait
results: parsing output: 37/ for test: kms_vblank
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: gem_tiled_fence_blits
results: parsing output: 40/ for test: gem_exec_balancer
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: gem_set_tiling_vs_blt
results: parsing output: 43/ for test: gem_render_copy
results: parsing output: 44/ for test: prime_vgem
results: parsing output: 45/ for test: gem_ctx_param
results: parsing output: 46/ for test: kms_cursor_legacy
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: syncobj_eventfd
results: parsing output: 49/ for test: gem_exec_whisper
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: perf
results: parsing output: 52/ for test: gem_mmap_gtt
results: parsing output: 53/ for test: core_hotunplug
results: parsing output: 54/ for test: api_intel_allocator
results: parsing output: 55/ for test: perf
results: parsing output: 56/ for test: kms_selftest
results: parsing output: 57/ for test: kms_flip
results: parsing output: 58/ for test: kms_chamelium_frames
results: parsing output: 59/ for test: gem_exec_reloc
results: parsing output: 60/ for test: kms_cursor_crc
results: parsing output: 61/ for test: kms_pipe_stress
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: prime_mmap
results: parsing output: 64/ for test: gem_ctx_shared
results: parsing output: 65/ for test: kms_big_fb
results: parsing output: 66/ for test: kms_big_fb
results: parsing output: 67/ for test: kms_psr2_sf
results: parsing output: 68/ for test: kms_properties
results: parsing output: 69/ for test: gem_ctx_engines
results: parsing output: 70/ for test: kms_flip
results: parsing output: 71/ for test: gem_vm_create
results: parsing output: 72/ for test: kms_ccs
results: parsing output: 73/ for test: prime_self_import
results: parsing output: 74/ for test: syncobj_timeline
results: parsing output: 75/ for test: kms_invalid_mode
results: parsing output: 76/ for test: gem_exec_nop
results: parsing output: 77/ for test: kms_big_fb
results: parsing output: 78/ for test: kms_big_fb
results: parsing output: 79/ for test: vgem_basic
results: parsing output: 80/ for test: kms_cursor_crc
results: parsing output: 81/ for test: gen9_exec_parse
results: parsing output: 82/ for test: gem_workarounds
results: parsing output: 83/ for test: gem_mmap_offset
results: parsing output: 84/ for test: kms_cursor_legacy
results: parsing output: 85/ for test: syncobj_timeline
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_psr
results: parsing output: 88/ for test: kms_cursor_edge_walk
results: parsing output: 89/ for test: syncobj_timeline
results: parsing output: 90/ for test: gem_pxp
results: parsing output: 91/ for test: gem_lmem_swapping
results: parsing output: 92/ for test: kms_color
results: parsing output: 93/ for test: gem_exec_reloc
results: parsing output: 94/ for test: kms_ccs
results: parsing output: 95/ for test: gem_exec_params
results: parsing output: 96/ for test: kms_chamelium_frames
results: parsing output: 97/ for test: i915_pm_rpm
results: parsing output: 98/ for test: kms_atomic_transition
results: parsing output: 99/ for test: kms_fbcon_fbt
results: parsing output: 100/ for test: dumb_buffer
results: parsing output: 101/ for test: kms_flip
results: parsing output: 102/ for test: kms_ccs
results: parsing output: 103/ for test: sw_sync
results: parsing output: 104/ for test: gem_softpin
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: i915_pm_rps
results: parsing output: 107/ for test: gem_fenced_exec_thrash
results: parsing output: 108/ for test: kms_psr
results: parsing output: 109/ for test: gem_exec_fence
results: parsing output: 110/ for test: kms_psr2_sf
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_content_protection
results: parsing output: 113/ for test: perf
results: parsing output: 114/ for test: kms_plane_scaling
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: gem_eio
results: parsing output: 118/ for test: sw_sync
results: parsing output: 119/ for test: kms_chamelium_color
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: kms_pm_rpm
results: parsing output: 122/ for test: i915_hangman
results: parsing output: 123/ for test: kms_dp_link_training
results: parsing output: 124/ for test: gem_eio
results: parsing output: 125/ for test: perf_pmu
results: parsing output: 126/ for test: kms_big_fb
results: parsing output: 127/ for test: kms_psr
results: parsing output: 128/ for test: kms_big_fb
results: parsing output: 129/ for test: gem_ctx_persistence
results: parsing output: 130/ for test: syncobj_wait
Done.