[30.674983] Initializing watchdogs [30.675041] /dev/watchdog0 [30.678471] [001/171] (960s left) i915_module_load (load) [30.715736] Starting subtest: load [31.259544] Subtest load: SUCCESS (0.544s) [31.268623] [002/171] (959s left) core_auth (basic-auth) [31.304503] Starting subtest: basic-auth [31.305271] Subtest basic-auth: SUCCESS (0.000s) [31.353977] [003/171] (959s left) debugfs_test (read_all_entries) [31.393298] Starting subtest: read_all_entries [31.443772] Subtest read_all_entries: SUCCESS (0.050s) [31.534678] [004/171] (959s left) debugfs_test (basic-hwmon) [31.570386] Starting subtest: basic-hwmon [31.571871] Subtest basic-hwmon: SKIP (0.000s) [31.669154] [005/171] (959s left) fbdev (eof) [31.726664] Starting subtest: eof [31.727461] Subtest eof: SUCCESS (0.000s) [31.780215] [006/171] (959s left) fbdev (info) [31.823705] Starting subtest: info [31.824630] Subtest info: SUCCESS (0.000s) [31.876387] [007/171] (959s left) fbdev (nullptr) [31.943209] Starting subtest: nullptr [31.943988] Subtest nullptr: SUCCESS (0.000s) [31.998372] [008/171] (959s left) fbdev (read) [32.059812] Starting subtest: read [32.639556] Subtest read: SUCCESS (0.579s) [32.690112] [009/171] (958s left) fbdev (write) [32.726162] Starting subtest: write [33.114181] Subtest write: SUCCESS (0.388s) [33.154221] [010/171] (958s left) gem_basic (bad-close) [33.195453] Starting subtest: bad-close [33.197180] Subtest bad-close: SUCCESS (0.000s) [33.265272] [011/171] (958s left) gem_basic (create-close) [33.319157] Starting subtest: create-close [33.320939] Subtest create-close: SUCCESS (0.000s) [33.421757] [012/171] (957s left) gem_basic (create-fd-close) [33.476295] Starting subtest: create-fd-close [33.477749] Subtest create-fd-close: SUCCESS (0.000s) [33.551069] [013/171] (957s left) gem_busy (busy@all-engines) [33.609681] Starting subtest: busy [33.610506] Starting dynamic subtest: all-engines [33.623113] Dynamic subtest all-engines: SUCCESS (0.014s) [33.623765] Subtest busy: SUCCESS (0.014s) [33.970187] [014/171] (957s left) gem_close_race (basic-process) [34.024954] Starting subtest: basic-process [34.053629] Subtest basic-process: SUCCESS (0.028s) [34.201248] [015/171] (957s left) gem_close_race (basic-threads) [34.239255] Starting subtest: basic-threads [35.418039] Subtest basic-threads: SUCCESS (1.179s) [35.613224] [016/171] (955s left) gem_ctx_create (basic) [35.678828] Starting subtest: basic [35.679468] Subtest basic: SUCCESS (0.000s) [35.871969] [017/171] (955s left) gem_ctx_create (basic-files) [35.928323] Starting subtest: basic-files [37.934223] Subtest basic-files: SUCCESS (2.006s) [38.103349] [018/171] (953s left) gem_ctx_exec (basic) [38.151478] Starting subtest: basic [38.152992] Subtest basic: SUCCESS (0.002s) [38.235757] [019/171] (953s left) gem_exec_basic (basic) [38.292981] Starting subtest: basic [38.293712] Starting dynamic subtest: rcs0-smem [38.294359] Dynamic subtest rcs0-smem: SUCCESS (0.001s) [38.297280] Starting dynamic subtest: bcs0-smem [38.297985] Dynamic subtest bcs0-smem: SUCCESS (0.000s) [38.300852] Starting dynamic subtest: vcs0-smem [38.301512] Dynamic subtest vcs0-smem: SUCCESS (0.000s) [38.304237] Starting dynamic subtest: vecs0-smem [38.304881] Dynamic subtest vecs0-smem: SUCCESS (0.000s) [38.305528] Subtest basic: SUCCESS (0.001s) [38.471994] [020/171] (952s left) gem_exec_create (basic) [38.529293] Starting subtest: basic [38.530032] Starting dynamic subtest: smem [40.582458] Dynamic subtest smem: SUCCESS (2.053s) [40.584650] Subtest basic: SUCCESS (2.053s) [40.750662] [021/171] (950s left) gem_exec_fence (basic-busy) [40.932886] Starting subtest: basic-busy [40.934412] Starting dynamic subtest: rcs0 [40.989481] Dynamic subtest rcs0: SUCCESS (0.064s) [41.003676] Starting dynamic subtest: bcs0 [41.028376] Dynamic subtest bcs0: SUCCESS (0.039s) [41.041349] Starting dynamic subtest: vcs0 [41.058434] Dynamic subtest vcs0: SUCCESS (0.030s) [41.070473] Starting dynamic subtest: vecs0 [41.100265] Dynamic subtest vecs0: SUCCESS (0.042s) [41.102063] Subtest basic-busy: SUCCESS (0.175s) [41.557040] [022/171] (949s left) gem_exec_fence (basic-wait) [41.717564] Starting subtest: basic-wait [41.719450] Starting dynamic subtest: rcs0 [41.783183] Dynamic subtest rcs0: SUCCESS (0.068s) [41.790759] Starting dynamic subtest: bcs0 [41.810241] Dynamic subtest bcs0: SUCCESS (0.027s) [41.823622] Starting dynamic subtest: vcs0 [41.842365] Dynamic subtest vcs0: SUCCESS (0.032s) [41.855570] Starting dynamic subtest: vecs0 [41.878496] Dynamic subtest vecs0: SUCCESS (0.027s) [41.880075] Subtest basic-wait: SUCCESS (0.155s) [42.323244] [023/171] (949s left) gem_exec_fence (basic-await) [42.492033] Starting subtest: basic-await [42.493505] Starting dynamic subtest: rcs0 [42.560592] Dynamic subtest rcs0: SUCCESS (0.074s) [42.576042] Starting dynamic subtest: bcs0 [42.642529] Dynamic subtest bcs0: SUCCESS (0.081s) [42.649772] Starting dynamic subtest: vcs0 [42.712215] Dynamic subtest vcs0: SUCCESS (0.070s) [42.726170] Starting dynamic subtest: vecs0 [42.790602] Dynamic subtest vecs0: SUCCESS (0.078s) [42.792247] Subtest basic-await: SUCCESS (0.304s) [43.220492] [024/171] (948s left) gem_exec_fence (nb-await) [43.407047] Starting subtest: nb-await [43.408645] Starting dynamic subtest: rcs0 [43.470695] Dynamic subtest rcs0: SUCCESS (0.064s) [43.475384] Starting dynamic subtest: bcs0 [43.529758] Dynamic subtest bcs0: SUCCESS (0.057s) [43.543820] Starting dynamic subtest: vcs0 [43.592888] Dynamic subtest vcs0: SUCCESS (0.064s) [43.606880] Starting dynamic subtest: vecs0 [43.656567] Dynamic subtest vecs0: SUCCESS (0.064s) [43.658394] Subtest nb-await: SUCCESS (0.250s) [44.082773] [025/171] (947s left) gem_exec_gttfill (basic) [44.123459] Starting subtest: basic [46.597286] Subtest basic: SUCCESS (2.473s) [46.772072] [026/171] (944s left) gem_exec_parallel (engines) [46.852763] Starting subtest: engines [46.853493] Starting dynamic subtest: basic [49.661272] Dynamic subtest basic: SUCCESS (2.809s) [49.664496] Starting dynamic subtest: contexts [51.527555] Dynamic subtest contexts: SUCCESS (1.866s) [51.531103] Starting dynamic subtest: fds [53.273163] Dynamic subtest fds: SUCCESS (1.745s) [53.283851] Starting dynamic subtest: userptr [55.011458] Dynamic subtest userptr: SUCCESS (1.739s) [55.012419] Subtest engines: SUCCESS (8.159s) [55.183466] [027/171] (936s left) gem_exec_store (basic) [55.240753] Starting subtest: basic [55.287948] Subtest basic: SUCCESS (0.046s) [55.474382] [028/171] (936s left) gem_flink_basic (bad-flink) [55.526299] Starting subtest: bad-flink [55.527063] Subtest bad-flink: SUCCESS (0.000s) [55.599563] [029/171] (936s left) gem_flink_basic (bad-open) [55.648741] Starting subtest: bad-open [55.649457] Subtest bad-open: SUCCESS (0.000s) [55.719535] [030/171] (935s left) gem_flink_basic (basic) [55.761086] Starting subtest: basic [55.761822] Subtest basic: SUCCESS (0.000s) [55.856676] [031/171] (935s left) gem_flink_basic (double-flink) [55.898455] Starting subtest: double-flink [55.899346] Subtest double-flink: SUCCESS (0.000s) [55.965702] [032/171] (935s left) gem_flink_basic (flink-lifetime) [56.015158] Starting subtest: flink-lifetime [56.016047] Subtest flink-lifetime: SUCCESS (0.001s) [56.108537] [033/171] (935s left) gem_huc_copy (huc-copy) [56.151809] Starting subtest: huc-copy [56.153688] Subtest huc-copy: SKIP (0.000s) [56.275569] [034/171] (935s left) gem_linear_blits (basic) [56.375214] Starting subtest: basic [56.378546] Subtest basic: SUCCESS (0.003s) [56.478873] [035/171] (935s left) gem_mmap (basic) [56.560706] Starting subtest: basic [56.565123] Subtest basic: SUCCESS (0.000s) [56.635160] [036/171] (935s left) gem_mmap_gtt (basic) [56.689955] Starting subtest: basic [56.690770] Subtest basic: SUCCESS (0.000s) [56.738088] [037/171] (935s left) gem_render_linear_blits (basic) [56.780435] Starting subtest: basic [56.805282] Subtest basic: SUCCESS (0.025s) [56.854794] [038/171] (934s left) gem_render_tiled_blits (basic) [56.899993] Starting subtest: basic [56.916173] Subtest basic: SUCCESS (0.016s) [56.976868] [039/171] (934s left) gem_ringfill (basic-all) [57.150290] Starting subtest: basic-all [58.254569] Subtest basic-all: SUCCESS (1.107s) [58.368629] [040/171] (933s left) gem_softpin (allocator-basic) [58.434994] Starting subtest: allocator-basic [58.480021] Subtest allocator-basic: SUCCESS (0.045s) [58.586365] [041/171] (933s left) gem_softpin (allocator-basic-reserve) [58.628350] Starting subtest: allocator-basic-reserve [58.672876] Subtest allocator-basic-reserve: SUCCESS (0.044s) [58.772863] [042/171] (933s left) gem_softpin (safe-alignment) [58.826721] Starting subtest: safe-alignment [58.831555] Subtest safe-alignment: SUCCESS (0.005s) [58.935137] [043/171] (932s left) gem_sync (basic-all) [58.988587] Starting subtest: basic-all [61.108239] Subtest basic-all: SUCCESS (2.121s) [61.290639] [044/171] (930s left) gem_sync (basic-each) [61.339159] Starting subtest: basic-each [63.400992] Subtest basic-each: SUCCESS (2.064s) [63.598997] [045/171] (928s left) gem_tiled_blits (basic) [63.699937] Starting subtest: basic [63.708036] Subtest basic: SUCCESS (0.008s) [63.831171] [046/171] (928s left) gem_tiled_fence_blits (basic) [63.962948] Starting subtest: basic [63.982135] Subtest basic: SUCCESS (0.019s) [64.075629] [047/171] (927s left) gem_tiled_pread_basic [64.181632] [048/171] (927s left) gem_wait (busy@all-engines) [64.233246] Starting subtest: busy [64.233981] Starting dynamic subtest: all-engines [64.767719] Dynamic subtest all-engines: SUCCESS (0.534s) [64.768878] Subtest busy: SUCCESS (0.534s) [64.951986] [049/171] (927s left) gem_wait (wait@all-engines) [65.009906] Starting subtest: wait [65.010586] Starting dynamic subtest: all-engines [66.054270] Dynamic subtest all-engines: SUCCESS (1.043s) [66.055024] Subtest wait: SUCCESS (1.043s) [66.235322] [050/171] (925s left) i915_getparams_basic (basic-eu-total) [66.277537] Starting subtest: basic-eu-total [66.278961] Subtest basic-eu-total: SUCCESS (0.000s) [66.359437] [051/171] (925s left) i915_getparams_basic (basic-subslice-total) [66.410515] Starting subtest: basic-subslice-total [66.412125] Subtest basic-subslice-total: SUCCESS (0.000s) [66.487842] [052/171] (925s left) i915_hangman (error-state-basic) [66.545454] Starting subtest: error-state-basic [66.548928] Subtest error-state-basic: SUCCESS (0.003s) [66.617637] [053/171] (925s left) i915_pciid [66.733400] [054/171] (925s left) kms_addfb_basic (addfb25-bad-modifier) [66.822380] Starting subtest: addfb25-bad-modifier [66.823031] Subtest addfb25-bad-modifier: SUCCESS (0.000s) [66.969274] [055/171] (925s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling) [67.036866] Starting subtest: addfb25-framebuffer-vs-set-tiling [67.037511] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s) [67.186197] [056/171] (924s left) kms_addfb_basic (addfb25-modifier-no-flag) [67.253584] Starting subtest: addfb25-modifier-no-flag [67.254288] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s) [67.386544] [057/171] (924s left) kms_addfb_basic (addfb25-x-tiled-legacy) [67.456231] Starting subtest: addfb25-x-tiled-legacy [67.456909] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s) [67.586729] [058/171] (924s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy) [67.656994] Starting subtest: addfb25-x-tiled-mismatch-legacy [67.657671] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.000s) [67.803148] [059/171] (924s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [67.903552] Starting subtest: addfb25-yf-tiled-legacy [67.904236] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s) [68.003410] [060/171] (924s left) kms_addfb_basic (addfb25-y-tiled-legacy) [68.105103] Starting subtest: addfb25-y-tiled-legacy [68.105763] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s) [68.219654] [061/171] (923s left) kms_addfb_basic (addfb25-y-tiled-small-legacy) [68.320783] Starting subtest: addfb25-y-tiled-small-legacy [68.321424] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.000s) [68.435681] [062/171] (923s left) kms_addfb_basic (bad-pitch-0) [68.470328] Starting subtest: bad-pitch-0 [68.471110] Subtest bad-pitch-0: SUCCESS (0.000s) [68.636974] [063/171] (923s left) kms_addfb_basic (bad-pitch-1024) [68.671222] Starting subtest: bad-pitch-1024 [68.672067] Subtest bad-pitch-1024: SUCCESS (0.000s) [68.835733] [064/171] (923s left) kms_addfb_basic (bad-pitch-128) [68.870730] Starting subtest: bad-pitch-128 [68.871546] Subtest bad-pitch-128: SUCCESS (0.000s) [69.052199] [065/171] (923s left) kms_addfb_basic (bad-pitch-256) [69.087078] Starting subtest: bad-pitch-256 [69.087908] Subtest bad-pitch-256: SUCCESS (0.000s) [69.252444] [066/171] (922s left) kms_addfb_basic (bad-pitch-32) [69.286833] Starting subtest: bad-pitch-32 [69.287543] Subtest bad-pitch-32: SUCCESS (0.000s) [69.468676] [067/171] (922s left) kms_addfb_basic (bad-pitch-63) [69.503323] Starting subtest: bad-pitch-63 [69.504067] Subtest bad-pitch-63: SUCCESS (0.000s) [69.685766] [068/171] (922s left) kms_addfb_basic (bad-pitch-65536) [69.720162] Starting subtest: bad-pitch-65536 [69.720880] Subtest bad-pitch-65536: SUCCESS (0.000s) [69.868877] [069/171] (922s left) kms_addfb_basic (bad-pitch-999) [69.903049] Starting subtest: bad-pitch-999 [69.903765] Subtest bad-pitch-999: SUCCESS (0.000s) [70.069136] [070/171] (922s left) kms_addfb_basic (basic) [70.103819] Starting subtest: basic [70.104527] Subtest basic: SUCCESS (0.000s) [70.268695] [071/171] (921s left) kms_addfb_basic (basic-x-tiled-legacy) [70.399410] Starting subtest: basic-x-tiled-legacy [70.400134] Subtest basic-x-tiled-legacy: SUCCESS (0.000s) [70.468870] [072/171] (921s left) kms_addfb_basic (basic-y-tiled-legacy) [70.600962] Starting subtest: basic-y-tiled-legacy [70.601667] Subtest basic-y-tiled-legacy: SUCCESS (0.000s) [70.669280] [073/171] (921s left) kms_addfb_basic (bo-too-small) [70.736720] Starting subtest: bo-too-small [70.737554] Subtest bo-too-small: SUCCESS (0.000s) [70.918653] [074/171] (921s left) kms_addfb_basic (bo-too-small-due-to-tiling) [70.992608] Starting subtest: bo-too-small-due-to-tiling [70.993423] Subtest bo-too-small-due-to-tiling: SUCCESS (0.000s) [71.135598] [075/171] (921s left) kms_addfb_basic (clobberred-modifier) [71.170475] Starting subtest: clobberred-modifier [71.171170] Subtest clobberred-modifier: SUCCESS (0.000s) [71.335789] [076/171] (921s left) kms_addfb_basic (framebuffer-vs-set-tiling) [71.467949] Starting subtest: framebuffer-vs-set-tiling [71.468663] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s) [71.535851] [077/171] (920s left) kms_addfb_basic (invalid-get-prop) [71.666734] Starting subtest: invalid-get-prop [71.667546] Subtest invalid-get-prop: SUCCESS (0.000s) [71.735607] [078/171] (920s left) kms_addfb_basic (invalid-get-prop-any) [71.866802] Starting subtest: invalid-get-prop-any [71.867549] Subtest invalid-get-prop-any: SUCCESS (0.000s) [71.935745] [079/171] (920s left) kms_addfb_basic (invalid-set-prop) [72.066740] Starting subtest: invalid-set-prop [72.067424] Subtest invalid-set-prop: SUCCESS (0.000s) [72.152173] [080/171] (920s left) kms_addfb_basic (invalid-set-prop-any) [72.284076] Starting subtest: invalid-set-prop-any [72.284866] Subtest invalid-set-prop-any: SUCCESS (0.000s) [72.335635] [081/171] (920s left) kms_addfb_basic (no-handle) [72.369595] Starting subtest: no-handle [72.370255] Subtest no-handle: SUCCESS (0.000s) [72.535856] [082/171] (919s left) kms_addfb_basic (size-max) [72.602948] Starting subtest: size-max [72.603681] Subtest size-max: SUCCESS (0.000s) [72.735603] [083/171] (919s left) kms_addfb_basic (small-bo) [72.802709] Starting subtest: small-bo [72.803462] Subtest small-bo: SUCCESS (0.000s) [72.935728] [084/171] (919s left) kms_addfb_basic (tile-pitch-mismatch) [73.067146] Starting subtest: tile-pitch-mismatch [73.067866] Subtest tile-pitch-mismatch: SUCCESS (0.000s) [73.135477] [085/171] (919s left) kms_addfb_basic (too-high) [73.203026] Starting subtest: too-high [73.203749] Subtest too-high: SUCCESS (0.000s) [73.335723] [086/171] (919s left) kms_addfb_basic (too-wide) [73.402866] Starting subtest: too-wide [73.403586] Subtest too-wide: SUCCESS (0.000s) [73.535748] [087/171] (918s left) kms_addfb_basic (unused-handle) [73.570942] Starting subtest: unused-handle [73.571683] Subtest unused-handle: SUCCESS (0.000s) [73.735723] [088/171] (918s left) kms_addfb_basic (unused-modifier) [73.770473] Starting subtest: unused-modifier [73.771355] Subtest unused-modifier: SUCCESS (0.000s) [73.935830] [089/171] (918s left) kms_addfb_basic (unused-offsets) [73.969999] Starting subtest: unused-offsets [73.970639] Subtest unused-offsets: SUCCESS (0.000s) [74.157474] [090/171] (918s left) kms_addfb_basic (unused-pitches) [74.191689] Starting subtest: unused-pitches [74.192323] Subtest unused-pitches: SUCCESS (0.000s) [74.352112] [091/171] (918s left) kms_busy (basic) [74.422728] Starting subtest: basic [74.423355] Starting dynamic subtest: flip [74.964563] Dynamic subtest flip: SUCCESS (0.541s) [74.968216] Starting dynamic subtest: modeset [75.582581] Dynamic subtest modeset: SUCCESS (0.618s) [75.583283] Subtest basic: SUCCESS (1.160s) [75.706817] [092/171] (916s left) kms_chamelium_hpd (dp-hpd-fast) [75.851597] Subtest dp-hpd-fast: SKIP (0.000s) [75.912850] [093/171] (916s left) kms_chamelium_edid (dp-edid-read) [76.046136] Subtest dp-edid-read: SKIP (0.000s) [76.105778] [094/171] (916s left) kms_chamelium_frames (dp-crc-fast) [76.237036] Subtest dp-crc-fast: SKIP (0.000s) [76.296747] [095/171] (916s left) kms_chamelium_hpd (hdmi-hpd-fast) [76.429599] Subtest hdmi-hpd-fast: SKIP (0.000s) [76.490579] [096/171] (916s left) kms_chamelium_edid (hdmi-edid-read) [76.621662] Subtest hdmi-edid-read: SKIP (0.000s) [76.684987] [097/171] (915s left) kms_chamelium_frames (hdmi-crc-fast) [76.816711] Subtest hdmi-crc-fast: SKIP (0.000s) [76.877800] [098/171] (915s left) kms_chamelium_hpd (vga-hpd-fast) [77.008981] Subtest vga-hpd-fast: SKIP (0.000s) [77.068718] [099/171] (915s left) kms_chamelium_edid (vga-edid-read) [77.199573] Subtest vga-edid-read: SKIP (0.000s) [77.259303] [100/171] (915s left) kms_prop_blob (basic) [77.293948] Starting subtest: basic [77.294660] Subtest basic: SUCCESS (0.000s) [77.345143] [101/171] (915s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic) [77.413206] Starting subtest: basic-busy-flip-before-cursor-atomic [77.414579] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s) [77.462278] [102/171] (915s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy) [77.531100] Starting subtest: basic-busy-flip-before-cursor-legacy [77.532504] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s) [77.579067] [103/171] (914s left) kms_cursor_legacy (basic-flip-after-cursor-atomic) [77.646082] Starting subtest: basic-flip-after-cursor-atomic [78.606565] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.961s) [78.708295] [104/171] (913s left) kms_cursor_legacy (basic-flip-after-cursor-legacy) [78.785491] Starting subtest: basic-flip-after-cursor-legacy [79.737052] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.961s) [79.853050] [105/171] (912s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size) [79.921531] Starting subtest: basic-flip-after-cursor-varying-size [80.896562] Subtest basic-flip-after-cursor-varying-size: SUCCESS (0.976s) [81.012912] [106/171] (911s left) kms_cursor_legacy (basic-flip-before-cursor-atomic) [81.079792] Starting subtest: basic-flip-before-cursor-atomic [82.023549] Subtest basic-flip-before-cursor-atomic: SUCCESS (0.944s) [82.135204] [107/171] (910s left) kms_cursor_legacy (basic-flip-before-cursor-legacy) [82.203622] Starting subtest: basic-flip-before-cursor-legacy [83.163965] Subtest basic-flip-before-cursor-legacy: SUCCESS (0.961s) [83.281339] [108/171] (909s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size) [83.348699] Starting subtest: basic-flip-before-cursor-varying-size [84.291489] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.943s) [84.416331] [109/171] (908s left) kms_flip (basic-flip-vs-dpms) [84.479350] Starting subtest: basic-flip-vs-dpms [84.480027] Starting dynamic subtest: A-HDMI-A1 [85.413040] Dynamic subtest A-HDMI-A1: SUCCESS (0.933s) [85.416748] Starting dynamic subtest: B-HDMI-A1 [86.189614] Dynamic subtest B-HDMI-A1: SUCCESS (0.776s) [86.193549] Starting dynamic subtest: C-HDMI-A1 [87.054828] Dynamic subtest C-HDMI-A1: SUCCESS (0.864s) [87.055615] Subtest basic-flip-vs-dpms: SUCCESS (2.576s) [87.174042] [110/171] (905s left) kms_flip (basic-flip-vs-modeset) [87.237510] Starting subtest: basic-flip-vs-modeset [87.238164] Starting dynamic subtest: A-HDMI-A1 [88.189174] Dynamic subtest A-HDMI-A1: SUCCESS (0.950s) [88.192929] Starting dynamic subtest: B-HDMI-A1 [88.973314] Dynamic subtest B-HDMI-A1: SUCCESS (0.785s) [88.977097] Starting dynamic subtest: C-HDMI-A1 [89.850117] Dynamic subtest C-HDMI-A1: SUCCESS (0.876s) [89.850937] Subtest basic-flip-vs-modeset: SUCCESS (2.613s) [89.959691] [111/171] (902s left) kms_flip (basic-flip-vs-wf_vblank) [90.024136] Starting subtest: basic-flip-vs-wf_vblank [90.024961] Starting dynamic subtest: A-HDMI-A1 [91.187704] Dynamic subtest A-HDMI-A1: SUCCESS (1.164s) [91.191549] Starting dynamic subtest: B-HDMI-A1 [92.309315] Dynamic subtest B-HDMI-A1: SUCCESS (1.121s) [92.315820] Starting dynamic subtest: C-HDMI-A1 [93.447907] Dynamic subtest C-HDMI-A1: SUCCESS (1.137s) [93.449822] Subtest basic-flip-vs-wf_vblank: SUCCESS (3.427s) [93.632476] [112/171] (899s left) kms_flip (basic-plain-flip) [93.696937] Starting subtest: basic-plain-flip [93.697721] Starting dynamic subtest: A-HDMI-A1 [94.589712] Dynamic subtest A-HDMI-A1: SUCCESS (0.891s) [94.594923] Starting dynamic subtest: B-HDMI-A1 [95.441885] Dynamic subtest B-HDMI-A1: SUCCESS (0.851s) [95.448891] Starting dynamic subtest: C-HDMI-A1 [96.296252] Dynamic subtest C-HDMI-A1: SUCCESS (0.854s) [96.297201] Subtest basic-plain-flip: SUCCESS (2.601s) [96.459650] [113/171] (896s left) kms_force_connector_basic (force-connector-state) [96.581117] Starting subtest: force-connector-state [96.867198] Subtest force-connector-state: SUCCESS (0.288s) [97.113778] [114/171] (895s left) kms_force_connector_basic (force-edid) [97.235409] Starting subtest: force-edid [97.371982] Subtest force-edid: SUCCESS (0.138s) [97.528937] [115/171] (895s left) kms_force_connector_basic (force-load-detect) [97.647273] Starting subtest: force-load-detect [97.648671] Subtest force-load-detect: SKIP (0.000s) [97.812420] [116/171] (894s left) kms_force_connector_basic (prune-stale-modes) [97.929884] Starting subtest: prune-stale-modes [98.066895] Subtest prune-stale-modes: SUCCESS (0.137s) [98.228880] [117/171] (894s left) kms_frontbuffer_tracking (basic) [98.300450] Starting subtest: basic [101.054391] Subtest basic: SUCCESS (2.755s) [101.152518] [118/171] (891s left) kms_pipe_crc_basic (compare-crc-sanitycheck) [101.229551] Starting subtest: compare-crc-sanitycheck [101.230442] Starting dynamic subtest: pipe-A-HDMI-A-1 [101.657918] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.428s) [101.661799] Starting dynamic subtest: pipe-B-HDMI-A-1 [102.018537] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.360s) [102.022465] Starting dynamic subtest: pipe-C-HDMI-A-1 [102.382573] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.363s) [102.383433] Subtest compare-crc-sanitycheck: SUCCESS (1.154s) [102.501190] [119/171] (890s left) kms_pipe_crc_basic (hang-read-crc) [102.569563] Starting subtest: hang-read-crc [102.570420] Starting dynamic subtest: pipe-A-HDMI-A-1 [103.577483] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.008s) [103.581266] Starting dynamic subtest: pipe-B-HDMI-A-1 [104.474493] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.896s) [104.478412] Starting dynamic subtest: pipe-C-HDMI-A-1 [105.373628] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.898s) [105.374309] Subtest hang-read-crc: SUCCESS (2.805s) [105.467202] [120/171] (887s left) kms_pipe_crc_basic (nonblocking-crc) [105.535506] Starting subtest: nonblocking-crc [105.536234] Starting dynamic subtest: pipe-A-HDMI-A-1 [106.127314] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.592s) [106.131187] Starting dynamic subtest: pipe-B-HDMI-A-1 [106.635391] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.507s) [106.640149] Starting dynamic subtest: pipe-C-HDMI-A-1 [107.148391] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.512s) [107.149061] Subtest nonblocking-crc: SUCCESS (1.614s) [107.274334] [121/171] (885s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence) [107.342651] Starting subtest: nonblocking-crc-frame-sequence [107.343360] Starting dynamic subtest: pipe-A-HDMI-A-1 [107.934291] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.592s) [107.938141] Starting dynamic subtest: pipe-B-HDMI-A-1 [108.443264] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.508s) [108.448020] Starting dynamic subtest: pipe-C-HDMI-A-1 [108.954584] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.509s) [108.955283] Subtest nonblocking-crc-frame-sequence: SUCCESS (1.612s) [109.047523] [122/171] (883s left) kms_pipe_crc_basic (read-crc) [109.118059] Starting subtest: read-crc [109.118741] Starting dynamic subtest: pipe-A-HDMI-A-1 [109.656439] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.539s) [109.667941] Starting dynamic subtest: pipe-B-HDMI-A-1 [110.097402] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.440s) [110.109752] Starting dynamic subtest: pipe-C-HDMI-A-1 [110.542994] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.444s) [110.543755] Subtest read-crc: SUCCESS (1.426s) [110.637560] [123/171] (882s left) kms_pipe_crc_basic (read-crc-frame-sequence) [110.713915] Starting subtest: read-crc-frame-sequence [110.716331] Starting dynamic subtest: pipe-A-HDMI-A-1 [111.246739] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.532s) [111.250683] Starting dynamic subtest: pipe-B-HDMI-A-1 [111.687387] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.440s) [111.692188] Starting dynamic subtest: pipe-C-HDMI-A-1 [112.138740] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.444s) [112.139509] Subtest read-crc-frame-sequence: SUCCESS (1.419s) [112.226561] [124/171] (880s left) kms_psr (primary_page_flip) [112.262925] Subtest primary_page_flip: SKIP (0.000s) [112.299538] [125/171] (880s left) kms_psr (cursor_plane_move) [112.341483] Subtest cursor_plane_move: SKIP (0.000s) [112.355489] [126/171] (880s left) kms_psr (sprite_plane_onoff) [112.405832] Subtest sprite_plane_onoff: SKIP (0.000s) [112.423376] [127/171] (880s left) kms_psr (primary_mmap_gtt) [112.473060] Subtest primary_mmap_gtt: SKIP (0.000s) [112.500492] [128/171] (880s left) kms_setmode (basic-clone-single-crtc) [112.551938] Starting subtest: basic-clone-single-crtc [112.554422] Subtest basic-clone-single-crtc: SKIP (0.000s) [112.645815] [129/171] (880s left) i915_pm_backlight (basic-brightness) [112.723265] Subtest basic-brightness: SKIP (0.000s) [112.746163] [130/171] (880s left) i915_pm_rpm (basic-pci-d3-state) [114.240145] Starting subtest: basic-pci-d3-state [114.599161] Subtest basic-pci-d3-state: SUCCESS (0.351s) [114.920760] [131/171] (877s left) i915_pm_rpm (basic-rte) [114.960831] Starting subtest: basic-rte [116.736890] Subtest basic-rte: SUCCESS (1.776s) [117.492259] [132/171] (875s left) i915_pm_rps (basic-api) [117.529025] Starting subtest: basic-api [117.530702] Subtest basic-api: SUCCESS (0.001s) [117.605473] [133/171] (875s left) prime_self_import (basic-llseek-bad) [117.648200] Starting subtest: basic-llseek-bad [117.648928] Subtest basic-llseek-bad: SUCCESS (0.001s) [117.727711] [134/171] (875s left) prime_self_import (basic-llseek-size) [117.768074] Starting subtest: basic-llseek-size [117.768815] Subtest basic-llseek-size: SUCCESS (0.001s) [117.863838] [135/171] (875s left) prime_self_import (basic-with_fd_dup) [117.911442] Starting subtest: basic-with_fd_dup [117.913157] Subtest basic-with_fd_dup: SUCCESS (0.001s) [118.013449] [136/171] (874s left) prime_self_import (basic-with_one_bo) [118.062234] Starting subtest: basic-with_one_bo [118.062968] Subtest basic-with_one_bo: SUCCESS (0.001s) [118.131219] [137/171] (874s left) prime_self_import (basic-with_one_bo_two_files) [118.170827] Starting subtest: basic-with_one_bo_two_files [118.171569] Subtest basic-with_one_bo_two_files: SUCCESS (0.001s) [118.261984] [138/171] (874s left) prime_self_import (basic-with_two_bos) [118.310658] Starting subtest: basic-with_two_bos [118.312437] Subtest basic-with_two_bos: SUCCESS (0.001s) [118.388723] [139/171] (874s left) prime_vgem (basic-fence-flip) [118.450941] Starting subtest: basic-fence-flip [118.848432] Subtest basic-fence-flip: SUCCESS (0.397s) [118.942018] [140/171] (874s left) prime_vgem (basic-fence-mmap) [118.999712] Starting subtest: basic-fence-mmap [119.012367] Subtest basic-fence-mmap: SUCCESS (0.013s) [119.113769] [141/171] (873s left) prime_vgem (basic-fence-read) [119.166565] Starting subtest: basic-fence-read [119.170057] Subtest basic-fence-read: SKIP (0.003s) [119.281907] [142/171] (873s left) prime_vgem (basic-gtt) [119.359972] Starting subtest: basic-gtt [119.368451] Subtest basic-gtt: SUCCESS (0.009s) [119.457188] [143/171] (873s left) prime_vgem (basic-read) [119.499669] Starting subtest: basic-read [119.503286] Subtest basic-read: SKIP (0.003s) [119.589660] [144/171] (873s left) prime_vgem (basic-write) [119.633067] Starting subtest: basic-write [119.636869] Subtest basic-write: SKIP (0.003s) [119.748646] [145/171] (873s left) prime_vgem (basic-userptr) [119.810724] Starting subtest: basic-userptr [119.815213] Subtest basic-userptr: SKIP (0.004s) [119.911824] [146/171] (873s left) vgem_basic (setversion) [119.964402] Starting subtest: setversion [119.965782] Subtest setversion: SUCCESS (0.000s) [120.022748] [147/171] (873s left) vgem_basic (create) [120.080980] Starting subtest: create [120.081682] Subtest create: SUCCESS (0.000s) [120.141881] [148/171] (873s left) vgem_basic (debugfs) [120.198295] Starting subtest: debugfs [120.199230] Subtest debugfs: SUCCESS (0.000s) [120.260710] [149/171] (873s left) vgem_basic (dmabuf-export) [120.314246] Starting subtest: dmabuf-export [120.316071] Subtest dmabuf-export: SUCCESS (0.001s) [120.413911] [150/171] (872s left) vgem_basic (dmabuf-fence) [120.464456] Starting subtest: dmabuf-fence [120.465201] Subtest dmabuf-fence: SUCCESS (0.000s) [120.526836] [151/171] (872s left) vgem_basic (dmabuf-fence-before) [120.581234] Starting subtest: dmabuf-fence-before [120.582072] Subtest dmabuf-fence-before: SUCCESS (0.000s) [120.642838] [152/171] (872s left) vgem_basic (dmabuf-mmap) [120.697888] Starting subtest: dmabuf-mmap [120.705405] Subtest dmabuf-mmap: SUCCESS (0.008s) [120.752070] [153/171] (872s left) vgem_basic (mmap) [120.814532] Starting subtest: mmap [120.818825] Subtest mmap: SUCCESS (0.004s) [120.870845] [154/171] (872s left) vgem_basic (second-client) [120.931317] Starting subtest: second-client [120.982532] Subtest second-client: SUCCESS (0.050s) [121.048147] [155/171] (872s left) vgem_basic (sysfs) [121.097714] Starting subtest: sysfs [121.098605] Subtest sysfs: SUCCESS (0.000s) [121.157500] [156/171] (872s left) core_hotunplug (unbind-rebind) [121.215068] Starting subtest: unbind-rebind [122.029119] Subtest unbind-rebind: SUCCESS (0.815s) [122.038853] [157/171] (871s left) vgem_basic (unload) [122.075962] Starting subtest: unload [150.817580] Subtest unload: SUCCESS (28.740s) [150.920876] [158/171] (842s left) i915_module_load (reload) [150.964158] Starting subtest: reload [152.200105] Subtest reload: SUCCESS (1.236s) [152.210265] [159/171] (841s left) gem_lmem_swapping (basic) [152.264789] Subtest basic: SKIP (0.000s) [152.288838] [160/171] (841s left) gem_lmem_swapping (parallel-random-engines) [152.326075] Subtest parallel-random-engines: SKIP (0.000s) [152.339270] [161/171] (841s left) gem_lmem_swapping (random-engines) [152.376904] Subtest random-engines: SKIP (0.000s) [152.389415] [162/171] (841s left) gem_lmem_swapping (verify-random) [152.427152] Subtest verify-random: SKIP (0.000s) [152.438587] [163/171] (841s left) i915_pm_rpm (module-reload) [154.259930] Starting subtest: module-reload [160.549501] Subtest module-reload: SUCCESS (6.283s) [160.564408] [164/171] (832s left) i915_selftest (live) [160.633262] Starting subtest: live [160.634100] Starting dynamic subtest: sanitycheck [161.047563] Dynamic subtest sanitycheck: SUCCESS (0.393s) [161.062370] Starting dynamic subtest: uncore [161.412403] Dynamic subtest uncore: SUCCESS (0.382s) [161.418640] Starting dynamic subtest: workarounds [162.004591] Dynamic subtest workarounds: SUCCESS (0.587s) [162.007764] Starting dynamic subtest: gt_engines [162.855769] Dynamic subtest gt_engines: SUCCESS (0.851s) [162.859337] Starting dynamic subtest: gt_timelines [167.884215] Dynamic subtest gt_timelines: SUCCESS (5.037s) [167.887365] Starting dynamic subtest: gt_contexts [168.329262] Dynamic subtest gt_contexts: SUCCESS (0.445s) [168.332363] Starting dynamic subtest: gt_lrc [170.992305] Dynamic subtest gt_lrc: SUCCESS (2.663s) [170.995752] Starting dynamic subtest: gt_mocs [171.406332] Dynamic subtest gt_mocs: SUCCESS (0.414s) [171.409615] Starting dynamic subtest: gt_pm [182.976286] Dynamic subtest gt_pm: SUCCESS (11.570s) [182.979480] Starting dynamic subtest: gt_heartbeat [183.474272] Dynamic subtest gt_heartbeat: SUCCESS (0.498s) [183.477687] Starting dynamic subtest: requests [190.113328] Dynamic subtest requests: SUCCESS (6.639s) [190.116518] Starting dynamic subtest: migrate [193.254555] Dynamic subtest migrate: SUCCESS (3.141s) [193.257891] Starting dynamic subtest: active [193.622874] Dynamic subtest active: SUCCESS (0.361s) [193.626242] Starting dynamic subtest: objects [194.494501] Dynamic subtest objects: SUCCESS (0.864s) [194.497897] Starting dynamic subtest: mman [198.234382] Dynamic subtest mman: SUCCESS (3.755s) [198.238633] Starting dynamic subtest: dmabuf [198.658362] Dynamic subtest dmabuf: SUCCESS (0.424s) [198.661598] Starting dynamic subtest: vma [199.028307] Dynamic subtest vma: SUCCESS (0.370s) [199.031598] Starting dynamic subtest: coherency [200.026352] Dynamic subtest coherency: SUCCESS (0.998s) [200.029484] Starting dynamic subtest: gtt [209.937234] Dynamic subtest gtt: SUCCESS (9.911s) [209.940449] Starting dynamic subtest: gem [210.397242] Dynamic subtest gem: SUCCESS (0.460s) [210.400408] Starting dynamic subtest: evict [211.249291] Dynamic subtest evict: SUCCESS (0.852s) [211.252491] Starting dynamic subtest: hugepages [217.280418] Dynamic subtest hugepages: SUCCESS (6.031s) [217.283889] Starting dynamic subtest: gem_contexts [228.355571] Dynamic subtest gem_contexts: SUCCESS (11.075s) [228.360569] Starting dynamic subtest: client [228.731164] Dynamic subtest client: SUCCESS (0.375s) [228.734589] Starting dynamic subtest: gem_migrate [229.093238] Dynamic subtest gem_migrate: SUCCESS (0.362s) [229.096430] Starting dynamic subtest: reset [232.721163] Dynamic subtest reset: SUCCESS (3.628s) [232.724417] Starting dynamic subtest: memory_region [233.105363] Dynamic subtest memory_region: SUCCESS (0.384s) [233.108833] Starting dynamic subtest: hangcheck [256.619230] Dynamic subtest hangcheck: SUCCESS (23.514s) [256.622724] Starting dynamic subtest: execlists [264.146455] Dynamic subtest execlists: SUCCESS (7.527s) [264.149912] Starting dynamic subtest: ring_submission [264.519382] Dynamic subtest ring_submission: SUCCESS (0.373s) [264.522762] Starting dynamic subtest: perf [264.967380] Dynamic subtest perf: SUCCESS (0.448s) [264.972890] Starting dynamic subtest: slpc [265.358302] Dynamic subtest slpc: SUCCESS (0.391s) [265.361784] Starting dynamic subtest: guc [265.726437] Dynamic subtest guc: SUCCESS (0.368s) [265.729639] Starting dynamic subtest: guc_multi_lrc [266.075266] Dynamic subtest guc_multi_lrc: SUCCESS (0.349s) [266.078803] Starting dynamic subtest: guc_hang [266.430318] Dynamic subtest guc_hang: SUCCESS (0.355s) [266.433798] Starting dynamic subtest: late_gt_pm [266.819392] Dynamic subtest late_gt_pm: SUCCESS (0.389s) [266.820122] Subtest live: SUCCESS (106.186s) [266.882873] [165/171] (726s left) dmabuf (all-tests) [266.936491] Starting subtest: all-tests [266.937273] Starting dynamic subtest: sanitycheck [266.957392] Dynamic subtest sanitycheck: SUCCESS (0.021s) [266.961638] Starting dynamic subtest: dma_fence [267.084956] Dynamic subtest dma_fence: SUCCESS (0.127s) [267.088264] Starting dynamic subtest: dma_fence_chain [276.753009] Dynamic subtest dma_fence_chain: SUCCESS (9.668s) [276.756375] Starting dynamic subtest: dma_fence_unwrap [276.784117] Dynamic subtest dma_fence_unwrap: SUCCESS (0.030s) [276.790607] Starting dynamic subtest: dma_resv [276.816551] Dynamic subtest dma_resv: SUCCESS (0.031s) [276.818510] Subtest all-tests: SUCCESS (9.879s) [276.838285] [166/171] (716s left) i915_suspend (basic-s2idle-without-i915) [276.880098] Starting subtest: basic-s2idle-without-i915 [294.126393] Subtest basic-s2idle-without-i915: SUCCESS (5.045s) [300.235748] [167/171] (711s left) i915_suspend (basic-s3-without-i915) [300.278163] Starting subtest: basic-s3-without-i915 [322.403725] Subtest basic-s3-without-i915: SUCCESS (16.575s) [327.519194] [168/171] (694s left) gem_exec_suspend (basic-s0) [327.579883] Starting subtest: basic-S0 [327.580748] Starting dynamic subtest: smem [344.388528] Dynamic subtest smem: SUCCESS (4.348s) [344.389248] Subtest basic-S0: SUCCESS (4.349s) [349.562434] [169/171] (690s left) gem_exec_suspend (basic-s3) [349.609267] Starting subtest: basic-S3 [349.610060] Starting dynamic subtest: smem [378.431216] Dynamic subtest smem: SUCCESS (17.411s) [378.431885] Subtest basic-S3: SUCCESS (17.411s) [382.633499] [170/171] (672s left) kms_chamelium_hpd (common-hpd-after-suspend) [382.768596] Subtest common-hpd-after-suspend: SKIP (0.000s) [382.829458] [171/171] (672s left) kms_pipe_crc_basic (suspend-read-crc) [382.891480] Starting subtest: suspend-read-crc [382.892146] Starting dynamic subtest: pipe-A-HDMI-A-1 [404.559124] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.514s) [404.565206] Starting dynamic subtest: pipe-B-HDMI-A-1 [431.637017] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (6.509s) [431.642961] Starting dynamic subtest: pipe-C-HDMI-A-1 [459.637622] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (6.395s) [459.638359] Subtest suspend-read-crc: SUCCESS (19.420s) [464.705349] Closing watchdogs Done.