[58.831566] Initializing watchdogs
[58.831613]   /dev/watchdog0
[58.845914] [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]
[58.850743] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.852895] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.854877] [001/132] (960s left) gem_pxp (verify-pxp-stale-ctx-execution)
[58.983753] Starting subtest: verify-pxp-stale-ctx-execution
[60.049537] Subtest verify-pxp-stale-ctx-execution: SUCCESS (1.071s)
[60.199914] [002/132] (959s left) kms_color_pipeline (plane-lut1d-lut1d)
[60.298034] Starting subtest: plane-lut1d-lut1d
[60.324098] Starting dynamic subtest: pipe-A-eDP-1
[60.776809] Dynamic subtest pipe-A-eDP-1: FAIL (0.308s)
[61.673144] Starting dynamic subtest: pipe-B-eDP-1
[62.152697] Dynamic subtest pipe-B-eDP-1: FAIL (0.291s)
[62.996826] Starting dynamic subtest: pipe-C-eDP-1
[63.462117] Dynamic subtest pipe-C-eDP-1: FAIL (0.258s)
[64.334127] Starting dynamic subtest: pipe-D-eDP-1
[64.795903] Dynamic subtest pipe-D-eDP-1: FAIL (0.246s)
[64.862314] Subtest plane-lut1d-lut1d: FAIL (4.577s)
[65.723409] [003/132] (953s left) template (a)
[65.789247] Starting subtest: A
[65.790348] Subtest A: SUCCESS (0.000s)
[65.920432] [004/132] (953s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[66.027154] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[66.028074] Starting dynamic subtest: pipe-A-default-mode
[68.759687] Dynamic subtest pipe-A-default-mode: SUCCESS (2.735s)
[68.760623] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (2.737s)
[69.624269] [005/132] (949s left) gem_mmap_offset (partial-remap)
[69.681766] Starting subtest: partial-remap
[69.682828] Starting dynamic subtest: smem0
[69.686405] Dynamic subtest smem0: SUCCESS (0.004s)
[69.687226] Subtest partial-remap: SUCCESS (0.004s)
[69.788628] [006/132] (949s left) kms_chamelium_hpd (hdmi-hpd-after-suspend)
[70.167294] Subtest hdmi-hpd-after-suspend: SKIP (0.000s)
[70.980512] [007/132] (948s left) kms_frontbuffer_tracking (fbc-tiling-y)
[71.068327] Starting subtest: fbc-tiling-y
[71.070178] Subtest fbc-tiling-y: SKIP (0.000s)
[71.185943] [008/132] (948s left) kms_cursor_legacy (flip-vs-cursor-varying-size)
[71.295707] Starting subtest: flip-vs-cursor-varying-size
[79.851988] Subtest flip-vs-cursor-varying-size: SUCCESS (8.559s)
[80.659358] [009/132] (938s left) kms_plane_cursor (primary)
[80.755441] Starting subtest: primary
[80.757507] Starting dynamic subtest: pipe-A-eDP-1-size-64
[83.331080] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.576s)
[83.354638] Starting dynamic subtest: pipe-A-eDP-1-size-128
[85.864244] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.516s)
[85.888585] Starting dynamic subtest: pipe-A-eDP-1-size-256
[88.442986] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.561s)
[88.755363] Starting dynamic subtest: pipe-B-eDP-1-size-64
[92.041402] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.293s)
[92.065544] Starting dynamic subtest: pipe-B-eDP-1-size-128
[94.609817] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.549s)
[94.633062] Starting dynamic subtest: pipe-B-eDP-1-size-256
[97.210305] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.582s)
[97.539917] Starting dynamic subtest: pipe-C-eDP-1-size-64
[100.398156] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.875s)
[100.421816] Starting dynamic subtest: pipe-C-eDP-1-size-128
[102.551772] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.136s)
[102.579151] Starting dynamic subtest: pipe-C-eDP-1-size-256
[104.707371] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.136s)
[105.019847] Starting dynamic subtest: pipe-D-eDP-1-size-64
[107.938960] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.925s)
[107.964925] Starting dynamic subtest: pipe-D-eDP-1-size-128
[110.094412] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.136s)
[110.120264] Starting dynamic subtest: pipe-D-eDP-1-size-256
[112.294635] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.180s)
[112.600567] Subtest primary: SUCCESS (31.846s)
[113.492379] [010/132] (906s left) gem_ctx_persistence (saturated-hostile)
[113.550951] Starting subtest: saturated-hostile
[113.551890] Starting dynamic subtest: rcs0
[114.417994] Dynamic subtest rcs0: SUCCESS (0.866s)
[114.428525] Starting dynamic subtest: bcs0
[115.212056] Dynamic subtest bcs0: SUCCESS (0.792s)
[115.225142] Starting dynamic subtest: vcs0
[116.026567] Dynamic subtest vcs0: SUCCESS (0.810s)
[116.034508] Starting dynamic subtest: vcs1
[116.803221] Dynamic subtest vcs1: SUCCESS (0.777s)
[116.812475] Starting dynamic subtest: vecs0
[117.620605] Dynamic subtest vecs0: SUCCESS (0.816s)
[117.630290] Starting dynamic subtest: ccs0
[118.474980] Dynamic subtest ccs0: SUCCESS (0.853s)
[118.476193] Subtest saturated-hostile: SUCCESS (4.925s)
[118.570927] [011/132] (901s left) gem_ctx_shared (q-out-order)
[118.629465] Starting subtest: Q-out-order
[118.630328] Starting dynamic subtest: rcs0
[118.836829] Dynamic subtest rcs0: SUCCESS (0.204s)
[118.850344] Starting dynamic subtest: vcs0
[118.936320] Dynamic subtest vcs0: SUCCESS (0.101s)
[118.949879] Starting dynamic subtest: vcs1
[119.042855] Dynamic subtest vcs1: SUCCESS (0.105s)
[119.056736] Starting dynamic subtest: vecs0
[119.142767] Dynamic subtest vecs0: SUCCESS (0.099s)
[119.156982] Starting dynamic subtest: ccs0
[119.258583] Dynamic subtest ccs0: SUCCESS (0.115s)
[119.259792] Subtest Q-out-order: SUCCESS (0.629s)
[120.025197] [FACT gem_ctx_shared (q-out-order)] new: kernel.kmod_is_loaded.vgem: true
[120.027015] [012/132] (899s left) gem_exec_params (larger-than-life-batch)
[120.093302] Starting subtest: larger-than-life-batch
[122.341510] Subtest larger-than-life-batch: SUCCESS (2.247s)
[122.965897] [013/132] (896s left) gem_mmap_offset (pf-nonblock)
[123.053279] Starting subtest: pf-nonblock
[123.065189] Subtest pf-nonblock: SUCCESS (0.012s)
[123.173848] [014/132] (896s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[123.275911] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[123.276711] Starting dynamic subtest: pipe-A-eDP-1
[123.279912] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[123.286758] Starting dynamic subtest: pipe-B-eDP-1
[123.289974] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[123.296427] Starting dynamic subtest: pipe-C-eDP-1
[123.299822] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[123.306055] Starting dynamic subtest: pipe-D-eDP-1
[123.309309] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[123.310884] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[125.545903] [015/132] (894s left) vgem_basic (bad-flag)
[125.593954] Starting subtest: bad-flag
[125.594964] Subtest bad-flag: SUCCESS (0.000s)
[125.667490] [016/132] (894s left) vgem_basic (dmabuf-fence-before)
[125.703115] Starting subtest: dmabuf-fence-before
[125.704194] Subtest dmabuf-fence-before: SUCCESS (0.000s)
[125.780095] [017/132] (894s left) gem_eio (wait-1us)
[126.003649] Starting subtest: wait-1us
[126.339407] Subtest wait-1us: SUCCESS (0.336s)
[126.517438] [018/132] (893s left) kms_pm_rpm (pm-caching)
[128.056955] Starting subtest: pm-caching
[128.059285] Subtest pm-caching: SKIP (0.000s)
[128.776689] [019/132] (891s left) gem_exec_balancer (bonded-pair)
[128.846961] Starting subtest: bonded-pair
[128.848940] Subtest bonded-pair: SKIP (0.000s)
[129.182495] [020/132] (890s left) kms_psr (fbc-psr-suspend)
[129.282269] Starting subtest: fbc-psr-suspend
[129.283085] Starting dynamic subtest: eDP-1
[129.284841] Dynamic subtest eDP-1: SKIP (0.000s)
[129.286499] Subtest fbc-psr-suspend: SKIP (0.001s)
[129.375944] [021/132] (890s left) gem_exec_reloc (basic-wc)
[129.435986] Subtest basic-wc: SKIP (0.000s)
[129.509693] [022/132] (890s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[129.611535] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-gtt
[129.613160] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[129.728326] [023/132] (890s left) i915_drm_fdinfo (memory-info-purgeable)
[129.764538] Starting subtest: memory-info-purgeable
[129.765455] Starting dynamic subtest: smem0
[132.366052] Dynamic subtest smem0: SUCCESS (2.600s)
[132.367851] Subtest memory-info-purgeable: SUCCESS (2.601s)
[132.459911] [024/132] (887s left) kms_hdr (invalid-hdr)
[132.560050] Starting subtest: invalid-hdr
[134.661690] Starting dynamic subtest: pipe-A-eDP-1
[137.635886] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.974s)
[137.637035] Subtest invalid-hdr: SUCCESS (5.076s)
[137.791960] [025/132] (882s left) kms_flip_tiling (flip-change-tiling)
[137.879531] Starting subtest: flip-change-tiling
[137.880386] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-mc-ccs
[139.154429] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.274s)
[139.165068] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs
[139.300823] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.142s)
[139.310622] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[139.445705] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.142s)
[139.454350] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4
[139.588046] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4: SUCCESS (0.142s)
[139.599668] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-x
[139.732019] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-x: SUCCESS (0.142s)
[139.743436] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-linear
[139.876429] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.142s)
[139.887616] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-mc-ccs
[140.010381] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.131s)
[140.022346] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs
[140.121417] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.109s)
[140.132634] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[140.256703] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.131s)
[140.266574] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4
[140.399269] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4: SUCCESS (0.142s)
[140.409618] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-x
[140.543090] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-x: SUCCESS (0.142s)
[140.554631] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-linear
[140.687837] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.142s)
[140.699585] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[140.821178] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.131s)
[140.831890] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[140.967624] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.142s)
[140.977302] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[141.076854] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.109s)
[141.087938] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4
[141.210263] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.131s)
[141.221446] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-x
[141.354445] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.142s)
[141.367110] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-linear
[141.498636] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.142s)
[141.511467] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-mc-ccs
[141.643411] Dynamic subtest pipe-A-eDP-1-4-to-4-mc-ccs: SUCCESS (0.142s)
[141.654909] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-rc-ccs
[141.788468] Dynamic subtest pipe-A-eDP-1-4-to-4-rc-ccs: SUCCESS (0.142s)
[141.803330] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-rc-ccs-cc
[141.932271] Dynamic subtest pipe-A-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.141s)
[141.943081] Starting dynamic subtest: pipe-A-eDP-1-4-to-4
[142.054817] Dynamic subtest pipe-A-eDP-1-4-to-4: SUCCESS (0.119s)
[142.065966] Starting dynamic subtest: pipe-A-eDP-1-4-to-x
[142.198769] Dynamic subtest pipe-A-eDP-1-4-to-x: SUCCESS (0.142s)
[142.209510] Starting dynamic subtest: pipe-A-eDP-1-4-to-linear
[142.343293] Dynamic subtest pipe-A-eDP-1-4-to-linear: SUCCESS (0.142s)
[142.365028] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-mc-ccs
[142.532511] Dynamic subtest pipe-A-eDP-1-x-to-4-mc-ccs: SUCCESS (0.186s)
[142.544233] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-rc-ccs
[142.676577] Dynamic subtest pipe-A-eDP-1-x-to-4-rc-ccs: SUCCESS (0.142s)
[142.687909] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-rc-ccs-cc
[142.821072] Dynamic subtest pipe-A-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.142s)
[142.832610] Starting dynamic subtest: pipe-A-eDP-1-x-to-4
[142.976740] Dynamic subtest pipe-A-eDP-1-x-to-4: SUCCESS (0.153s)
[142.987776] Starting dynamic subtest: pipe-A-eDP-1-x-to-x
[143.099530] Dynamic subtest pipe-A-eDP-1-x-to-x: SUCCESS (0.120s)
[143.110958] Starting dynamic subtest: pipe-A-eDP-1-x-to-linear
[143.243882] Dynamic subtest pipe-A-eDP-1-x-to-linear: SUCCESS (0.142s)
[143.255767] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-mc-ccs
[143.388340] Dynamic subtest pipe-A-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.142s)
[143.399785] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-rc-ccs
[143.532182] Dynamic subtest pipe-A-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.142s)
[143.542838] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-rc-ccs-cc
[143.678041] Dynamic subtest pipe-A-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.142s)
[143.688084] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4
[143.821536] Dynamic subtest pipe-A-eDP-1-linear-to-4: SUCCESS (0.142s)
[143.832580] Starting dynamic subtest: pipe-A-eDP-1-linear-to-x
[143.966032] Dynamic subtest pipe-A-eDP-1-linear-to-x: SUCCESS (0.142s)
[143.976855] Starting dynamic subtest: pipe-A-eDP-1-linear-to-linear
[144.088302] Dynamic subtest pipe-A-eDP-1-linear-to-linear: SUCCESS (0.120s)
[144.139216] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-mc-ccs
[145.387221] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.254s)
[145.398603] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs
[145.522419] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.131s)
[145.532417] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[145.655729] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.131s)
[145.665541] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4
[145.798215] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4: SUCCESS (0.142s)
[145.812879] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-x
[145.969924] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-x: SUCCESS (0.169s)
[145.981145] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-linear
[146.114486] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.142s)
[146.125487] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-mc-ccs
[146.259404] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.142s)
[146.270239] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs
[146.381519] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.119s)
[146.393570] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[146.527973] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.141s)
[146.537957] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4
[146.670349] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4: SUCCESS (0.142s)
[146.680852] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-x
[146.814306] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-x: SUCCESS (0.142s)
[146.825975] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-linear
[146.959027] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.141s)
[146.970936] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[147.103906] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.142s)
[147.115304] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[147.238578] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.131s)
[147.248686] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[147.358950] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.120s)
[147.368734] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4
[147.516370] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.153s)
[147.525405] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-x
[147.658893] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.142s)
[147.669069] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-linear
[147.803190] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.142s)
[147.813856] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-mc-ccs
[147.947959] Dynamic subtest pipe-B-eDP-1-4-to-4-mc-ccs: SUCCESS (0.142s)
[147.958555] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-rc-ccs
[148.092202] Dynamic subtest pipe-B-eDP-1-4-to-4-rc-ccs: SUCCESS (0.142s)
[148.102951] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-rc-ccs-cc
[148.259162] Dynamic subtest pipe-B-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.163s)
[148.270315] Starting dynamic subtest: pipe-B-eDP-1-4-to-4
[148.381370] Dynamic subtest pipe-B-eDP-1-4-to-4: SUCCESS (0.119s)
[148.392308] Starting dynamic subtest: pipe-B-eDP-1-4-to-x
[148.525455] Dynamic subtest pipe-B-eDP-1-4-to-x: SUCCESS (0.142s)
[148.536409] Starting dynamic subtest: pipe-B-eDP-1-4-to-linear
[148.670275] Dynamic subtest pipe-B-eDP-1-4-to-linear: SUCCESS (0.142s)
[148.679323] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-mc-ccs
[148.814272] Dynamic subtest pipe-B-eDP-1-x-to-4-mc-ccs: SUCCESS (0.142s)
[148.825184] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-rc-ccs
[148.959066] Dynamic subtest pipe-B-eDP-1-x-to-4-rc-ccs: SUCCESS (0.142s)
[148.969764] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-rc-ccs-cc
[149.103481] Dynamic subtest pipe-B-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.142s)
[149.114689] Starting dynamic subtest: pipe-B-eDP-1-x-to-4
[149.247833] Dynamic subtest pipe-B-eDP-1-x-to-4: SUCCESS (0.142s)
[149.258655] Starting dynamic subtest: pipe-B-eDP-1-x-to-x
[149.369999] Dynamic subtest pipe-B-eDP-1-x-to-x: SUCCESS (0.120s)
[149.380270] Starting dynamic subtest: pipe-B-eDP-1-x-to-linear
[149.514863] Dynamic subtest pipe-B-eDP-1-x-to-linear: SUCCESS (0.142s)
[149.525654] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-mc-ccs
[149.658815] Dynamic subtest pipe-B-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.142s)
[149.669224] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-rc-ccs
[149.803207] Dynamic subtest pipe-B-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.142s)
[149.814557] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-rc-ccs-cc
[149.947742] Dynamic subtest pipe-B-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.142s)
[149.958577] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4
[150.092382] Dynamic subtest pipe-B-eDP-1-linear-to-4: SUCCESS (0.142s)
[150.102476] Starting dynamic subtest: pipe-B-eDP-1-linear-to-x
[150.236870] Dynamic subtest pipe-B-eDP-1-linear-to-x: SUCCESS (0.142s)
[150.247491] Starting dynamic subtest: pipe-B-eDP-1-linear-to-linear
[150.359033] Dynamic subtest pipe-B-eDP-1-linear-to-linear: SUCCESS (0.120s)
[150.410461] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-mc-ccs
[151.618909] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.215s)
[151.630231] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs
[151.718972] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.098s)
[151.728630] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[151.818979] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s)
[151.830297] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4
[151.930270] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4: SUCCESS (0.109s)
[151.941307] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-x
[152.040884] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-x: SUCCESS (0.109s)
[152.051079] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-linear
[152.190680] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.148s)
[152.198900] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-mc-ccs
[152.290880] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.099s)
[152.301510] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs
[152.391222] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.098s)
[152.402252] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[152.491019] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s)
[152.502409] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4
[152.602271] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4: SUCCESS (0.109s)
[152.613783] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-x
[152.712869] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-x: SUCCESS (0.109s)
[152.723902] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-linear
[152.824191] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.109s)
[152.834676] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[152.924465] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.098s)
[152.935887] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[153.024445] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.098s)
[153.035495] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[153.124493] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.098s)
[153.134296] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4
[153.235486] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.109s)
[153.247278] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-x
[153.346144] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.109s)
[153.357059] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-linear
[153.457368] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.109s)
[153.467930] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-mc-ccs
[153.557994] Dynamic subtest pipe-C-eDP-1-4-to-4-mc-ccs: SUCCESS (0.098s)
[153.567922] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-rc-ccs
[153.669061] Dynamic subtest pipe-C-eDP-1-4-to-4-rc-ccs: SUCCESS (0.109s)
[153.680855] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-rc-ccs-cc
[153.780094] Dynamic subtest pipe-C-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.109s)
[153.791400] Starting dynamic subtest: pipe-C-eDP-1-4-to-4
[153.891351] Dynamic subtest pipe-C-eDP-1-4-to-4: SUCCESS (0.109s)
[153.902968] Starting dynamic subtest: pipe-C-eDP-1-4-to-x
[154.001790] Dynamic subtest pipe-C-eDP-1-4-to-x: SUCCESS (0.109s)
[154.011059] Starting dynamic subtest: pipe-C-eDP-1-4-to-linear
[154.112948] Dynamic subtest pipe-C-eDP-1-4-to-linear: SUCCESS (0.109s)
[154.123907] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-mc-ccs
[154.224107] Dynamic subtest pipe-C-eDP-1-x-to-4-mc-ccs: SUCCESS (0.109s)
[154.234699] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-rc-ccs
[154.335161] Dynamic subtest pipe-C-eDP-1-x-to-4-rc-ccs: SUCCESS (0.109s)
[154.345371] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-rc-ccs-cc
[154.446208] Dynamic subtest pipe-C-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.110s)
[154.456812] Starting dynamic subtest: pipe-C-eDP-1-x-to-4
[154.617216] Dynamic subtest pipe-C-eDP-1-x-to-4: SUCCESS (0.169s)
[154.627782] Starting dynamic subtest: pipe-C-eDP-1-x-to-x
[154.728216] Dynamic subtest pipe-C-eDP-1-x-to-x: SUCCESS (0.109s)
[154.739979] Starting dynamic subtest: pipe-C-eDP-1-x-to-linear
[154.839695] Dynamic subtest pipe-C-eDP-1-x-to-linear: SUCCESS (0.109s)
[154.851711] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-mc-ccs
[154.950362] Dynamic subtest pipe-C-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.109s)
[154.960764] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-rc-ccs
[155.050468] Dynamic subtest pipe-C-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.098s)
[155.069624] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-rc-ccs-cc
[155.161761] Dynamic subtest pipe-C-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.110s)
[155.172167] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4
[155.272634] Dynamic subtest pipe-C-eDP-1-linear-to-4: SUCCESS (0.109s)
[155.283713] Starting dynamic subtest: pipe-C-eDP-1-linear-to-x
[155.384287] Dynamic subtest pipe-C-eDP-1-linear-to-x: SUCCESS (0.109s)
[155.395719] Starting dynamic subtest: pipe-C-eDP-1-linear-to-linear
[155.495276] Dynamic subtest pipe-C-eDP-1-linear-to-linear: SUCCESS (0.109s)
[155.535487] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-mc-ccs
[156.751405] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.221s)
[156.761622] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs
[156.850992] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.098s)
[156.862180] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[156.962250] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.108s)
[156.972031] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4
[157.073200] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4: SUCCESS (0.110s)
[157.082803] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-x
[157.195058] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-x: SUCCESS (0.120s)
[157.205632] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-linear
[157.317279] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.120s)
[157.327975] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-mc-ccs
[157.417855] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.098s)
[157.429276] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs
[157.529042] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.108s)
[157.540387] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[157.629082] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s)
[157.639050] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4
[157.739927] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4: SUCCESS (0.109s)
[157.751534] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-x
[157.850496] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-x: SUCCESS (0.109s)
[157.861052] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-linear
[157.972843] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.120s)
[157.983643] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[158.073563] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.097s)
[158.083398] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[158.173559] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.098s)
[158.183736] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[158.273524] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.098s)
[158.285035] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4
[158.384768] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.109s)
[158.394660] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-x
[158.495035] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.110s)
[158.505721] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-linear
[158.606309] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.109s)
[158.616064] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-mc-ccs
[158.706364] Dynamic subtest pipe-D-eDP-1-4-to-4-mc-ccs: SUCCESS (0.099s)
[158.717689] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-rc-ccs
[158.817449] Dynamic subtest pipe-D-eDP-1-4-to-4-rc-ccs: SUCCESS (0.109s)
[158.828362] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-rc-ccs-cc
[158.928857] Dynamic subtest pipe-D-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.109s)
[158.941262] Starting dynamic subtest: pipe-D-eDP-1-4-to-4
[159.039940] Dynamic subtest pipe-D-eDP-1-4-to-4: SUCCESS (0.109s)
[159.052070] Starting dynamic subtest: pipe-D-eDP-1-4-to-x
[159.150594] Dynamic subtest pipe-D-eDP-1-4-to-x: SUCCESS (0.109s)
[159.162315] Starting dynamic subtest: pipe-D-eDP-1-4-to-linear
[159.261646] Dynamic subtest pipe-D-eDP-1-4-to-linear: SUCCESS (0.109s)
[159.270728] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-mc-ccs
[159.372844] Dynamic subtest pipe-D-eDP-1-x-to-4-mc-ccs: SUCCESS (0.110s)
[159.383580] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-rc-ccs
[159.472847] Dynamic subtest pipe-D-eDP-1-x-to-4-rc-ccs: SUCCESS (0.099s)
[159.482987] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-rc-ccs-cc
[159.572802] Dynamic subtest pipe-D-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.098s)
[159.580971] Starting dynamic subtest: pipe-D-eDP-1-x-to-4
[159.684063] Dynamic subtest pipe-D-eDP-1-x-to-4: SUCCESS (0.110s)
[159.695431] Starting dynamic subtest: pipe-D-eDP-1-x-to-x
[159.795535] Dynamic subtest pipe-D-eDP-1-x-to-x: SUCCESS (0.109s)
[159.807021] Starting dynamic subtest: pipe-D-eDP-1-x-to-linear
[159.906737] Dynamic subtest pipe-D-eDP-1-x-to-linear: SUCCESS (0.109s)
[159.918071] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-mc-ccs
[160.017256] Dynamic subtest pipe-D-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.109s)
[160.027850] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-rc-ccs
[160.117762] Dynamic subtest pipe-D-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.098s)
[160.127104] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-rc-ccs-cc
[160.217285] Dynamic subtest pipe-D-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.099s)
[160.227791] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4
[160.328397] Dynamic subtest pipe-D-eDP-1-linear-to-4: SUCCESS (0.110s)
[160.338313] Starting dynamic subtest: pipe-D-eDP-1-linear-to-x
[160.439863] Dynamic subtest pipe-D-eDP-1-linear-to-x: SUCCESS (0.109s)
[160.451711] Starting dynamic subtest: pipe-D-eDP-1-linear-to-linear
[160.551205] Dynamic subtest pipe-D-eDP-1-linear-to-linear: SUCCESS (0.109s)
[160.583750] Subtest flip-change-tiling: SUCCESS (22.704s)
[161.769439] [026/132] (858s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-blt)
[161.877780] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-blt
[169.098060] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.220s)
[169.251130] [027/132] (850s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[169.352749] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[170.200406] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (0.848s)
[170.388611] [028/132] (849s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-signa
[170.443261] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-signaled
[170.547891] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-signaled: SUCCESS (0.102s)
[170.642889] [029/132] (849s left) gem_exec_fence (syncobj-backward-timeline-chain-engines)
[171.196145] Starting subtest: syncobj-backward-timeline-chain-engines
[171.316473] Subtest syncobj-backward-timeline-chain-engines: SUCCESS (0.123s)
[173.008606] [030/132] (847s left) gem_exec_balancer (sliced)
[173.075629] Starting subtest: sliced
[173.077657] Subtest sliced: SKIP (0.000s)
[173.378884] [031/132] (846s left) perf (oa-exponents)
[173.512203] Starting subtest: oa-exponents
[173.513068] Starting dynamic subtest: 0-rcs0
[175.297677] Dynamic subtest 0-rcs0: SUCCESS (1.783s)
[175.305781] Starting dynamic subtest: 1-vcs0
[177.126395] Dynamic subtest 1-vcs0: SUCCESS (1.828s)
[177.127590] Subtest oa-exponents: SUCCESS (3.612s)
[177.166579] [032/132] (843s left) gem_userptr_blits (stress-mm)
[177.241545] Starting subtest: stress-mm
[182.610728] Subtest stress-mm: SUCCESS (5.369s)
[182.786759] [033/132] (837s left) gem_mmap_gtt (basic-short)
[182.849841] Subtest basic-short: SKIP (0.000s)
[182.915545] [034/132] (837s left) gen7_exec_parse (bitmasks)
[182.983467] Subtest bitmasks: SKIP (0.000s)
[183.068746] [035/132] (837s left) gem_exec_reloc (basic-cpu-wc)
[183.129820] Subtest basic-cpu-wc: SKIP (0.000s)
[183.206643] [036/132] (837s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[183.315696] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip
[183.317623] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[183.425553] [037/132] (837s left) kms_plane (plane-position-covered)
[183.526157] Starting subtest: plane-position-covered
[184.067141] Starting dynamic subtest: pipe-A-plane-1
[185.349676] Dynamic subtest pipe-A-plane-1: SUCCESS (1.282s)
[185.357137] Starting dynamic subtest: pipe-A-plane-2
[186.687329] Dynamic subtest pipe-A-plane-2: SUCCESS (1.337s)
[186.694944] Starting dynamic subtest: pipe-A-plane-3
[187.995093] Dynamic subtest pipe-A-plane-3: SUCCESS (1.307s)
[188.004827] Starting dynamic subtest: pipe-A-plane-4
[189.225952] Dynamic subtest pipe-A-plane-4: SUCCESS (1.230s)
[189.233883] Starting dynamic subtest: pipe-A-plane-5
[189.251547] Dynamic subtest pipe-A-plane-5: SUCCESS (0.024s)
[190.386600] Starting dynamic subtest: pipe-B-plane-1
[191.611398] Dynamic subtest pipe-B-plane-1: SUCCESS (1.231s)
[191.619437] Starting dynamic subtest: pipe-B-plane-2
[192.925377] Dynamic subtest pipe-B-plane-2: SUCCESS (1.314s)
[192.932679] Starting dynamic subtest: pipe-B-plane-3
[194.150352] Dynamic subtest pipe-B-plane-3: SUCCESS (1.223s)
[194.162774] Starting dynamic subtest: pipe-B-plane-4
[195.372322] Dynamic subtest pipe-B-plane-4: SUCCESS (1.222s)
[195.380175] Starting dynamic subtest: pipe-B-plane-5
[195.398460] Dynamic subtest pipe-B-plane-5: SUCCESS (0.025s)
[195.399388] Subtest plane-position-covered: SUCCESS (11.873s)
[196.208959] [038/132] (824s left) gem_exec_schedule (noreorder-corked)
[196.400991] Starting subtest: noreorder-corked
[196.401938] Starting dynamic subtest: rcs0
[197.576950] Dynamic subtest rcs0: SUCCESS (1.177s)
[197.592909] Starting dynamic subtest: vcs0
[198.967031] Dynamic subtest vcs0: SUCCESS (1.385s)
[198.976890] Starting dynamic subtest: vcs1
[200.951939] Dynamic subtest vcs1: SUCCESS (1.982s)
[200.962742] Starting dynamic subtest: vecs0
[202.924215] Dynamic subtest vecs0: SUCCESS (1.972s)
[202.935701] Starting dynamic subtest: ccs0
[204.080890] Dynamic subtest ccs0: SUCCESS (1.154s)
[204.082339] Subtest noreorder-corked: SUCCESS (7.682s)
[204.283638] [039/132] (816s left) kms_cursor_legacy (nonblocking-modeset-vs-cursor-atomic)
[204.413119] Starting subtest: nonblocking-modeset-vs-cursor-atomic
[205.850669] Subtest nonblocking-modeset-vs-cursor-atomic: SUCCESS (1.437s)
[206.667987] [040/132] (813s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc)
[206.768356] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc
[206.769158] Starting dynamic subtest: pipe-A-eDP-1
[206.777321] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[206.785239] Starting dynamic subtest: pipe-B-eDP-1
[206.793404] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[206.800917] Starting dynamic subtest: pipe-C-eDP-1
[206.808789] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[206.816079] Starting dynamic subtest: pipe-D-eDP-1
[206.824238] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[206.825828] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[208.955700] [041/132] (811s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[209.184242] Starting subtest: cursor-rapid-movement-256x256
[209.189415] Starting dynamic subtest: pipe-A-eDP-1
[209.732753] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.543s)
[209.760068] Starting dynamic subtest: pipe-D-eDP-1
[210.929560] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.177s)
[210.930402] Subtest cursor-rapid-movement-256x256: SUCCESS (1.745s)
[211.820015] [042/132] (808s left) sw_sync (sync_multi_consumer_producer)
[211.853263] Starting subtest: sync_multi_consumer_producer
[212.138577] Subtest sync_multi_consumer_producer: SUCCESS (0.283s)
[212.214426] [043/132] (808s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[212.314275] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[212.315916] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[212.437121] [044/132] (808s left) gem_lmem_swapping (massive)
[212.475683] Subtest massive: SKIP (0.000s)
[212.506547] [045/132] (808s left) perf_pmu (semaphore-busy)
[212.539244] Starting subtest: semaphore-busy
[212.540090] Starting dynamic subtest: rcs0
[214.210906] Dynamic subtest rcs0: SUCCESS (1.668s)
[214.220997] Starting dynamic subtest: bcs0
[215.845104] Dynamic subtest bcs0: SUCCESS (1.630s)
[215.855328] Starting dynamic subtest: vcs0
[220.434211] Dynamic subtest vcs0: SUCCESS (4.587s)
[220.443829] Starting dynamic subtest: vcs1
[226.447655] Dynamic subtest vcs1: SUCCESS (6.012s)
[226.456778] Starting dynamic subtest: vecs0
[232.399953] Dynamic subtest vecs0: SUCCESS (5.949s)
[232.409441] Starting dynamic subtest: ccs0
[235.539657] Dynamic subtest ccs0: SUCCESS (3.135s)
[235.540859] Subtest semaphore-busy: SUCCESS (22.998s)
[235.693564] [046/132] (785s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[235.793534] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[235.795115] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[235.923859] [047/132] (784s left) kms_pipe_b_c_ivb (pipe-b-dpms-off-modeset-pipe-c)
[235.968944] Subtest pipe-B-dpms-off-modeset-pipe-C: SKIP (0.000s)
[236.036254] [048/132] (784s left) kms_flip (2x-modeset-vs-vblank-race)
[236.124404] Starting subtest: 2x-modeset-vs-vblank-race
[236.135649] Subtest 2x-modeset-vs-vblank-race: SKIP (0.011s)
[236.275121] [049/132] (784s left) kms_flip (nonexisting-fb)
[236.365504] Starting subtest: nonexisting-fb
[236.367958] Starting dynamic subtest: A-eDP1
[237.490807] Dynamic subtest A-eDP1: SUCCESS (1.123s)
[237.499368] Starting dynamic subtest: B-eDP1
[238.624028] Dynamic subtest B-eDP1: SUCCESS (1.129s)
[238.633760] Starting dynamic subtest: C-eDP1
[239.755702] Dynamic subtest C-eDP1: SUCCESS (1.134s)
[239.764393] Starting dynamic subtest: D-eDP1
[240.883609] Dynamic subtest D-eDP1: SUCCESS (1.127s)
[240.885923] Subtest nonexisting-fb: SUCCESS (4.520s)
[242.067865] [050/132] (778s left) kms_psr (psr-basic)
[242.183715] Starting subtest: psr-basic
[242.185986] Starting dynamic subtest: eDP-1
[243.833079] Dynamic subtest eDP-1: SUCCESS (1.648s)
[243.834050] Subtest psr-basic: SUCCESS (1.650s)
[244.639036] [051/132] (776s left) kms_cursor_legacy (cursorb-vs-flipb-atomic)
[244.767024] Starting subtest: cursorB-vs-flipB-atomic
[244.768773] Subtest cursorB-vs-flipB-atomic: SKIP (0.001s)
[244.944158] [052/132] (776s left) kms_cursor_crc (cursor-alpha-transparent)
[245.039511] Starting subtest: cursor-alpha-transparent
[245.040455] Starting dynamic subtest: pipe-A-eDP-1
[245.635404] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.595s)
[245.643283] Starting dynamic subtest: pipe-D-eDP-1
[246.895762] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.260s)
[246.896709] Subtest cursor-alpha-transparent: SUCCESS (1.857s)
[247.803270] [053/132] (773s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[247.899244] Subtest addfb25-x-tiled-legacy: SKIP (0.000s)
[248.026817] [054/132] (773s left) gem_render_copy (yf-tiled-to-vebox-y-tiled)
[248.084016] Starting subtest: yf-tiled-to-vebox-y-tiled
[248.085985] Subtest yf-tiled-to-vebox-y-tiled: SKIP (0.000s)
[248.287626] [055/132] (772s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[248.374034] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[248.376048] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[248.516355] [056/132] (772s left) kms_addfb_basic (bad-pitch-32)
[248.580676] Starting subtest: bad-pitch-32
[248.581860] Subtest bad-pitch-32: SUCCESS (0.000s)
[248.741779] [057/132] (772s left) kms_flip (flip-vs-rmfb)
[248.835924] Starting subtest: flip-vs-rmfb
[248.837921] Starting dynamic subtest: A-eDP1
[257.471997] Dynamic subtest A-eDP1: SUCCESS (8.635s)
[257.481172] Starting dynamic subtest: B-eDP1
[266.111635] Dynamic subtest B-eDP1: SUCCESS (8.638s)
[266.122296] Starting dynamic subtest: C-eDP1
[274.730175] Dynamic subtest C-eDP1: SUCCESS (8.617s)
[274.740371] Starting dynamic subtest: D-eDP1
[283.360973] Dynamic subtest D-eDP1: SUCCESS (8.629s)
[283.363669] Subtest flip-vs-rmfb: SUCCESS (34.528s)
[284.558655] [058/132] (736s left) kms_ccs (bad-rotation-90-4-tiled-dg2-rc-ccs)
[284.652517] Starting subtest: bad-rotation-90-4-tiled-dg2-rc-ccs
[284.653442] Starting dynamic subtest: pipe-A-eDP-1
[284.661920] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[284.670073] Starting dynamic subtest: pipe-B-eDP-1
[284.678430] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[284.686691] Starting dynamic subtest: pipe-C-eDP-1
[284.695015] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[284.702586] Starting dynamic subtest: pipe-D-eDP-1
[284.711035] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[284.712730] Subtest bad-rotation-90-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[286.833873] [059/132] (734s left) syncobj_wait (multi-wait-all-for-submit-signaled)
[286.890827] Starting subtest: multi-wait-all-for-submit-signaled
[286.891652] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.000s)
[287.009032] [060/132] (734s left) kms_rotation_crc (primary-4-tiled-reflect-x-0)
[287.110771] Starting subtest: primary-4-tiled-reflect-x-0
[294.236133] Subtest primary-4-tiled-reflect-x-0: SUCCESS (7.125s)
[295.516028] [061/132] (725s left) gem_close (basic)
[295.579666] Starting subtest: basic
[295.580564] Subtest basic: SUCCESS (0.000s)
[295.702859] [062/132] (725s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[295.815810] Starting subtest: basic-flip-after-cursor-atomic
[296.747544] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.931s)
[297.563583] [063/132] (723s left) syncobj_timeline (multi-wait-for-submit-signaled)
[297.613474] Starting subtest: multi-wait-for-submit-signaled
[297.614496] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[297.737766] [064/132] (723s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0)
[297.838710] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0
[298.783470] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (0.945s)
[298.934587] [065/132] (722s left) i915_suspend (basic-s3-without-i915)
[298.971986] Starting subtest: basic-s3-without-i915
[300.927431] Subtest basic-s3-without-i915: SKIP (1.953s)
[302.468273] [066/132] (719s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-upscaling)
[302.563371] Starting subtest: flip-32bpp-linear-to-64bpp-linear-upscaling
[302.564206] Starting dynamic subtest: pipe-A-default-mode
[305.249205] Dynamic subtest pipe-A-default-mode: SUCCESS (2.685s)
[305.250147] Subtest flip-32bpp-linear-to-64bpp-linear-upscaling: SUCCESS (2.687s)
[306.133921] [067/132] (715s left) i915_pm_rpm (system-suspend)
[308.063945] Starting subtest: system-suspend
[326.165547] Subtest system-suspend: SUCCESS (3.279s)
[332.569004] [068/132] (695s left) kms_vblank (query-forked-hang)
[332.666783] Starting subtest: query-forked-hang
[332.667702] Starting dynamic subtest: pipe-A-eDP-1
[359.523294] Dynamic subtest pipe-A-eDP-1: SUCCESS (27.037s)
[359.535303] Starting dynamic subtest: pipe-D-eDP-1
[384.511094] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.982s)
[384.512047] Subtest query-forked-hang: SUCCESS (52.027s)
[385.402899] [069/132] (642s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[385.518349] Starting subtest: cursor-vs-flip-atomic
[415.091550] Subtest cursor-vs-flip-atomic: SUCCESS (29.580s)
[415.913057] [070/132] (611s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-blt)
[416.011115] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-blt
[416.012838] Subtest fbc-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[416.147053] [071/132] (611s left) gem_exec_schedule (submit-early-slice)
[416.204791] Starting subtest: submit-early-slice
[416.205640] Starting dynamic subtest: rcs0
[416.248781] Dynamic subtest rcs0: SUCCESS (0.044s)
[416.257993] Starting dynamic subtest: bcs0
[416.285767] Dynamic subtest bcs0: SUCCESS (0.036s)
[416.293871] Starting dynamic subtest: vcs0
[416.325208] Dynamic subtest vcs0: SUCCESS (0.039s)
[416.333030] Starting dynamic subtest: vcs1
[416.363479] Dynamic subtest vcs1: SUCCESS (0.037s)
[416.374011] Starting dynamic subtest: vecs0
[416.400007] Dynamic subtest vecs0: SUCCESS (0.036s)
[416.408271] Starting dynamic subtest: ccs0
[416.436617] Dynamic subtest ccs0: SUCCESS (0.036s)
[416.437512] Subtest submit-early-slice: SUCCESS (0.232s)
[417.861770] [072/132] (609s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[417.983918] Starting subtest: basic-flip-before-cursor-varying-size
[418.909554] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.925s)
[419.751563] [073/132] (607s left) syncobj_timeline (host-signal-ordered)
[419.800279] Starting subtest: host-signal-ordered
[419.801234] Subtest host-signal-ordered: SUCCESS (0.000s)
[419.907956] [074/132] (607s left) kms_big_fb (x-tiled-64bpp-rotate-0)
[420.007070] Starting subtest: x-tiled-64bpp-rotate-0
[421.556535] Subtest x-tiled-64bpp-rotate-0: SUCCESS (1.550s)
[421.777355] [075/132] (606s left) gem_userptr_blits (relocations)
[421.835520] Starting subtest: relocations
[421.837356] Subtest relocations: SKIP (0.000s)
[421.991183] [076/132] (605s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt)
[422.077879] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt
[429.337841] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.262s)
[429.503672] [077/132] (598s left) core_getversion (basic)
[429.537157] Starting subtest: basic
[429.538925] Subtest basic: SUCCESS (0.000s)
[429.625039] [078/132] (598s left) perf (enable-disable)
[429.755109] Starting subtest: enable-disable
[429.755976] Starting dynamic subtest: 0-rcs0
[432.025529] Dynamic subtest 0-rcs0: SUCCESS (2.268s)
[432.033951] Starting dynamic subtest: 1-vcs0
[436.514571] Dynamic subtest 1-vcs0: SUCCESS (4.486s)
[436.516090] Subtest enable-disable: SUCCESS (6.756s)
[436.558000] [079/132] (591s left) gem_softpin (allocator-nopin-reserve)
[436.611266] Starting subtest: allocator-nopin-reserve
[436.723313] Subtest allocator-nopin-reserve: SUCCESS (0.111s)
[436.859376] [080/132] (591s left) kms_multipipe_modeset (basic-max-pipe-crc-check)
[436.958638] Starting subtest: basic-max-pipe-crc-check
[436.960397] Subtest basic-max-pipe-crc-check: SKIP (0.000s)
[437.002018] [081/132] (591s left) kms_psr2_sf (fbc-pr-plane-move-sf-dmg-area)
[442.008378] Starting subtest: fbc-pr-plane-move-sf-dmg-area
[442.012875] Subtest fbc-pr-plane-move-sf-dmg-area: SKIP (0.002s)
[442.868399] [082/132] (585s left) api_intel_allocator (two-level-inception-interruptible)
[442.939018] Starting subtest: two-level-inception-interruptible
[448.346753] Subtest two-level-inception-interruptible: SUCCESS (5.406s)
[448.497438] [083/132] (579s left) kms_flip (wf_vblank-ts-check)
[448.593581] Starting subtest: wf_vblank-ts-check
[448.595742] Starting dynamic subtest: A-eDP1
[457.498555] Dynamic subtest A-eDP1: SUCCESS (8.902s)
[457.507944] Starting dynamic subtest: B-eDP1
[466.440440] Dynamic subtest B-eDP1: SUCCESS (8.940s)
[466.450603] Starting dynamic subtest: C-eDP1
[475.362042] Dynamic subtest C-eDP1: SUCCESS (8.920s)
[475.376003] Starting dynamic subtest: D-eDP1
[484.299836] Dynamic subtest D-eDP1: SUCCESS (8.937s)
[484.303183] Subtest wf_vblank-ts-check: SUCCESS (35.710s)
[485.546371] [084/132] (542s left) syncobj_timeline (wait-delayed-signal)
[485.610561] Starting subtest: wait-delayed-signal
[485.715076] Subtest wait-delayed-signal: SUCCESS (0.102s)
[485.812502] [085/132] (542s left) gem_cs_tlb (engines)
[485.864731] Starting subtest: engines
[485.865697] Starting dynamic subtest: rcs0
[488.019149] Dynamic subtest rcs0: SUCCESS (2.153s)
[488.033464] Starting dynamic subtest: bcs0
[490.171772] Dynamic subtest bcs0: SUCCESS (2.151s)
[490.180640] Starting dynamic subtest: vcs0
[492.324487] Dynamic subtest vcs0: SUCCESS (2.152s)
[492.335205] Starting dynamic subtest: vcs1
[494.476672] Dynamic subtest vcs1: SUCCESS (2.153s)
[494.484901] Starting dynamic subtest: vecs0
[496.629569] Dynamic subtest vecs0: SUCCESS (2.152s)
[496.638563] Starting dynamic subtest: ccs0
[498.781318] Dynamic subtest ccs0: SUCCESS (2.153s)
[498.782631] Subtest engines: SUCCESS (12.919s)
[498.937004] [086/132] (529s left) gem_tiled_blits (interruptible)
[498.999001] Subtest interruptible: SKIP (0.000s)
[499.077026] [087/132] (529s left) kms_joiner (basic-big-joiner)
[499.164124] Starting subtest: basic-big-joiner
[499.166250] Subtest basic-big-joiner: SKIP (0.000s)
[499.252060] [088/132] (529s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs)
[499.341759] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs
[499.342585] Starting dynamic subtest: pipe-A-eDP-1
[499.351797] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[499.360923] Starting dynamic subtest: pipe-B-eDP-1
[499.370371] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[499.378771] Starting dynamic subtest: pipe-C-eDP-1
[499.387539] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[499.395225] Starting dynamic subtest: pipe-D-eDP-1
[499.404316] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[499.405999] Subtest random-ccs-data-4-tiled-dg2-rc-ccs: SKIP (0.004s)
[501.514335] [089/132] (526s left) kms_cursor_crc (cursor-suspend)
[501.642999] Starting subtest: cursor-suspend
[501.644393] Starting dynamic subtest: pipe-A-eDP-1
[535.949069] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.087s)
[535.958663] Starting dynamic subtest: pipe-D-eDP-1
[570.913219] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.458s)
[570.914343] Subtest cursor-suspend: SUCCESS (8.548s)
[577.754923] [090/132] (456s left) gem_tiled_blits (basic)
[577.827473] Subtest basic: SKIP (0.000s)
[577.906077] [091/132] (456s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-render)
[578.010349] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-render
[578.011970] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[578.132791] [092/132] (456s left) gem_exec_reloc (basic-cpu-gtt-active)
[578.196202] Subtest basic-cpu-gtt-active: SKIP (0.000s)
[578.258033] [093/132] (456s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-plflip-blt)
[578.354950] Starting subtest: fbcpsr-2p-primscrn-shrfb-plflip-blt
[578.356832] Subtest fbcpsr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[578.509768] [094/132] (455s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-blt)
[578.599827] Starting subtest: fbcpsr-rgb565-draw-blt
[585.512785] Subtest fbcpsr-rgb565-draw-blt: SUCCESS (7.004s)
[585.677814] [095/132] (448s left) kms_cursor_crc (cursor-offscreen-64x21)
[585.877289] Starting subtest: cursor-offscreen-64x21
[585.917142] Subtest cursor-offscreen-64x21: SKIP (0.039s)
[586.181094] [096/132] (448s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-pwrite)
[586.277167] Starting subtest: psr-2p-primscrn-spr-indfb-draw-pwrite
[586.279068] Subtest psr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[586.419112] [097/132] (448s left) kms_frontbuffer_tracking (fbc-rgb565-draw-blt)
[586.516890] Starting subtest: fbc-rgb565-draw-blt
[590.710977] Subtest fbc-rgb565-draw-blt: SUCCESS (4.218s)
[591.914099] [098/132] (442s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-wc)
[592.012201] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-wc
[595.590660] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (3.590s)
[596.783234] [099/132] (437s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-onoff)
[596.873868] Starting subtest: fbc-2p-primscrn-spr-indfb-onoff
[596.875748] Subtest fbc-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[597.008556] [100/132] (437s left) api_intel_bb (full-batch)
[597.064235] Starting subtest: full-batch
[597.071691] Subtest full-batch: SUCCESS (0.009s)
[597.192287] [101/132] (437s left) perf (gen12-unprivileged-single-ctx-counters)
[597.295330] Starting subtest: gen12-unprivileged-single-ctx-counters
[597.296365] Starting dynamic subtest: rcs0
[597.457144] Dynamic subtest rcs0: SUCCESS (0.161s)
[597.459900] Subtest gen12-unprivileged-single-ctx-counters: SUCCESS (0.164s)
[597.496126] [102/132] (437s left) kms_psr (fbc-psr2-cursor-plane-onoff)
[597.633347] Starting subtest: fbc-psr2-cursor-plane-onoff
[597.634223] Starting dynamic subtest: eDP-1
[597.635957] Dynamic subtest eDP-1: SKIP (0.000s)
[597.637608] Subtest fbc-psr2-cursor-plane-onoff: SKIP (0.001s)
[597.728642] [103/132] (437s left) kms_psr (psr2-primary-mmap-cpu)
[597.814567] Starting subtest: psr2-primary-mmap-cpu
[597.815407] Starting dynamic subtest: eDP-1
[599.538122] Dynamic subtest eDP-1: SUCCESS (1.726s)
[599.539028] Subtest psr2-primary-mmap-cpu: SUCCESS (1.727s)
[600.431700] [104/132] (434s left) gem_exec_await (wide-all)
[600.671137] Starting subtest: wide-all
[624.381018] Subtest wide-all: SUCCESS (23.716s)
[624.591123] [105/132] (410s left) kms_dither (fb-8bpc-vs-panel-6bpc)
[624.724680] Starting subtest: fb-8bpc-vs-panel-6bpc
[624.725557] Starting dynamic subtest: pipe-A-eDP-1
[626.090393] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.365s)
[626.091215] Subtest fb-8bpc-vs-panel-6bpc: SUCCESS (1.367s)
[626.968984] [106/132] (407s left) kms_chamelium_frames (dp-crc-single)
[627.347321] Subtest dp-crc-single: SKIP (0.000s)
[628.161782] [107/132] (406s left) gem_exec_whisper (basic-fds-priority-all)
[628.230555] Starting subtest: basic-fds-priority-all
[651.414666] Subtest basic-fds-priority-all: SUCCESS (23.186s)
[651.623990] [108/132] (383s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render)
[651.732937] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render
[651.734703] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[651.867650] [109/132] (383s left) fbdev (unaligned-read)
[651.899938] Starting subtest: unaligned-read
[651.915460] Subtest unaligned-read: SUCCESS (0.015s)
[651.990682] [110/132] (383s left) gen3_render_tiledy_blits
[652.108496] [111/132] (382s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[652.220107] Starting subtest: cursorA-vs-flipA-toggle
[663.383079] Subtest cursorA-vs-flipA-toggle: SUCCESS (11.165s)
[664.214798] [112/132] (370s left) gem_eio (in-flight-10ms)
[664.445997] Starting subtest: in-flight-10ms
[673.520333] Subtest in-flight-10ms: SUCCESS (9.078s)
[673.725579] [113/132] (361s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[673.829392] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-wc
[673.831174] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[673.965409] [114/132] (361s left) kms_pm_rpm (modeset-non-lpsp-stress-no-wait)
[675.592635] Starting subtest: modeset-non-lpsp-stress-no-wait
[675.630633] Subtest modeset-non-lpsp-stress-no-wait: SKIP (0.041s)
[676.248221] [115/132] (358s left) kms_atomic (plane-immutable-zpos)
[676.361970] Starting subtest: plane-immutable-zpos
[676.362892] Starting dynamic subtest: pipe-A-eDP-1
[676.994091] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.631s)
[676.995003] Subtest plane-immutable-zpos: SUCCESS (0.633s)
[677.881264] [116/132] (357s left) syncobj_timeline (invalid-transfer-non-existent-point)
[677.939751] Starting subtest: invalid-transfer-non-existent-point
[677.940673] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[678.070920] [117/132] (357s left) kms_big_fb (4-tiled-64bpp-rotate-0)
[678.175126] Starting subtest: 4-tiled-64bpp-rotate-0
[679.799040] Subtest 4-tiled-64bpp-rotate-0: SUCCESS (1.623s)
[680.000779] [118/132] (355s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[680.097626] Starting subtest: plane-downscale-factor-0-75-with-rotation
[680.098526] Starting dynamic subtest: pipe-A
[680.328914] Dynamic subtest pipe-A: SUCCESS (0.232s)
[680.338464] Starting dynamic subtest: pipe-B
[681.660465] Dynamic subtest pipe-B: SUCCESS (1.330s)
[681.678465] Starting dynamic subtest: pipe-C
[682.990129] Dynamic subtest pipe-C: SUCCESS (1.327s)
[683.000165] Starting dynamic subtest: pipe-D
[684.343997] Dynamic subtest pipe-D: SUCCESS (1.352s)
[684.346406] Subtest plane-downscale-factor-0-75-with-rotation: SUCCESS (4.247s)
[685.514147] [119/132] (349s left) kms_cdclk (mode-transition-all-outputs)
[685.615005] Starting subtest: mode-transition-all-outputs
[685.901017] Subtest mode-transition-all-outputs: SKIP (0.285s)
[686.742181] [120/132] (348s left) kms_psr (fbc-pr-sprite-plane-move)
[686.855695] Starting subtest: fbc-pr-sprite-plane-move
[686.857497] Subtest fbc-pr-sprite-plane-move: SKIP (0.000s)
[686.952833] [121/132] (348s left) gem_ctx_persistence (engines-mixed-process)
[687.011763] Starting subtest: engines-mixed-process
[687.012686] Starting dynamic subtest: rcs0
[688.466656] Dynamic subtest rcs0: SUCCESS (1.454s)
[688.480167] Starting dynamic subtest: bcs0
[690.440653] Dynamic subtest bcs0: SUCCESS (1.969s)
[690.451986] Starting dynamic subtest: vcs0
[692.452759] Dynamic subtest vcs0: SUCCESS (2.012s)
[692.465484] Starting dynamic subtest: vcs1
[694.476736] Dynamic subtest vcs1: SUCCESS (2.022s)
[694.489302] Starting dynamic subtest: vecs0
[696.448323] Dynamic subtest vecs0: SUCCESS (1.969s)
[696.461095] Starting dynamic subtest: ccs0
[698.487693] Dynamic subtest ccs0: SUCCESS (2.037s)
[698.488628] Subtest engines-mixed-process: SUCCESS (11.474s)
[698.587906] [122/132] (336s left) kms_draw_crc (draw-method-mmap-gtt)
[698.693104] Starting subtest: draw-method-mmap-gtt
[698.695077] Subtest draw-method-mmap-gtt: SKIP (0.000s)
[698.802524] [123/132] (336s left) syncobj_wait (single-wait-all-submitted)
[698.866767] Starting subtest: single-wait-all-submitted
[698.976019] Subtest single-wait-all-submitted: SUCCESS (0.107s)
[699.070849] [124/132] (336s left) gem_lmem_swapping (verify-ccs)
[699.109534] Subtest verify-ccs: SKIP (0.000s)
[699.153475] [125/132] (336s left) i915_pm_freq_api (freq-suspend)
[699.223976] Starting subtest: freq-suspend
[699.225008] Starting dynamic subtest: gt0
[716.459408] Dynamic subtest gt0: SUCCESS (1.647s)
[716.478465] Starting dynamic subtest: gt1
[733.442971] Dynamic subtest gt1: SUCCESS (1.579s)
[733.444395] Subtest freq-suspend: SUCCESS (3.230s)
[746.573367] [126/132] (302s left) gem_eio (wait-immediate)
[746.791079] Starting subtest: wait-immediate
[747.189850] Subtest wait-immediate: SUCCESS (0.408s)
[747.378448] [127/132] (301s left) gem_vm_create (invalid-create)
[747.432597] Starting subtest: invalid-create
[747.434605] Subtest invalid-create: SUCCESS (0.001s)
[747.564758] [128/132] (301s left) kms_psr2_sf (pr-overlay-primary-update-sf-dmg-area)
[752.478506] Starting subtest: pr-overlay-primary-update-sf-dmg-area
[752.480364] Subtest pr-overlay-primary-update-sf-dmg-area: SKIP (0.002s)
[753.365782] [129/132] (295s left) kms_plane_scaling (planes-upscale-factor-0-25-downscale-factor-0-5)
[753.459516] Starting subtest: planes-upscale-factor-0-25-downscale-factor-0-5
[753.460461] Starting dynamic subtest: pipe-A
[753.476660] Dynamic subtest pipe-A: SKIP (0.016s)
[753.486611] Starting dynamic subtest: pipe-B
[753.505560] Dynamic subtest pipe-B: SKIP (0.028s)
[753.515343] Starting dynamic subtest: pipe-C
[753.532990] Dynamic subtest pipe-C: SKIP (0.028s)
[753.542484] Starting dynamic subtest: pipe-D
[753.561405] Dynamic subtest pipe-D: SKIP (0.028s)
[753.563140] Subtest planes-upscale-factor-0-25-downscale-factor-0-5: SKIP (0.103s)
[753.690216] [130/132] (295s left) kms_vblank (wait-forked-busy)
[753.782045] Starting subtest: wait-forked-busy
[753.782834] Starting dynamic subtest: pipe-A-eDP-1
[755.656375] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.888s)
[755.668855] Starting dynamic subtest: pipe-D-eDP-1
[758.181827] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.538s)
[758.182784] Subtest wait-forked-busy: SUCCESS (4.430s)
[758.996185] [131/132] (289s left) prime_vgem (sync)
[759.085070] Starting subtest: sync
[759.086001] Starting dynamic subtest: rcs0
[759.143330] Dynamic subtest rcs0: SUCCESS (0.058s)
[759.154065] Starting dynamic subtest: bcs0
[759.228696] Dynamic subtest bcs0: SUCCESS (0.084s)
[759.237868] Starting dynamic subtest: vcs0
[759.277728] Dynamic subtest vcs0: SUCCESS (0.048s)
[759.287024] Starting dynamic subtest: vcs1
[759.323772] Dynamic subtest vcs1: SUCCESS (0.045s)
[759.333012] Starting dynamic subtest: vecs0
[759.368871] Dynamic subtest vecs0: SUCCESS (0.045s)
[759.378433] Starting dynamic subtest: ccs0
[759.414767] Dynamic subtest ccs0: SUCCESS (0.045s)
[759.415703] Subtest sync: SUCCESS (0.332s)
[759.582690] [132/132] (289s left) kms_getfb (getfb-repeated-different-handles)
[759.667337] Starting subtest: getfb-repeated-different-handles
[759.668306] Subtest getfb-repeated-different-handles: SUCCESS (0.000s)
[759.779084] Closing watchdogs
results: parsing output: 0/ for test: gem_pxp
results: parsing output: 1/ for test: kms_color_pipeline
results: parsing output: 2/ for test: template
results: parsing output: 3/ for test: kms_flip_scaled_crc
results: parsing output: 4/ for test: gem_mmap_offset
results: parsing output: 5/ for test: kms_chamelium_hpd
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: kms_cursor_legacy
results: parsing output: 8/ for test: kms_plane_cursor
results: parsing output: 9/ for test: gem_ctx_persistence
results: parsing output: 10/ for test: gem_ctx_shared
results: parsing output: 11/ for test: gem_exec_params
results: parsing output: 12/ for test: gem_mmap_offset
results: parsing output: 13/ for test: kms_ccs
results: parsing output: 14/ for test: vgem_basic
results: parsing output: 15/ for test: vgem_basic
results: parsing output: 16/ for test: gem_eio
results: parsing output: 17/ for test: kms_pm_rpm
results: parsing output: 18/ for test: gem_exec_balancer
results: parsing output: 19/ for test: kms_psr
results: parsing output: 20/ for test: gem_exec_reloc
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: i915_drm_fdinfo
results: parsing output: 23/ for test: kms_hdr
results: parsing output: 24/ for test: kms_flip_tiling
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_big_fb
results: parsing output: 27/ for test: syncobj_timeline
results: parsing output: 28/ for test: gem_exec_fence
results: parsing output: 29/ for test: gem_exec_balancer
results: parsing output: 30/ for test: perf
results: parsing output: 31/ for test: gem_userptr_blits
results: parsing output: 32/ for test: gem_mmap_gtt
results: parsing output: 33/ for test: gen7_exec_parse
results: parsing output: 34/ for test: gem_exec_reloc
results: parsing output: 35/ for test: kms_big_fb
results: parsing output: 36/ for test: kms_plane
results: parsing output: 37/ for test: gem_exec_schedule
results: parsing output: 38/ for test: kms_cursor_legacy
results: parsing output: 39/ for test: kms_ccs
results: parsing output: 40/ for test: kms_cursor_crc
results: parsing output: 41/ for test: sw_sync
results: parsing output: 42/ for test: kms_big_fb
results: parsing output: 43/ for test: gem_lmem_swapping
results: parsing output: 44/ for test: perf_pmu
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: kms_pipe_b_c_ivb
results: parsing output: 47/ for test: kms_flip
results: parsing output: 48/ for test: kms_flip
results: parsing output: 49/ for test: kms_psr
results: parsing output: 50/ for test: kms_cursor_legacy
results: parsing output: 51/ for test: kms_cursor_crc
results: parsing output: 52/ for test: kms_addfb_basic
results: parsing output: 53/ for test: gem_render_copy
results: parsing output: 54/ for test: kms_big_fb
results: parsing output: 55/ for test: kms_addfb_basic
results: parsing output: 56/ for test: kms_flip
results: parsing output: 57/ for test: kms_ccs
results: parsing output: 58/ for test: syncobj_wait
results: parsing output: 59/ for test: kms_rotation_crc
results: parsing output: 60/ for test: gem_close
results: parsing output: 61/ for test: kms_cursor_legacy
results: parsing output: 62/ for test: syncobj_timeline
results: parsing output: 63/ for test: kms_big_fb
results: parsing output: 64/ for test: i915_suspend
results: parsing output: 65/ for test: kms_flip_scaled_crc
results: parsing output: 66/ for test: i915_pm_rpm
results: parsing output: 67/ for test: kms_vblank
results: parsing output: 68/ for test: kms_cursor_legacy
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: gem_exec_schedule
results: parsing output: 71/ for test: kms_cursor_legacy
results: parsing output: 72/ for test: syncobj_timeline
results: parsing output: 73/ for test: kms_big_fb
results: parsing output: 74/ for test: gem_userptr_blits
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: core_getversion
results: parsing output: 77/ for test: perf
results: parsing output: 78/ for test: gem_softpin
results: parsing output: 79/ for test: kms_multipipe_modeset
results: parsing output: 80/ for test: kms_psr2_sf
results: parsing output: 81/ for test: api_intel_allocator
results: parsing output: 82/ for test: kms_flip
results: parsing output: 83/ for test: syncobj_timeline
results: parsing output: 84/ for test: gem_cs_tlb
results: parsing output: 85/ for test: gem_tiled_blits
results: parsing output: 86/ for test: kms_joiner
results: parsing output: 87/ for test: kms_ccs
results: parsing output: 88/ for test: kms_cursor_crc
results: parsing output: 89/ for test: gem_tiled_blits
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: gem_exec_reloc
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: kms_cursor_crc
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: api_intel_bb
results: parsing output: 100/ for test: perf
results: parsing output: 101/ for test: kms_psr
results: parsing output: 102/ for test: kms_psr
results: parsing output: 103/ for test: gem_exec_await
results: parsing output: 104/ for test: kms_dither
results: parsing output: 105/ for test: kms_chamelium_frames
results: parsing output: 106/ for test: gem_exec_whisper
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: fbdev
results: parsing output: 109/ for test: gen3_render_tiledy_blits
results: parsing output: 110/ for test: kms_cursor_legacy
results: parsing output: 111/ for test: gem_eio
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_pm_rpm
results: parsing output: 114/ for test: kms_atomic
results: parsing output: 115/ for test: syncobj_timeline
results: parsing output: 116/ for test: kms_big_fb
results: parsing output: 117/ for test: kms_plane_scaling
results: parsing output: 118/ for test: kms_cdclk
results: parsing output: 119/ for test: kms_psr
results: parsing output: 120/ for test: gem_ctx_persistence
results: parsing output: 121/ for test: kms_draw_crc
results: parsing output: 122/ for test: syncobj_wait
results: parsing output: 123/ for test: gem_lmem_swapping
results: parsing output: 124/ for test: i915_pm_freq_api
results: parsing output: 125/ for test: gem_eio
results: parsing output: 126/ for test: gem_vm_create
results: parsing output: 127/ for test: kms_psr2_sf
results: parsing output: 128/ for test: kms_plane_scaling
results: parsing output: 129/ for test: kms_vblank
results: parsing output: 130/ for test: prime_vgem
results: parsing output: 131/ for test: kms_getfb
Done.