[50.793260] Initializing watchdogs [50.793427] /dev/watchdog0 [50.803614] [001/170] (960s left) i915_module_load (load) [50.946409] Starting subtest: load [53.560826] Subtest load: SUCCESS (2.615s) [53.587396] [002/170] (957s left) core_auth (basic-auth) [53.719773] Starting subtest: basic-auth [53.721099] Subtest basic-auth: SUCCESS (0.002s) [53.805474] [003/170] (957s left) debugfs_test (read_all_entries) [53.944225] Starting subtest: read_all_entries [54.012650] Subtest read_all_entries: SUCCESS (0.068s) [54.125174] [004/170] (957s left) debugfs_test (basic-hwmon) [54.267497] Starting subtest: basic-hwmon [54.269575] Subtest basic-hwmon: SKIP (0.000s) [54.378105] [005/170] (957s left) fbdev (eof) [54.549307] Starting subtest: eof [54.550439] Subtest eof: SUCCESS (0.001s) [54.610245] [006/170] (956s left) fbdev (info) [54.742630] Starting subtest: info [54.743809] Subtest info: SUCCESS (0.000s) [54.826961] [007/170] (956s left) fbdev (nullptr) [54.980938] Starting subtest: nullptr [54.982468] Subtest nullptr: SUCCESS (0.000s) [55.043054] [008/170] (956s left) fbdev (read) [55.195041] Starting subtest: read [62.274994] Subtest read: SUCCESS (7.046s) [62.312199] [009/170] (949s left) fbdev (write) [62.463875] Starting subtest: write [66.232777] Subtest write: SUCCESS (3.736s) [66.277152] [010/170] (945s left) gem_basic (bad-close) [66.410708] Starting subtest: bad-close [66.412904] Subtest bad-close: SUCCESS (0.000s) [66.493203] [011/170] (945s left) gem_basic (create-close) [66.633469] Starting subtest: create-close [66.635555] Subtest create-close: SUCCESS (0.000s) [66.726242] [012/170] (944s left) gem_basic (create-fd-close) [66.861502] Starting subtest: create-fd-close [66.863540] Subtest create-fd-close: SUCCESS (0.000s) [66.959199] [013/170] (944s left) gem_busy (busy@all-engines) [67.106268] Starting subtest: busy [67.107433] Starting dynamic subtest: all-engines [67.167957] Dynamic subtest all-engines: SUCCESS (0.062s) [67.169322] Subtest busy: SUCCESS (0.062s) [67.544767] [014/170] (944s left) gem_close_race (basic-process) [67.717467] Starting subtest: basic-process [67.795941] Subtest basic-process: SUCCESS (0.077s) [67.994530] [015/170] (943s left) gem_close_race (basic-threads) [68.155628] Starting subtest: basic-threads [69.328149] Subtest basic-threads: SUCCESS (1.172s) [69.540985] [016/170] (942s left) gem_ctx_create (basic) [69.701847] Starting subtest: basic [69.703318] Subtest basic: SUCCESS (0.000s) [69.894837] [017/170] (941s left) gem_ctx_create (basic-files) [70.050358] Starting subtest: basic-files [72.075455] Subtest basic-files: SUCCESS (2.025s) [72.296097] [018/170] (939s left) gem_ctx_exec (basic) [72.429098] Starting subtest: basic [72.434115] Subtest basic: SUCCESS (0.005s) [72.525762] [019/170] (939s left) gem_exec_basic (basic) [72.664382] Starting subtest: basic [72.665522] Starting dynamic subtest: rcs0-smem [72.666694] Dynamic subtest rcs0-smem: SUCCESS (0.002s) [72.678028] Starting dynamic subtest: bcs0-smem [72.679307] Dynamic subtest bcs0-smem: SUCCESS (0.001s) [72.689418] Starting dynamic subtest: vcs0-smem [72.690698] Dynamic subtest vcs0-smem: SUCCESS (0.001s) [72.700541] Starting dynamic subtest: vecs0-smem [72.701762] Dynamic subtest vecs0-smem: SUCCESS (0.001s) [72.703041] Subtest basic: SUCCESS (0.005s) [72.877894] [020/170] (938s left) gem_exec_create (basic) [73.019789] Starting subtest: basic [73.020991] Starting dynamic subtest: smem [75.072498] Dynamic subtest smem: SUCCESS (2.052s) [75.074073] Subtest basic: SUCCESS (2.052s) [75.283576] [021/170] (936s left) gem_exec_fence (basic-busy) [75.596293] Starting subtest: basic-busy [75.597676] Starting dynamic subtest: rcs0 [75.612784] Dynamic subtest rcs0: SUCCESS (0.025s) [75.624995] Starting dynamic subtest: bcs0 [75.634321] Dynamic subtest bcs0: SUCCESS (0.022s) [75.644817] Starting dynamic subtest: vcs0 [75.656311] Dynamic subtest vcs0: SUCCESS (0.022s) [75.666839] Starting dynamic subtest: vecs0 [75.688426] Dynamic subtest vecs0: SUCCESS (0.032s) [75.689764] Subtest basic-busy: SUCCESS (0.101s) [76.279575] [022/170] (935s left) gem_exec_fence (basic-wait) [76.577972] Starting subtest: basic-wait [76.579457] Starting dynamic subtest: rcs0 [76.605911] Dynamic subtest rcs0: SUCCESS (0.035s) [76.621380] Starting dynamic subtest: bcs0 [76.623820] Dynamic subtest bcs0: SUCCESS (0.018s) [76.634915] Starting dynamic subtest: vcs0 [76.645496] Dynamic subtest vcs0: SUCCESS (0.022s) [76.656775] Starting dynamic subtest: vecs0 [76.675050] Dynamic subtest vecs0: SUCCESS (0.029s) [76.676377] Subtest basic-wait: SUCCESS (0.106s) [77.213131] [023/170] (934s left) gem_exec_fence (basic-await) [77.509861] Starting subtest: basic-await [77.511027] Starting dynamic subtest: rcs0 [77.599225] Dynamic subtest rcs0: SUCCESS (0.096s) [77.624621] Starting dynamic subtest: bcs0 [77.711178] Dynamic subtest bcs0: SUCCESS (0.112s) [77.736996] Starting dynamic subtest: vcs0 [77.843131] Dynamic subtest vcs0: SUCCESS (0.130s) [77.868581] Starting dynamic subtest: vecs0 [77.969377] Dynamic subtest vecs0: SUCCESS (0.126s) [77.971287] Subtest basic-await: SUCCESS (0.467s) [78.579260] [024/170] (933s left) gem_exec_fence (nb-await) [78.877924] Starting subtest: nb-await [78.879137] Starting dynamic subtest: rcs0 [78.934204] Dynamic subtest rcs0: SUCCESS (0.063s) [78.953647] Starting dynamic subtest: bcs0 [79.005174] Dynamic subtest bcs0: SUCCESS (0.071s) [79.031423] Starting dynamic subtest: vcs0 [79.081234] Dynamic subtest vcs0: SUCCESS (0.076s) [79.106544] Starting dynamic subtest: vecs0 [79.156168] Dynamic subtest vecs0: SUCCESS (0.075s) [79.157963] Subtest nb-await: SUCCESS (0.286s) [79.696262] [025/170] (932s left) gem_exec_gttfill (basic) [79.838151] Starting subtest: basic [87.321227] Subtest basic: SUCCESS (7.475s) [87.516043] [026/170] (924s left) gem_exec_parallel (engines) [87.735570] Starting subtest: engines [87.737030] Starting dynamic subtest: basic [90.138631] Dynamic subtest basic: SUCCESS (2.402s) [90.165350] Starting dynamic subtest: contexts [93.579819] Dynamic subtest contexts: SUCCESS (3.433s) [93.593762] Starting dynamic subtest: fds [98.078374] Dynamic subtest fds: SUCCESS (4.502s) [98.092595] Starting dynamic subtest: userptr [100.589955] Dynamic subtest userptr: SUCCESS (2.491s) [100.591952] Subtest engines: SUCCESS (12.829s) [100.765416] [027/170] (911s left) gem_exec_store (basic) [100.911340] Starting subtest: basic [100.972123] Subtest basic: SUCCESS (0.060s) [101.180241] [028/170] (910s left) gem_flink_basic (bad-flink) [101.312516] Starting subtest: bad-flink [101.313723] Subtest bad-flink: SUCCESS (0.000s) [101.396257] [029/170] (910s left) gem_flink_basic (bad-open) [101.530743] Starting subtest: bad-open [101.531872] Subtest bad-open: SUCCESS (0.000s) [101.612770] [030/170] (910s left) gem_flink_basic (basic) [101.747131] Starting subtest: basic [101.748199] Subtest basic: SUCCESS (0.000s) [101.863322] [031/170] (910s left) gem_flink_basic (double-flink) [101.997170] Starting subtest: double-flink [101.998388] Subtest double-flink: SUCCESS (0.000s) [102.097145] [032/170] (909s left) gem_flink_basic (flink-lifetime) [102.230820] Starting subtest: flink-lifetime [102.232250] Subtest flink-lifetime: SUCCESS (0.002s) [102.346251] [033/170] (909s left) gem_huc_copy (huc-copy) [102.483721] Starting subtest: huc-copy [102.486090] Subtest huc-copy: SKIP (0.000s) [102.596458] [034/170] (909s left) gem_linear_blits (basic) [102.883854] Starting subtest: basic [102.896753] Subtest basic: SUCCESS (0.012s) [103.031707] [035/170] (909s left) gem_mmap (basic) [103.231699] Starting subtest: basic [103.236571] Subtest basic: SUCCESS (0.001s) [103.330368] [036/170] (908s left) gem_mmap_gtt (basic) [103.458162] Starting subtest: basic [103.459504] Subtest basic: SUCCESS (0.001s) [103.545567] [037/170] (908s left) gem_render_linear_blits (basic) [103.683439] Starting subtest: basic [103.732257] Subtest basic: SUCCESS (0.048s) [103.794893] [038/170] (908s left) gem_render_tiled_blits (basic) [103.927670] Starting subtest: basic [103.987330] Subtest basic: SUCCESS (0.058s) [104.045230] [039/170] (908s left) gem_ringfill (basic-all) [104.321308] Starting subtest: basic-all [105.560346] Subtest basic-all: SUCCESS (1.231s) [105.631036] [040/170] (906s left) gem_softpin (allocator-basic) [105.773352] Starting subtest: allocator-basic [105.936065] Subtest allocator-basic: SUCCESS (0.154s) [106.047472] [041/170] (906s left) gem_softpin (allocator-basic-reserve) [106.203715] Starting subtest: allocator-basic-reserve [106.366738] Subtest allocator-basic-reserve: SUCCESS (0.154s) [106.480224] [042/170] (905s left) gem_softpin (safe-alignment) [106.637547] Starting subtest: safe-alignment [106.656452] Subtest safe-alignment: SUCCESS (0.017s) [106.763274] [043/170] (905s left) gem_sync (basic-all) [106.906881] Starting subtest: basic-all [109.369414] Subtest basic-all: SUCCESS (2.439s) [109.547435] [044/170] (902s left) gem_sync (basic-each) [109.698407] Starting subtest: basic-each [112.054778] Subtest basic-each: SUCCESS (2.356s) [112.275982] [045/170] (900s left) gem_tiled_blits (basic) [112.573760] Starting subtest: basic [112.601572] Subtest basic: SUCCESS (0.028s) [112.731408] [046/170] (899s left) gem_tiled_fence_blits (basic) [113.089335] Starting subtest: basic [113.119255] Subtest basic: SUCCESS (0.030s) [113.245755] [047/170] (899s left) gem_tiled_pread_basic [113.781295] [048/170] (898s left) gem_wait (busy@all-engines) [113.945248] Starting subtest: busy [113.946493] Starting dynamic subtest: all-engines [114.488583] Dynamic subtest all-engines: SUCCESS (0.543s) [114.489753] Subtest busy: SUCCESS (0.544s) [114.731827] [049/170] (897s left) gem_wait (wait@all-engines) [114.890705] Starting subtest: wait [114.891879] Starting dynamic subtest: all-engines [115.926036] Dynamic subtest all-engines: SUCCESS (1.032s) [115.927120] Subtest wait: SUCCESS (1.032s) [116.166790] [050/170] (896s left) i915_getparams_basic (basic-eu-total) [116.299448] Starting subtest: basic-eu-total [116.301555] Subtest basic-eu-total: SUCCESS (0.000s) [116.380120] [051/170] (896s left) i915_getparams_basic (basic-subslice-total) [116.515562] Starting subtest: basic-subslice-total [116.517752] Subtest basic-subslice-total: SUCCESS (0.000s) [116.597400] [052/170] (896s left) i915_hangman (error-state-basic) [116.739559] Starting subtest: error-state-basic [116.749931] Subtest error-state-basic: SUCCESS (0.011s) [116.830664] [053/170] (895s left) i915_pciid [117.046925] [054/170] (895s left) kms_addfb_basic (addfb25-bad-modifier) [117.175094] Starting subtest: addfb25-bad-modifier [117.176219] Subtest addfb25-bad-modifier: SUCCESS (0.000s) [117.296197] [055/170] (895s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling) [117.433201] Starting subtest: addfb25-framebuffer-vs-set-tiling [117.434242] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s) [117.563734] [056/170] (895s left) kms_addfb_basic (addfb25-modifier-no-flag) [117.700986] Starting subtest: addfb25-modifier-no-flag [117.702247] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s) [117.829983] [057/170] (894s left) kms_addfb_basic (addfb25-x-tiled-legacy) [117.965213] Starting subtest: addfb25-x-tiled-legacy [117.966255] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s) [118.080468] [058/170] (894s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy) [118.214633] Starting subtest: addfb25-x-tiled-mismatch-legacy [118.215887] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.000s) [118.347261] [059/170] (894s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [118.510047] Starting subtest: addfb25-yf-tiled-legacy [118.511163] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s) [118.613575] [060/170] (894s left) kms_addfb_basic (addfb25-y-tiled-legacy) [118.777695] Starting subtest: addfb25-y-tiled-legacy [118.778786] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s) [118.880623] [061/170] (893s left) kms_addfb_basic (addfb25-y-tiled-small-legacy) [119.043339] Starting subtest: addfb25-y-tiled-small-legacy [119.044428] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.000s) [119.146541] [062/170] (893s left) kms_addfb_basic (bad-pitch-0) [119.280808] Starting subtest: bad-pitch-0 [119.281991] Subtest bad-pitch-0: SUCCESS (0.000s) [119.396254] [063/170] (893s left) kms_addfb_basic (bad-pitch-1024) [119.530652] Starting subtest: bad-pitch-1024 [119.531759] Subtest bad-pitch-1024: SUCCESS (0.000s) [119.663913] [064/170] (893s left) kms_addfb_basic (bad-pitch-128) [119.799354] Starting subtest: bad-pitch-128 [119.800385] Subtest bad-pitch-128: SUCCESS (0.000s) [119.930424] [065/170] (893s left) kms_addfb_basic (bad-pitch-256) [120.065823] Starting subtest: bad-pitch-256 [120.066979] Subtest bad-pitch-256: SUCCESS (0.000s) [120.197247] [066/170] (892s left) kms_addfb_basic (bad-pitch-32) [120.325996] Starting subtest: bad-pitch-32 [120.327113] Subtest bad-pitch-32: SUCCESS (0.000s) [120.464249] [067/170] (892s left) kms_addfb_basic (bad-pitch-63) [120.600072] Starting subtest: bad-pitch-63 [120.601138] Subtest bad-pitch-63: SUCCESS (0.000s) [120.730237] [068/170] (892s left) kms_addfb_basic (bad-pitch-65536) [120.868643] Starting subtest: bad-pitch-65536 [120.869744] Subtest bad-pitch-65536: SUCCESS (0.000s) [120.997119] [069/170] (892s left) kms_addfb_basic (bad-pitch-999) [121.130845] Starting subtest: bad-pitch-999 [121.132110] Subtest bad-pitch-999: SUCCESS (0.000s) [121.265385] [070/170] (891s left) kms_addfb_basic (basic) [121.400893] Starting subtest: basic [121.402244] Subtest basic: SUCCESS (0.000s) [121.552805] [071/170] (891s left) kms_addfb_basic (basic-x-tiled-legacy) [121.693806] Starting subtest: basic-x-tiled-legacy [121.694849] Subtest basic-x-tiled-legacy: SUCCESS (0.000s) [121.813151] [072/170] (891s left) kms_addfb_basic (basic-y-tiled-legacy) [121.950853] Starting subtest: basic-y-tiled-legacy [121.951951] Subtest basic-y-tiled-legacy: SUCCESS (0.000s) [122.091891] [073/170] (891s left) kms_addfb_basic (bo-too-small) [122.261894] Starting subtest: bo-too-small [122.263285] Subtest bo-too-small: SUCCESS (0.000s) [122.363493] [074/170] (890s left) kms_addfb_basic (bo-too-small-due-to-tiling) [122.529418] Starting subtest: bo-too-small-due-to-tiling [122.530486] Subtest bo-too-small-due-to-tiling: SUCCESS (0.000s) [122.629976] [075/170] (890s left) kms_addfb_basic (clobberred-modifier) [122.765379] Starting subtest: clobberred-modifier [122.766678] Subtest clobberred-modifier: SUCCESS (0.000s) [122.897044] [076/170] (890s left) kms_addfb_basic (framebuffer-vs-set-tiling) [123.035709] Starting subtest: framebuffer-vs-set-tiling [123.036831] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s) [123.163110] [077/170] (890s left) kms_addfb_basic (invalid-get-prop) [123.298511] Starting subtest: invalid-get-prop [123.299534] Subtest invalid-get-prop: SUCCESS (0.000s) [123.412699] [078/170] (889s left) kms_addfb_basic (invalid-get-prop-any) [123.555101] Starting subtest: invalid-get-prop-any [123.556170] Subtest invalid-get-prop-any: SUCCESS (0.000s) [123.680486] [079/170] (889s left) kms_addfb_basic (invalid-set-prop) [123.817685] Starting subtest: invalid-set-prop [123.818795] Subtest invalid-set-prop: SUCCESS (0.000s) [123.946628] [080/170] (889s left) kms_addfb_basic (invalid-set-prop-any) [124.083705] Starting subtest: invalid-set-prop-any [124.084828] Subtest invalid-set-prop-any: SUCCESS (0.000s) [124.196354] [081/170] (889s left) kms_addfb_basic (no-handle) [124.330558] Starting subtest: no-handle [124.331663] Subtest no-handle: SUCCESS (0.000s) [124.447043] [082/170] (888s left) kms_addfb_basic (size-max) [124.614793] Starting subtest: size-max [124.615887] Subtest size-max: SUCCESS (0.000s) [124.713371] [083/170] (888s left) kms_addfb_basic (small-bo) [124.878393] Starting subtest: small-bo [124.879483] Subtest small-bo: SUCCESS (0.000s) [124.979775] [084/170] (888s left) kms_addfb_basic (tile-pitch-mismatch) [125.117942] Starting subtest: tile-pitch-mismatch [125.119068] Subtest tile-pitch-mismatch: SUCCESS (0.000s) [125.247067] [085/170] (888s left) kms_addfb_basic (too-high) [125.412656] Starting subtest: too-high [125.413780] Subtest too-high: SUCCESS (0.001s) [125.512727] [086/170] (888s left) kms_addfb_basic (too-wide) [125.678340] Starting subtest: too-wide [125.679411] Subtest too-wide: SUCCESS (0.000s) [125.780358] [087/170] (887s left) kms_addfb_basic (unused-handle) [125.917887] Starting subtest: unused-handle [125.918972] Subtest unused-handle: SUCCESS (0.000s) [126.046657] [088/170] (887s left) kms_addfb_basic (unused-modifier) [126.185819] Starting subtest: unused-modifier [126.187183] Subtest unused-modifier: SUCCESS (0.000s) [126.313036] [089/170] (887s left) kms_addfb_basic (unused-offsets) [126.447558] Starting subtest: unused-offsets [126.448850] Subtest unused-offsets: SUCCESS (0.000s) [126.580898] [090/170] (887s left) kms_addfb_basic (unused-pitches) [126.716650] Starting subtest: unused-pitches [126.717820] Subtest unused-pitches: SUCCESS (0.000s) [126.846781] [091/170] (886s left) kms_busy (basic) [127.017476] Starting subtest: basic [127.018744] Starting dynamic subtest: flip [128.001488] Dynamic subtest flip: SUCCESS (0.980s) [128.017393] Starting dynamic subtest: modeset [131.876270] Dynamic subtest modeset: SUCCESS (3.877s) [131.877323] Subtest basic: SUCCESS (4.860s) [132.846902] [092/170] (880s left) kms_chamelium_hpd (dp-hpd-fast) [133.313320] Subtest dp-hpd-fast: SKIP (0.000s) [134.202203] [093/170] (879s left) kms_chamelium_edid (dp-edid-read) [134.670573] Subtest dp-edid-read: SKIP (0.000s) [135.548365] [094/170] (878s left) kms_chamelium_frames (dp-crc-fast) [136.017356] Subtest dp-crc-fast: SKIP (0.000s) [136.892086] [095/170] (876s left) kms_chamelium_hpd (hdmi-hpd-fast) [137.375404] Subtest hdmi-hpd-fast: SKIP (0.000s) [138.249375] [096/170] (875s left) kms_chamelium_edid (hdmi-edid-read) [138.740424] Subtest hdmi-edid-read: SKIP (0.000s) [139.643578] [097/170] (874s left) kms_chamelium_frames (hdmi-crc-fast) [140.126227] Subtest hdmi-crc-fast: SKIP (0.000s) [140.988606] [098/170] (872s left) kms_chamelium_hpd (vga-hpd-fast) [141.470513] Subtest vga-hpd-fast: SKIP (0.000s) [142.331398] [099/170] (871s left) kms_chamelium_edid (vga-edid-read) [142.813487] Subtest vga-edid-read: SKIP (0.000s) [143.674313] [100/170] (870s left) kms_prop_blob (basic) [143.803227] Starting subtest: basic [143.804438] Subtest basic: SUCCESS (0.000s) [143.895596] [101/170] (870s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic) [144.054667] Starting subtest: basic-busy-flip-before-cursor-atomic [144.056761] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s) [144.140518] [102/170] (869s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy) [144.304391] Starting subtest: basic-busy-flip-before-cursor-legacy [144.306399] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s) [144.390033] [103/170] (869s left) kms_cursor_legacy (basic-flip-after-cursor-atomic) [144.554347] Starting subtest: basic-flip-after-cursor-atomic [145.842398] Subtest basic-flip-after-cursor-atomic: SUCCESS (1.288s) [146.800323] [104/170] (867s left) kms_cursor_legacy (basic-flip-after-cursor-legacy) [146.964550] Starting subtest: basic-flip-after-cursor-legacy [148.263166] Subtest basic-flip-after-cursor-legacy: SUCCESS (1.298s) [149.228730] [105/170] (864s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size) [149.393747] Starting subtest: basic-flip-after-cursor-varying-size [150.704959] Subtest basic-flip-after-cursor-varying-size: SUCCESS (1.311s) [151.660979] [106/170] (862s left) kms_cursor_legacy (basic-flip-before-cursor-atomic) [151.827495] Starting subtest: basic-flip-before-cursor-atomic [153.120169] Subtest basic-flip-before-cursor-atomic: SUCCESS (1.292s) [154.093735] [107/170] (860s left) kms_cursor_legacy (basic-flip-before-cursor-legacy) [154.255381] Starting subtest: basic-flip-before-cursor-legacy [155.554727] Subtest basic-flip-before-cursor-legacy: SUCCESS (1.298s) [156.525713] [108/170] (857s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size) [156.689279] Starting subtest: basic-flip-before-cursor-varying-size [157.969723] Subtest basic-flip-before-cursor-varying-size: SUCCESS (1.282s) [158.894163] [109/170] (855s left) kms_flip (basic-flip-vs-dpms) [159.030399] Starting subtest: basic-flip-vs-dpms [159.033218] Starting dynamic subtest: A-eDP1 [161.899464] Dynamic subtest A-eDP1: SUCCESS (2.866s) [161.915902] Starting dynamic subtest: B-eDP1 [164.267211] Dynamic subtest B-eDP1: SUCCESS (2.366s) [164.283746] Starting dynamic subtest: C-eDP1 [166.624544] Dynamic subtest C-eDP1: SUCCESS (2.352s) [166.625700] Subtest basic-flip-vs-dpms: SUCCESS (7.592s) [167.534015] [110/170] (846s left) kms_flip (basic-flip-vs-modeset) [167.677854] Starting subtest: basic-flip-vs-modeset [167.682625] Starting dynamic subtest: A-eDP1 [170.531114] Dynamic subtest A-eDP1: SUCCESS (2.849s) [170.547792] Starting dynamic subtest: B-eDP1 [172.900083] Dynamic subtest B-eDP1: SUCCESS (2.365s) [172.915954] Starting dynamic subtest: C-eDP1 [175.271543] Dynamic subtest C-eDP1: SUCCESS (2.372s) [175.272611] Subtest basic-flip-vs-modeset: SUCCESS (7.594s) [176.238299] [111/170] (837s left) kms_flip (basic-flip-vs-wf_vblank) [176.382175] Starting subtest: basic-flip-vs-wf_vblank [176.385242] Starting dynamic subtest: A-eDP1 [178.708275] Dynamic subtest A-eDP1: SUCCESS (2.324s) [178.724617] Starting dynamic subtest: B-eDP1 [180.989944] Dynamic subtest B-eDP1: SUCCESS (2.281s) [181.006111] Starting dynamic subtest: C-eDP1 [183.294768] Dynamic subtest C-eDP1: SUCCESS (2.304s) [183.297273] Subtest basic-flip-vs-wf_vblank: SUCCESS (6.917s) [184.557122] [112/170] (829s left) kms_flip (basic-plain-flip) [184.699981] Starting subtest: basic-plain-flip [184.703287] Starting dynamic subtest: A-eDP1 [186.739524] Dynamic subtest A-eDP1: SUCCESS (2.036s) [186.756301] Starting dynamic subtest: B-eDP1 [188.704252] Dynamic subtest B-eDP1: SUCCESS (1.964s) [188.720984] Starting dynamic subtest: C-eDP1 [190.690249] Dynamic subtest C-eDP1: SUCCESS (1.985s) [190.692836] Subtest basic-plain-flip: SUCCESS (5.994s) [191.983505] [113/170] (822s left) kms_force_connector_basic (force-connector-state) [192.118507] Starting subtest: force-connector-state [193.848332] Subtest force-connector-state: SUCCESS (1.728s) [194.462729] [114/170] (819s left) kms_force_connector_basic (force-edid) [194.604124] Starting subtest: force-edid [194.865054] Subtest force-edid: SUCCESS (0.257s) [194.995905] [115/170] (819s left) kms_force_connector_basic (force-load-detect) [195.135451] Starting subtest: force-load-detect [195.137558] Subtest force-load-detect: SKIP (0.000s) [195.246026] [116/170] (819s left) kms_force_connector_basic (prune-stale-modes) [195.384868] Starting subtest: prune-stale-modes [195.699727] Subtest prune-stale-modes: SUCCESS (0.309s) [195.813140] [117/170] (818s left) kms_frontbuffer_tracking (basic) [195.978099] Starting subtest: basic [199.297117] Subtest basic: SUCCESS (3.317s) [199.415955] [118/170] (814s left) kms_pipe_crc_basic (compare-crc-sanitycheck) [199.583085] Starting subtest: compare-crc-sanitycheck [199.584646] Starting dynamic subtest: pipe-A-eDP-1 [200.262318] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.676s) [200.282418] Starting dynamic subtest: pipe-B-eDP-1 [201.628270] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.362s) [201.647849] Starting dynamic subtest: pipe-C-eDP-1 [203.179091] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.541s) [203.180380] Subtest compare-crc-sanitycheck: SUCCESS (3.592s) [204.134130] [119/170] (810s left) kms_pipe_crc_basic (hang-read-crc) [204.301218] Starting subtest: hang-read-crc [204.304261] Starting dynamic subtest: pipe-A-eDP-1 [206.618669] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.314s) [206.637066] Starting dynamic subtest: pipe-B-eDP-1 [209.593882] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.970s) [209.612688] Starting dynamic subtest: pipe-C-eDP-1 [212.892513] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.295s) [212.893646] Subtest hang-read-crc: SUCCESS (8.591s) [213.799174] [120/170] (800s left) kms_pipe_crc_basic (nonblocking-crc) [213.965668] Starting subtest: nonblocking-crc [213.967329] Starting dynamic subtest: pipe-A-eDP-1 [214.826474] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.857s) [214.844117] Starting dynamic subtest: pipe-B-eDP-1 [216.376640] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.547s) [216.396530] Starting dynamic subtest: pipe-C-eDP-1 [218.085830] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.703s) [218.086953] Subtest nonblocking-crc: SUCCESS (4.120s) [219.047847] [121/170] (795s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence) [219.214358] Starting subtest: nonblocking-crc-frame-sequence [219.217488] Starting dynamic subtest: pipe-A-eDP-1 [220.073973] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.856s) [220.093159] Starting dynamic subtest: pipe-B-eDP-1 [221.623642] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.546s) [221.643733] Starting dynamic subtest: pipe-C-eDP-1 [223.331029] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.702s) [223.332237] Subtest nonblocking-crc-frame-sequence: SUCCESS (4.117s) [224.295935] [122/170] (790s left) kms_pipe_crc_basic (read-crc) [224.461931] Starting subtest: read-crc [224.465130] Starting dynamic subtest: pipe-A-eDP-1 [225.257147] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.791s) [225.276280] Starting dynamic subtest: pipe-B-eDP-1 [226.742360] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.480s) [226.766181] Starting dynamic subtest: pipe-C-eDP-1 [228.388861] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.642s) [228.394254] Subtest read-crc: SUCCESS (3.927s) [229.353475] [123/170] (785s left) kms_pipe_crc_basic (read-crc-frame-sequence) [229.519454] Starting subtest: read-crc-frame-sequence [229.522533] Starting dynamic subtest: pipe-A-eDP-1 [230.308714] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.786s) [230.329834] Starting dynamic subtest: pipe-B-eDP-1 [231.799312] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.486s) [231.818643] Starting dynamic subtest: pipe-C-eDP-1 [233.440358] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.635s) [233.441453] Subtest read-crc-frame-sequence: SUCCESS (3.920s) [234.407582] [124/170] (780s left) kms_psr (primary_page_flip) [234.569260] Starting subtest: primary_page_flip [238.896827] Subtest primary_page_flip: SUCCESS (4.327s) [239.847800] [125/170] (774s left) kms_psr (cursor_plane_move) [240.018382] Starting subtest: cursor_plane_move [244.211759] Subtest cursor_plane_move: SUCCESS (4.193s) [245.160301] [126/170] (769s left) kms_psr (sprite_plane_onoff) [245.326543] Starting subtest: sprite_plane_onoff [249.555560] Subtest sprite_plane_onoff: SUCCESS (4.220s) [250.471737] [127/170] (764s left) kms_psr (primary_mmap_gtt) [250.632796] Starting subtest: primary_mmap_gtt [254.872626] Subtest primary_mmap_gtt: SUCCESS (4.239s) [255.783842] [128/170] (758s left) kms_setmode (basic-clone-single-crtc) [255.916729] Starting subtest: basic-clone-single-crtc [255.919664] Subtest basic-clone-single-crtc: SKIP (0.000s) [256.005622] [129/170] (758s left) i915_pm_backlight (basic-brightness) [256.164137] Starting subtest: basic-brightness [256.274731] Starting dynamic subtest: eDP-1 [256.817372] Dynamic subtest eDP-1: SUCCESS (0.543s) [256.818681] Subtest basic-brightness: SUCCESS (0.646s) [257.768378] [130/170] (756s left) i915_pm_rpm (basic-pci-d3-state) [259.674474] Starting subtest: basic-pci-d3-state [264.067615] Subtest basic-pci-d3-state: SUCCESS (4.392s) [264.269931] [131/170] (750s left) i915_pm_rpm (basic-rte) [264.405377] Starting subtest: basic-rte [270.531696] Subtest basic-rte: SUCCESS (6.125s) [275.843966] [132/170] (738s left) i915_pm_rps (basic-api) [275.979605] Starting subtest: basic-api [275.984189] Subtest basic-api: SUCCESS (0.005s) [276.081397] [133/170] (738s left) prime_self_import (basic-llseek-bad) [276.207939] Starting subtest: basic-llseek-bad [276.211716] Subtest basic-llseek-bad: SUCCESS (0.003s) [276.315976] [134/170] (738s left) prime_self_import (basic-llseek-size) [276.450598] Starting subtest: basic-llseek-size [276.454353] Subtest basic-llseek-size: SUCCESS (0.004s) [276.564631] [135/170] (738s left) prime_self_import (basic-with_fd_dup) [276.698405] Starting subtest: basic-with_fd_dup [276.703716] Subtest basic-with_fd_dup: SUCCESS (0.004s) [276.815382] [136/170] (738s left) prime_self_import (basic-with_one_bo) [276.948672] Starting subtest: basic-with_one_bo [276.954267] Subtest basic-with_one_bo: SUCCESS (0.005s) [277.042971] [137/170] (737s left) prime_self_import (basic-with_one_bo_two_files) [277.176808] Starting subtest: basic-with_one_bo_two_files [277.180172] Subtest basic-with_one_bo_two_files: SUCCESS (0.003s) [277.280205] [138/170] (737s left) prime_self_import (basic-with_two_bos) [277.413735] Starting subtest: basic-with_two_bos [277.419235] Subtest basic-with_two_bos: SUCCESS (0.004s) [277.530384] [139/170] (737s left) prime_vgem (basic-fence-flip) [277.687885] Starting subtest: basic-fence-flip [278.206438] Subtest basic-fence-flip: SUCCESS (0.517s) [278.331596] [140/170] (736s left) prime_vgem (basic-fence-mmap) [278.480124] Starting subtest: basic-fence-mmap [278.527261] Subtest basic-fence-mmap: SUCCESS (0.047s) [278.631316] [141/170] (736s left) prime_vgem (basic-fence-read) [278.780124] Starting subtest: basic-fence-read [278.852808] Subtest basic-fence-read: SUCCESS (0.072s) [278.948577] [142/170] (736s left) prime_vgem (basic-gtt) [279.096380] Starting subtest: basic-gtt [279.119527] Subtest basic-gtt: SUCCESS (0.023s) [279.247725] [143/170] (735s left) prime_vgem (basic-read) [279.396384] Starting subtest: basic-read [279.431506] Subtest basic-read: SUCCESS (0.035s) [279.547762] [144/170] (735s left) prime_vgem (basic-write) [279.696479] Starting subtest: basic-write [279.737646] Subtest basic-write: SUCCESS (0.041s) [279.830538] [145/170] (735s left) vgem_basic (setversion) [279.972797] Starting subtest: setversion [279.975199] Subtest setversion: SUCCESS (0.000s) [280.047172] [146/170] (735s left) vgem_basic (create) [280.189184] Starting subtest: create [280.190299] Subtest create: SUCCESS (0.000s) [280.263821] [147/170] (734s left) vgem_basic (debugfs) [280.405769] Starting subtest: debugfs [280.406994] Subtest debugfs: SUCCESS (0.001s) [280.479313] [148/170] (734s left) vgem_basic (dmabuf-export) [280.622400] Starting subtest: dmabuf-export [280.625873] Subtest dmabuf-export: SUCCESS (0.003s) [280.730023] [149/170] (734s left) vgem_basic (dmabuf-fence) [280.872370] Starting subtest: dmabuf-fence [280.873556] Subtest dmabuf-fence: SUCCESS (0.001s) [280.943610] [150/170] (734s left) vgem_basic (dmabuf-fence-before) [281.090522] Starting subtest: dmabuf-fence-before [281.091706] Subtest dmabuf-fence-before: SUCCESS (0.001s) [281.160085] [151/170] (734s left) vgem_basic (dmabuf-mmap) [281.307363] Starting subtest: dmabuf-mmap [281.333028] Subtest dmabuf-mmap: SUCCESS (0.026s) [281.410169] [152/170] (733s left) vgem_basic (mmap) [281.557417] Starting subtest: mmap [281.573396] Subtest mmap: SUCCESS (0.017s) [281.643883] [153/170] (733s left) vgem_basic (second-client) [281.790700] Starting subtest: second-client [281.840401] Subtest second-client: SUCCESS (0.049s) [281.909887] [154/170] (733s left) vgem_basic (sysfs) [282.057580] Starting subtest: sysfs [282.058725] Subtest sysfs: SUCCESS (0.001s) [282.127217] [155/170] (733s left) core_hotunplug (unbind-rebind) [282.307732] Starting subtest: unbind-rebind [284.727234] Subtest unbind-rebind: SUCCESS (2.417s) [284.759561] [156/170] (730s left) vgem_basic (unload) [284.895525] Starting subtest: unload [313.920913] Subtest unload: SUCCESS (28.991s) [314.031083] [157/170] (701s left) i915_module_load (reload) [314.157489] Starting subtest: reload [405.633324] Inactivity timeout exceeded. Killing the current test with SIGQUIT.