Dec 07 14:08:55.470 INFO testing google-content2_sandbox-1.0.8+20181009 against master#906deae0790bd18681b937fe9a141a3c26cf1855 for pr-56514 Dec 07 14:08:55.470 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-3/master#906deae0790bd18681b937fe9a141a3c26cf1855:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-3/pr-56514/master#906deae0790bd18681b937fe9a141a3c26cf1855:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +906deae0790bd18681b937fe9a141a3c26cf1855-alt build --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"` Dec 07 14:08:55.908 INFO [stdout] 422cc15fe152c9e0583b666a31e1b3df9e5ec2a03a1f983bd8251dbcd6e52dc7 Dec 07 14:08:55.914 INFO running `"docker" "start" "-a" "422cc15fe152c9e0583b666a31e1b3df9e5ec2a03a1f983bd8251dbcd6e52dc7"` Dec 07 14:08:57.807 INFO [stderr] usermod: no changes Dec 07 14:08:58.016 INFO [stderr] Compiling google-content2_sandbox v1.0.8+20181009 (/source) Dec 07 14:09:14.676 INFO [stderr] Finished dev [unoptimized + debuginfo] target(s) in 16.85s Dec 07 14:09:14.696 INFO [stderr] su: No module specific data is present Dec 07 14:09:15.932 INFO running `"docker" "inspect" "422cc15fe152c9e0583b666a31e1b3df9e5ec2a03a1f983bd8251dbcd6e52dc7"` Dec 07 14:09:16.254 INFO running `"docker" "rm" "-f" "422cc15fe152c9e0583b666a31e1b3df9e5ec2a03a1f983bd8251dbcd6e52dc7"` Dec 07 14:09:16.604 INFO [stdout] 422cc15fe152c9e0583b666a31e1b3df9e5ec2a03a1f983bd8251dbcd6e52dc7 Dec 07 14:09:16.606 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-3/master#906deae0790bd18681b937fe9a141a3c26cf1855:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-3/pr-56514/master#906deae0790bd18681b937fe9a141a3c26cf1855:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +906deae0790bd18681b937fe9a141a3c26cf1855-alt test --frozen --no-run" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"` Dec 07 14:09:17.002 INFO [stdout] bcadf0d3bce7b80309e802f72fecc4cbc8130e7282f9d306423d289c7204af5c Dec 07 14:09:17.004 INFO running `"docker" "start" "-a" "bcadf0d3bce7b80309e802f72fecc4cbc8130e7282f9d306423d289c7204af5c"` Dec 07 14:09:18.812 INFO [stderr] usermod: no changes Dec 07 14:09:19.014 INFO [stderr] Compiling google-content2_sandbox v1.0.8+20181009 (/source) Dec 07 14:09:34.144 INFO [stderr] Finished dev [unoptimized + debuginfo] target(s) in 15.30s Dec 07 14:09:34.156 INFO [stderr] su: No module specific data is present Dec 07 14:09:34.882 INFO running `"docker" "inspect" "bcadf0d3bce7b80309e802f72fecc4cbc8130e7282f9d306423d289c7204af5c"` Dec 07 14:09:35.192 INFO running `"docker" "rm" "-f" "bcadf0d3bce7b80309e802f72fecc4cbc8130e7282f9d306423d289c7204af5c"` Dec 07 14:09:35.390 INFO [stdout] bcadf0d3bce7b80309e802f72fecc4cbc8130e7282f9d306423d289c7204af5c Dec 07 14:09:35.400 INFO running `"docker" "create" "-v" "/mnt/big/crater/work/local/target-dirs/pr-56514/worker-3/master#906deae0790bd18681b937fe9a141a3c26cf1855:/target:rw,Z" "-v" "/mnt/big/crater/work/local/test-source/worker-3/pr-56514/master#906deae0790bd18681b937fe9a141a3c26cf1855:/source:ro,Z" "-v" "/mnt/big/crater/work/local/cargo-home:/cargo-home:ro,Z" "-v" "/mnt/big/crater/work/local/rustup-home:/rustup-home:ro,Z" "-e" "USER_ID=1000" "-e" "SOURCE_DIR=/source" "-e" "USER_ID=1000" "-e" "CMD=cargo +906deae0790bd18681b937fe9a141a3c26cf1855-alt test --frozen" "-e" "CARGO_TARGET_DIR=/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/cargo-home" "-e" "RUSTUP_HOME=/rustup-home" "-m" "1536M" "--network" "none" "crater"` Dec 07 14:09:35.686 INFO [stdout] 58dde7d67cfeab81c796aa20ebeaa75f811528f6eabf68c5c45f6a9550a177bc Dec 07 14:09:35.688 INFO running `"docker" "start" "-a" "58dde7d67cfeab81c796aa20ebeaa75f811528f6eabf68c5c45f6a9550a177bc"` Dec 07 14:09:36.640 INFO [stderr] usermod: no changes Dec 07 14:09:36.892 INFO [stderr] Finished dev [unoptimized + debuginfo] target(s) in 0.22s Dec 07 14:09:36.904 INFO [stderr] Running /target/debug/deps/google_content2_sandbox-0af48c4de5ebe384 Dec 07 14:09:36.916 INFO [stderr] Doc-tests google-content2_sandbox Dec 07 14:09:36.916 INFO [stdout] Dec 07 14:09:36.916 INFO [stdout] running 0 tests Dec 07 14:09:36.916 INFO [stdout] Dec 07 14:09:36.916 INFO [stdout] test result: ok. 0 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out Dec 07 14:09:36.916 INFO [stdout] Dec 07 14:09:46.626 INFO [stdout] Dec 07 14:09:46.626 INFO [stdout] running 37 tests Dec 07 14:09:46.692 INFO [stdout] test src/lib.rs - (line 55) ... ignored Dec 07 14:10:38.804 INFO [stdout] test src/lib.rs - (line 106) ... ok Dec 07 14:10:43.013 INFO [stdout] test src/lib.rs - OrderCancellineitemCall (line 10761) ... ok Dec 07 14:10:44.104 INFO [stdout] test src/lib.rs - OrderAcknowledgeCall (line 7448) ... ok Dec 07 14:10:45.032 INFO [stdout] test src/lib.rs - OrderCancelCall (line 12160) ... ok Dec 07 14:10:45.376 INFO [stdout] test src/lib.rs - OrderAdvancetestorderCall (line 7734) ... ok Dec 07 14:10:46.684 INFO [stdout] test src/lib.rs - OrderCanceltestorderbycustomerCall (line 8835) ... test src/lib.rs - OrderCanceltestorderbycustomerCall (line 8835) has been running for over 60 seconds Dec 07 14:10:46.685 INFO [stdout] test src/lib.rs - OrderCreatetestorderCall (line 8275) ... test src/lib.rs - OrderCreatetestorderCall (line 8275) has been running for over 60 seconds Dec 07 14:10:46.696 INFO [stdout] test src/lib.rs - OrderCreatetestreturnCall (line 11047) ... test src/lib.rs - OrderCreatetestreturnCall (line 11047) has been running for over 60 seconds Dec 07 14:10:47.138 INFO [stdout] test src/lib.rs - OrderCanceltestorderbycustomerCall (line 8835) ... ok Dec 07 14:10:48.384 INFO [stdout] test src/lib.rs - OrderCreatetestorderCall (line 8275) ... ok Dec 07 14:10:49.712 INFO [stdout] test src/lib.rs - OrderCreatetestreturnCall (line 11047) ... ok Dec 07 14:11:27.788 INFO [stdout] test src/lib.rs - OrderRefundCall (line 7162) ... ok Dec 07 14:11:27.961 INFO [stdout] test src/lib.rs - OrderCustombatchCall (line 10234) ... ok Dec 07 14:11:28.572 INFO [stdout] test src/lib.rs - OrderGetCall (line 9407) ... ok Dec 07 14:11:31.384 INFO [stdout] test src/lib.rs - OrderGetbymerchantorderidCall (line 11619) ... ok Dec 07 14:11:33.400 INFO [stdout] test src/lib.rs - OrderListCall (line 6277) ... ok Dec 07 14:11:33.976 INFO [stdout] test src/lib.rs - OrderGettestordertemplateCall (line 6895) ... ok Dec 07 14:11:34.812 INFO [stdout] test src/lib.rs - OrderInstorerefundlineitemCall (line 10475) ... ok Dec 07 14:11:41.733 INFO [stdout] test src/lib.rs - OrderMethods (line 3501) ... ok Dec 07 14:12:09.255 INFO [stdout] test src/lib.rs - OrderReturnrefundlineitemCall (line 9121) ... ok Dec 07 14:12:16.340 INFO [stdout] test src/lib.rs - OrderRejectreturnlineitemCall (line 7989) ... ok Dec 07 14:12:18.296 INFO [stdout] test src/lib.rs - OrderReturnlineitemCall (line 9662) ... ok Dec 07 14:12:24.166 INFO [stdout] test src/lib.rs - OrderUpdatelineitemshippingdetailCall (line 9948) ... ok Dec 07 14:12:25.564 INFO [stdout] test src/lib.rs - OrderSetlineitemmetadataCall (line 11874) ... ok Dec 07 14:12:26.933 INFO [stdout] test src/lib.rs - OrderUpdatemerchantorderidCall (line 6609) ... ok Dec 07 14:12:27.992 INFO [stdout] test src/lib.rs - OrderShiplineitemCall (line 8549) ... ok Dec 07 14:12:35.004 INFO [stdout] test src/lib.rs - OrderUpdateshipmentCall (line 11333) ... ok Dec 07 14:13:06.921 INFO [stdout] test src/lib.rs - OrderinvoiceCreatechargeinvoiceCall (line 5991) ... ok Dec 07 14:13:16.348 INFO [stdout] test src/lib.rs - OrderinvoiceCreaterefundinvoiceCall (line 5705) ... test src/lib.rs - OrderinvoiceCreaterefundinvoiceCall (line 5705) has been running for over 60 seconds Dec 07 14:13:17.632 INFO [stdout] test src/lib.rs - OrderinvoiceMethods (line 3417) ... ok Dec 07 14:13:21.282 INFO [stdout] test src/lib.rs - OrderinvoiceCreaterefundinvoiceCall (line 5705) ... ok Dec 07 14:13:24.168 INFO [stdout] test src/lib.rs - OrderpaymentMethods (line 3208) ... test src/lib.rs - OrderpaymentMethods (line 3208) has been running for over 60 seconds Dec 07 14:13:25.560 INFO [stdout] test src/lib.rs - OrderpaymentNotifyauthapprovedCall (line 4289) ... test src/lib.rs - OrderpaymentNotifyauthapprovedCall (line 4289) has been running for over 60 seconds Dec 07 14:13:26.940 INFO [stdout] test src/lib.rs - OrderpaymentNotifyauthdeclinedCall (line 4003) ... test src/lib.rs - OrderpaymentNotifyauthdeclinedCall (line 4003) has been running for over 60 seconds Dec 07 14:13:27.542 INFO [stdout] test src/lib.rs - OrderpaymentMethods (line 3208) ... ok Dec 07 14:13:27.996 INFO [stdout] test src/lib.rs - OrderpaymentNotifychargeCall (line 4575) ... test src/lib.rs - OrderpaymentNotifychargeCall (line 4575) has been running for over 60 seconds Dec 07 14:13:29.081 INFO [stdout] test src/lib.rs - OrderpaymentNotifyauthapprovedCall (line 4289) ... ok Dec 07 14:13:31.017 INFO [stdout] test src/lib.rs - OrderpaymentNotifyauthdeclinedCall (line 4003) ... ok Dec 07 14:13:32.308 INFO [stdout] test src/lib.rs - OrderpaymentNotifychargeCall (line 4575) ... ok Dec 07 14:13:35.005 INFO [stdout] test src/lib.rs - OrderpaymentNotifyrefundCall (line 4861) ... test src/lib.rs - OrderpaymentNotifyrefundCall (line 4861) has been running for over 60 seconds Dec 07 14:13:36.392 INFO [stdout] test src/lib.rs - OrderpaymentNotifyrefundCall (line 4861) ... ok Dec 07 14:13:52.764 INFO [stdout] test src/lib.rs - OrderreturnGetCall (line 5147) ... ok Dec 07 14:13:55.188 INFO [stdout] test src/lib.rs - OrderreturnListCall (line 5402) ... ok Dec 07 14:13:56.680 INFO [stdout] test src/lib.rs - ShoppingContent (line 292) ... ok Dec 07 14:13:56.692 INFO [stdout] test src/lib.rs - OrderreturnMethods (line 3334) ... ok Dec 07 14:13:56.692 INFO [stdout] Dec 07 14:13:56.692 INFO [stdout] test result: ok. 36 passed; 0 failed; 1 ignored; 0 measured; 0 filtered out Dec 07 14:13:56.692 INFO [stdout] Dec 07 14:13:56.756 INFO [stderr] su: No module specific data is present Dec 07 14:13:57.996 INFO running `"docker" "inspect" "58dde7d67cfeab81c796aa20ebeaa75f811528f6eabf68c5c45f6a9550a177bc"` Dec 07 14:13:58.304 INFO running `"docker" "rm" "-f" "58dde7d67cfeab81c796aa20ebeaa75f811528f6eabf68c5c45f6a9550a177bc"` Dec 07 14:13:58.659 INFO [stdout] 58dde7d67cfeab81c796aa20ebeaa75f811528f6eabf68c5c45f6a9550a177bc