builder: mozilla-central_ubuntu64_hw_qr_test-dromaeojs-e10s slave: talos-linux64-ix-056 starttime: 1503444362.22 results: success (0) revision: 80fafbaaf8484104018976c2a0442c91805d3554 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:02.218982) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:02.219506) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:02.219907) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:02.235814) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:02.236105) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-08-22 16:26:02-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 222M=0s 2017-08-22 16:26:02 (222 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.130538 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:02.384225) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:02.384786) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017820 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:02.435644) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:02.436030) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 80fafbaaf8484104018976c2a0442c91805d3554 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 80fafbaaf8484104018976c2a0442c91805d3554 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-08-22 16:26:02,654 truncating revision to first 12 chars 2017-08-22 16:26:02,654 Setting DEBUG logging. 2017-08-22 16:26:02,654 attempt 1/10 2017-08-22 16:26:02,654 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/80fafbaaf848?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-08-22 16:26:03,092 unpacking tar archive at: mozilla-central-80fafbaaf848/testing/mozharness/ program finished with exit code 0 elapsedTime=0.736871 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:03.191931) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:03.192292) ========= script_repo_revision: 80fafbaaf8484104018976c2a0442c91805d3554 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:03.192687) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:03.192977) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-22 16:26:03.207962) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 1 secs) (at 2017-08-22 16:26:03.208328) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:26:03 INFO - MultiFileLogger online at 20170822 16:26:03 in /builds/slave/test 16:26:03 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 16:26:03 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:26:03 INFO - {'append_to_log': False, 16:26:03 INFO - 'base_work_dir': '/builds/slave/test', 16:26:03 INFO - 'blob_upload_branch': 'Firefox', 16:26:03 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:26:03 INFO - 'branch': 'Firefox', 16:26:03 INFO - 'buildbot_json_path': 'buildprops.json', 16:26:03 INFO - 'code_coverage': False, 16:26:03 INFO - 'config_files': ('talos/linux_config.py',), 16:26:03 INFO - 'default_actions': ('clobber', 16:26:03 INFO - 'read-buildbot-config', 16:26:03 INFO - 'download-and-extract', 16:26:03 INFO - 'populate-webroot', 16:26:03 INFO - 'create-virtualenv', 16:26:03 INFO - 'install', 16:26:03 INFO - 'setup-mitmproxy', 16:26:03 INFO - 'run-tests'), 16:26:03 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:26:03 INFO - 'disable_ccov_upload': False, 16:26:03 INFO - 'download_minidump_stackwalk': True, 16:26:03 INFO - 'download_symbols': 'ondemand', 16:26:03 INFO - 'enable_stylo': False, 16:26:03 INFO - 'enable_webrender': False, 16:26:03 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:26:03 INFO - 'tooltool.py': '/tools/tooltool.py', 16:26:03 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:26:03 INFO - '/tools/misc-python/virtualenv.py')}, 16:26:03 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:26:03 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:26:03 INFO - 'gecko_profile': False, 16:26:03 INFO - 'gecko_profile_interval': 0, 16:26:03 INFO - 'installer_path': 'installer.exe', 16:26:03 INFO - 'log_level': 'info', 16:26:03 INFO - 'log_name': 'talos', 16:26:03 INFO - 'log_to_console': True, 16:26:03 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:26:03 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:26:03 INFO - 'opt_config_files': (), 16:26:03 INFO - 'pip_index': False, 16:26:03 INFO - 'suite': 'dromaeojs-e10s', 16:26:03 INFO - 'system_bits': '32', 16:26:03 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:26:03 INFO - 'title': 'talos-linux64-ix-056', 16:26:03 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:26:03 INFO - 'use_talos_json': True, 16:26:03 INFO - 'verify': 'False', 16:26:03 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:26:03 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:26:03 INFO - 'work_dir': 'build'} 16:26:03 INFO - [mozharness: 2017-08-22 23:26:03.579371Z] Running clobber step. 16:26:03 INFO - Running pre-action listener: _resource_record_pre_action 16:26:03 INFO - Running main action method: clobber 16:26:03 INFO - rmtree: /builds/slave/test/build 16:26:03 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:26:04 INFO - Running post-action listener: _resource_record_post_action 16:26:04 INFO - [mozharness: 2017-08-22 23:26:04.764222Z] Finished clobber step (success) 16:26:04 INFO - [mozharness: 2017-08-22 23:26:04.764448Z] Running read-buildbot-config step. 16:26:04 INFO - Running pre-action listener: _resource_record_pre_action 16:26:04 INFO - Running main action method: read_buildbot_config 16:26:04 INFO - Using buildbot properties: 16:26:04 INFO - { 16:26:04 INFO - "project": "", 16:26:04 INFO - "product": "firefox", 16:26:04 INFO - "who": "kwierso@gmail.com", 16:26:04 INFO - "installer_path": "public/build/target.tar.bz2", 16:26:04 INFO - "builddir": "mozilla-central_ubuntu64_hw_qr_test-dromaeojs-e10s", 16:26:04 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 16:26:04 INFO - "buildername": "Ubuntu HW 12.04 x64 qr mozilla-central talos dromaeojs-e10s", 16:26:04 INFO - "stage_platform": "linux64-qr", 16:26:04 INFO - "basedir": "/builds/slave/test", 16:26:04 INFO - "buildnumber": 10, 16:26:04 INFO - "platform": "ubuntu64_hw_qr", 16:26:04 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 16:26:04 INFO - "slavebuilddir": "test", 16:26:04 INFO - "taskId": "PrCer0Z2QTqzfHtgLiJXSA", 16:26:04 INFO - "branch": "mozilla-central", 16:26:04 INFO - "script_repo_revision": "production", 16:26:04 INFO - "revision": "80fafbaaf8484104018976c2a0442c91805d3554", 16:26:04 INFO - "slavename": "talos-linux64-ix-056", 16:26:04 INFO - "repo_path": "mozilla-central" 16:26:04 INFO - } 16:26:04 INFO - Finding installer, test and symbols from parent task. 16:26:04 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/PrCer0Z2QTqzfHtgLiJXSA'}, attempt #1 16:26:05 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/PrCer0Z2QTqzfHtgLiJXSA'}, attempt #1 16:26:05 INFO - Task dependencies: KRW8BKGhS3m3qhpOl1dvTA 16:26:05 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA'}, attempt #1 16:26:06 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.tar.bz2 16:26:06 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.test_packages.json 16:26:06 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.crashreporter-symbols.zip 16:26:06 INFO - Running post-action listener: _resource_record_post_action 16:26:06 INFO - [mozharness: 2017-08-22 23:26:06.160733Z] Finished read-buildbot-config step (success) 16:26:06 INFO - [mozharness: 2017-08-22 23:26:06.160950Z] Running download-and-extract step. 16:26:06 INFO - Running pre-action listener: _resource_record_pre_action 16:26:06 INFO - Running main action method: download_and_extract 16:26:06 INFO - mkdir: /builds/slave/test/build/tests 16:26:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:06 INFO - trying https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.test_packages.json 16:26:06 INFO - Downloading https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 16:26:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 16:26:06 INFO - Downloaded 989 bytes. 16:26:06 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 16:26:06 INFO - Using the following test package requirements: 16:26:06 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 16:26:06 INFO - u'common': [u'target.common.tests.zip'], 16:26:06 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 16:26:06 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 16:26:06 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 16:26:06 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 16:26:06 INFO - u'mozbase': [u'target.common.tests.zip'], 16:26:06 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 16:26:06 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 16:26:06 INFO - u'web-platform': [u'target.common.tests.zip', 16:26:06 INFO - u'target.web-platform.tests.tar.gz'], 16:26:06 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 16:26:06 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 16:26:06 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.common.tests.zip 16:26:06 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.common.tests.zip'}, attempt #1 16:26:06 INFO - Fetch https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.common.tests.zip into memory 16:26:07 INFO - Content-Length response header: 54949663 16:26:07 INFO - Bytes received: 54949663 16:26:18 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 16:26:18 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.common.tests.zip 16:26:18 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.common.tests.zip'}, attempt #1 16:26:18 INFO - Fetch https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.common.tests.zip into memory 16:26:19 INFO - Content-Length response header: 54949663 16:26:19 INFO - Bytes received: 54949663 16:26:31 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.talos.tests.zip 16:26:31 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.talos.tests.zip'}, attempt #1 16:26:31 INFO - Fetch https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.talos.tests.zip into memory 16:26:32 INFO - Content-Length response header: 14496256 16:26:32 INFO - Bytes received: 14496256 16:26:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:32 INFO - trying https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.tar.bz2 16:26:32 INFO - Downloading https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 16:26:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 16:26:33 INFO - Downloaded 61341819 bytes. 16:26:33 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.tar.bz2 16:26:33 INFO - mkdir: /builds/slave/test/properties 16:26:33 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:26:33 INFO - Writing to file /builds/slave/test/properties/build_url 16:26:33 INFO - Contents: 16:26:33 INFO - build_url:https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.tar.bz2 16:26:33 INFO - Running post-action listener: _resource_record_post_action 16:26:33 INFO - Running post-action listener: find_tests_for_verification 16:26:33 INFO - Running post-action listener: set_extra_try_arguments 16:26:33 INFO - [mozharness: 2017-08-22 23:26:33.937145Z] Finished download-and-extract step (success) 16:26:33 INFO - [mozharness: 2017-08-22 23:26:33.937242Z] Running populate-webroot step. 16:26:33 INFO - Running pre-action listener: _resource_record_pre_action 16:26:33 INFO - Running main action method: populate_webroot 16:26:33 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 16:26:33 INFO - 'chromez-stylo-e10s': {'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:26:33 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 16:26:33 INFO - 'dromaeojs-stylo-e10s': {'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:26:33 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 16:26:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:26:33 INFO - 'g1-stylo-e10s': {'pagesets_name': 'tp5n.zip', 16:26:33 INFO - 'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:26:33 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 16:26:33 INFO - 'tests': ['damp', 'tps']}, 16:26:33 INFO - 'g2-stylo-e10s': {'pagesets_name': 'tp5n.zip', 16:26:33 INFO - 'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['damp', 'tps']}, 16:26:33 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:26:33 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 16:26:33 INFO - 'g4-stylo-e10s': {'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 16:26:33 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 16:26:33 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 16:26:33 INFO - 'g5-stylo-e10s': {'pagesets_name': 'tp5n.zip', 16:26:33 INFO - 'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 16:26:33 INFO - 'other-e10s': {'tests': ['a11yr', 16:26:33 INFO - 'ts_paint', 16:26:33 INFO - 'tpaint', 16:26:33 INFO - 'sessionrestore', 16:26:33 INFO - 'sessionrestore_many_windows', 16:26:33 INFO - 'sessionrestore_no_auto_restore', 16:26:33 INFO - 'tabpaint']}, 16:26:33 INFO - 'other-stylo-e10s': {'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['a11yr', 16:26:33 INFO - 'ts_paint', 16:26:33 INFO - 'tpaint', 16:26:33 INFO - 'sessionrestore', 16:26:33 INFO - 'sessionrestore_many_windows', 16:26:33 INFO - 'sessionrestore_no_auto_restore', 16:26:33 INFO - 'tabpaint']}, 16:26:33 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 16:26:33 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 16:26:33 INFO - 'perf-reftest-singletons-stylo-e10s': {'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['bloom_basic_singleton']}, 16:26:33 INFO - 'perf-reftest-stylo-e10s': {'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['bloom_basic']}, 16:26:33 INFO - 'svgr-e10s': {'tests': ['tsvgx', 16:26:33 INFO - 'tsvgr_opacity', 16:26:33 INFO - 'tart', 16:26:33 INFO - 'tscrollx', 16:26:33 INFO - 'tsvg_static']}, 16:26:33 INFO - 'svgr-stylo-e10s': {'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['tsvgx', 16:26:33 INFO - 'tsvgr_opacity', 16:26:33 INFO - 'tart', 16:26:33 INFO - 'tscrollx', 16:26:33 INFO - 'tsvg_static']}, 16:26:33 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 16:26:33 INFO - 'tp5o-stylo-e10s': {'pagesets_name': 'tp5n.zip', 16:26:33 INFO - 'talos_options': ['--stylo'], 16:26:33 INFO - 'tests': ['tp5o']}, 16:26:33 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 16:26:33 INFO - 'talos_options': ['--mitmproxy', 16:26:33 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 16:26:33 INFO - '--firstNonBlankPaint'], 16:26:33 INFO - 'tests': ['tp6_google', 16:26:33 INFO - 'tp6_youtube', 16:26:33 INFO - 'tp6_amazon', 16:26:33 INFO - 'tp6_facebook']}, 16:26:33 INFO - 'tp6-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 16:26:33 INFO - 'talos_options': ['--stylo', 16:26:33 INFO - '--mitmproxy', 16:26:33 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 16:26:33 INFO - '--firstNonBlankPaint'], 16:26:33 INFO - 'tests': ['tp6_google', 16:26:33 INFO - 'tp6_youtube', 16:26:33 INFO - 'tp6_amazon', 16:26:33 INFO - 'tp6_facebook']}, 16:26:33 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 16:26:33 INFO - 'talos_options': ['--stylo', 16:26:33 INFO - '--stylo-threads=1', 16:26:33 INFO - '--mitmproxy', 16:26:33 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 16:26:33 INFO - '--firstNonBlankPaint'], 16:26:33 INFO - 'tests': ['tp6_google', 16:26:33 INFO - 'tp6_youtube', 16:26:33 INFO - 'tp6_amazon', 16:26:33 INFO - 'tp6_facebook']}, 16:26:33 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 16:26:33 INFO - 'talos_options': ['--xperf_path', 16:26:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:26:33 INFO - 'tests': ['tp5n']}, 16:26:33 INFO - 'xperf-stylo-e10s': {'pagesets_name': 'tp5n.zip', 16:26:33 INFO - 'talos_options': ['--stylo', 16:26:33 INFO - '--xperf_path', 16:26:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:26:33 INFO - 'tests': ['tp5n']}}} 16:26:33 INFO - Running post-action listener: _resource_record_post_action 16:26:33 INFO - [mozharness: 2017-08-22 23:26:33.951460Z] Finished populate-webroot step (success) 16:26:33 INFO - [mozharness: 2017-08-22 23:26:33.951550Z] Running create-virtualenv step. 16:26:33 INFO - Running pre-action listener: _resource_record_pre_action 16:26:33 INFO - Running main action method: create_virtualenv 16:26:33 INFO - Creating virtualenv /builds/slave/test/build/venv 16:26:33 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 16:26:33 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:26:33 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 16:26:34 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:26:34 INFO - Using real prefix '/usr' 16:26:34 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:26:34 INFO - Installing distribute.............................................................................................................................................................................................done. 16:26:36 INFO - Installing pip.................done. 16:26:36 INFO - Return code: 0 16:26:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 16:26:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 16:26:36 INFO - Reading from file tmpfile_stdout 16:26:36 INFO - Output received: 16:26:36 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 16:26:36 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:26:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:26:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:26:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24801f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27eef90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:26:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 16:26:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 16:26:36 INFO - Using env: {'DISPLAY': ':0', 16:26:36 INFO - 'HOME': '/home/cltbld', 16:26:36 INFO - 'LANG': 'en_US.UTF-8', 16:26:36 INFO - 'LANGUAGE': 'en_US:en', 16:26:36 INFO - 'LOGNAME': 'cltbld', 16:26:36 INFO - 'MAIL': '/var/mail/cltbld', 16:26:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:26:36 INFO - 'MOZ_NO_REMOTE': '1', 16:26:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:26:36 INFO - 'NO_EM_RESTART': '1', 16:26:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:26:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:26:36 INFO - 'PWD': '/builds/slave/test', 16:26:36 INFO - 'SHELL': '/bin/bash', 16:26:36 INFO - 'SHLVL': '1', 16:26:36 INFO - 'TERM': 'linux', 16:26:36 INFO - 'TMOUT': '86400', 16:26:36 INFO - 'USER': 'cltbld', 16:26:36 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:26:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:26:36 INFO - '_': '/tools/buildbot/bin/python'} 16:26:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:26:36 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 16:26:36 INFO - Cleaning up... 16:26:36 INFO - Return code: 0 16:26:36 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 16:26:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:26:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:26:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24801f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27eef90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:26:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 16:26:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 16:26:37 INFO - Using env: {'DISPLAY': ':0', 16:26:37 INFO - 'HOME': '/home/cltbld', 16:26:37 INFO - 'LANG': 'en_US.UTF-8', 16:26:37 INFO - 'LANGUAGE': 'en_US:en', 16:26:37 INFO - 'LOGNAME': 'cltbld', 16:26:37 INFO - 'MAIL': '/var/mail/cltbld', 16:26:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:26:37 INFO - 'MOZ_NO_REMOTE': '1', 16:26:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:26:37 INFO - 'NO_EM_RESTART': '1', 16:26:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:26:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:26:37 INFO - 'PWD': '/builds/slave/test', 16:26:37 INFO - 'SHELL': '/bin/bash', 16:26:37 INFO - 'SHLVL': '1', 16:26:37 INFO - 'TERM': 'linux', 16:26:37 INFO - 'TMOUT': '86400', 16:26:37 INFO - 'USER': 'cltbld', 16:26:37 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:26:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:26:37 INFO - '_': '/tools/buildbot/bin/python'} 16:26:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:26:37 INFO - Downloading/unpacking psutil>=3.1.1 16:26:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:26:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:26:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:26:38 INFO - Installing collected packages: psutil 16:26:38 INFO - Running setup.py install for psutil 16:26:38 INFO - building 'psutil._psutil_linux' extension 16:26:38 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 16:26:38 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 16:26:38 INFO - building 'psutil._psutil_posix' extension 16:26:38 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 16:26:38 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 16:26:38 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:26:38 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:26:38 INFO - Successfully installed psutil 16:26:38 INFO - Cleaning up... 16:26:38 INFO - Return code: 0 16:26:38 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 16:26:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:26:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:26:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24801f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27eef90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:26:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 16:26:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 16:26:38 INFO - Using env: {'DISPLAY': ':0', 16:26:38 INFO - 'HOME': '/home/cltbld', 16:26:38 INFO - 'LANG': 'en_US.UTF-8', 16:26:38 INFO - 'LANGUAGE': 'en_US:en', 16:26:38 INFO - 'LOGNAME': 'cltbld', 16:26:38 INFO - 'MAIL': '/var/mail/cltbld', 16:26:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:26:38 INFO - 'MOZ_NO_REMOTE': '1', 16:26:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:26:38 INFO - 'NO_EM_RESTART': '1', 16:26:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:26:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:26:38 INFO - 'PWD': '/builds/slave/test', 16:26:38 INFO - 'SHELL': '/bin/bash', 16:26:38 INFO - 'SHLVL': '1', 16:26:38 INFO - 'TERM': 'linux', 16:26:38 INFO - 'TMOUT': '86400', 16:26:38 INFO - 'USER': 'cltbld', 16:26:38 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:26:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:26:38 INFO - '_': '/tools/buildbot/bin/python'} 16:26:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:26:39 INFO - Downloading/unpacking mozsystemmonitor==0.3 16:26:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:40 INFO - Downloading mozsystemmonitor-0.3.tar.gz 16:26:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:26:40 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 16:26:40 INFO - Installing collected packages: mozsystemmonitor 16:26:40 INFO - Running setup.py install for mozsystemmonitor 16:26:40 INFO - Successfully installed mozsystemmonitor 16:26:40 INFO - Cleaning up... 16:26:40 INFO - Return code: 0 16:26:40 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 16:26:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:26:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:26:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24801f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27eef90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:26:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 16:26:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 16:26:40 INFO - Using env: {'DISPLAY': ':0', 16:26:40 INFO - 'HOME': '/home/cltbld', 16:26:40 INFO - 'LANG': 'en_US.UTF-8', 16:26:40 INFO - 'LANGUAGE': 'en_US:en', 16:26:40 INFO - 'LOGNAME': 'cltbld', 16:26:40 INFO - 'MAIL': '/var/mail/cltbld', 16:26:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:26:40 INFO - 'MOZ_NO_REMOTE': '1', 16:26:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:26:40 INFO - 'NO_EM_RESTART': '1', 16:26:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:26:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:26:40 INFO - 'PWD': '/builds/slave/test', 16:26:40 INFO - 'SHELL': '/bin/bash', 16:26:40 INFO - 'SHLVL': '1', 16:26:40 INFO - 'TERM': 'linux', 16:26:40 INFO - 'TMOUT': '86400', 16:26:40 INFO - 'USER': 'cltbld', 16:26:40 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:26:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:26:40 INFO - '_': '/tools/buildbot/bin/python'} 16:26:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:26:40 INFO - Downloading/unpacking jsonschema==2.5.1 16:26:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:41 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:26:41 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 16:26:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:41 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:41 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:41 INFO - Downloading functools32-3.2.3-2.tar.gz 16:26:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:26:41 INFO - warning: no files found matching '*.txt' 16:26:41 INFO - no previously-included directories found matching 'build' 16:26:41 INFO - no previously-included directories found matching 'dist' 16:26:41 INFO - no previously-included directories found matching '.git*' 16:26:41 INFO - Installing collected packages: jsonschema, functools32 16:26:42 INFO - Running setup.py install for functools32 16:26:42 INFO - warning: no files found matching '*.txt' 16:26:42 INFO - no previously-included directories found matching 'build' 16:26:42 INFO - no previously-included directories found matching 'dist' 16:26:42 INFO - no previously-included directories found matching '.git*' 16:26:42 INFO - Successfully installed jsonschema functools32 16:26:42 INFO - Cleaning up... 16:26:42 INFO - Return code: 0 16:26:42 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 16:26:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:26:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:26:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24801f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27eef90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:26:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 16:26:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 16:26:42 INFO - Using env: {'DISPLAY': ':0', 16:26:42 INFO - 'HOME': '/home/cltbld', 16:26:42 INFO - 'LANG': 'en_US.UTF-8', 16:26:42 INFO - 'LANGUAGE': 'en_US:en', 16:26:42 INFO - 'LOGNAME': 'cltbld', 16:26:42 INFO - 'MAIL': '/var/mail/cltbld', 16:26:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:26:42 INFO - 'MOZ_NO_REMOTE': '1', 16:26:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:26:42 INFO - 'NO_EM_RESTART': '1', 16:26:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:26:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:26:42 INFO - 'PWD': '/builds/slave/test', 16:26:42 INFO - 'SHELL': '/bin/bash', 16:26:42 INFO - 'SHLVL': '1', 16:26:42 INFO - 'TERM': 'linux', 16:26:42 INFO - 'TMOUT': '86400', 16:26:42 INFO - 'USER': 'cltbld', 16:26:42 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:26:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:26:42 INFO - '_': '/tools/buildbot/bin/python'} 16:26:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:26:42 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 16:26:42 INFO - Cleaning up... 16:26:42 INFO - Return code: 0 16:26:42 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:26:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:26:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:26:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24801f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27eef90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:26:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 16:26:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 16:26:42 INFO - Using env: {'DISPLAY': ':0', 16:26:42 INFO - 'HOME': '/home/cltbld', 16:26:42 INFO - 'LANG': 'en_US.UTF-8', 16:26:42 INFO - 'LANGUAGE': 'en_US:en', 16:26:42 INFO - 'LOGNAME': 'cltbld', 16:26:42 INFO - 'MAIL': '/var/mail/cltbld', 16:26:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:26:42 INFO - 'MOZ_NO_REMOTE': '1', 16:26:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:26:42 INFO - 'NO_EM_RESTART': '1', 16:26:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:26:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:26:42 INFO - 'PWD': '/builds/slave/test', 16:26:42 INFO - 'SHELL': '/bin/bash', 16:26:42 INFO - 'SHLVL': '1', 16:26:42 INFO - 'TERM': 'linux', 16:26:42 INFO - 'TMOUT': '86400', 16:26:42 INFO - 'USER': 'cltbld', 16:26:42 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:26:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:26:42 INFO - '_': '/tools/buildbot/bin/python'} 16:26:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:26:42 INFO - Downloading/unpacking blobuploader==1.2.4 16:26:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:43 INFO - Downloading blobuploader-1.2.4.tar.gz 16:26:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:26:43 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:26:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:26:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:26:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:44 INFO - Downloading docopt-0.6.1.tar.gz 16:26:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:26:44 INFO - Installing collected packages: blobuploader, requests, docopt 16:26:44 INFO - Running setup.py install for blobuploader 16:26:44 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:26:44 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:26:44 INFO - Running setup.py install for requests 16:26:44 INFO - Running setup.py install for docopt 16:26:44 INFO - Successfully installed blobuploader requests docopt 16:26:44 INFO - Cleaning up... 16:26:44 INFO - Return code: 0 16:26:44 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:26:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:26:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:26:44 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24801f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27eef90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:26:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 16:26:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:26:44 INFO - Using env: {'DISPLAY': ':0', 16:26:44 INFO - 'HOME': '/home/cltbld', 16:26:44 INFO - 'LANG': 'en_US.UTF-8', 16:26:44 INFO - 'LANGUAGE': 'en_US:en', 16:26:44 INFO - 'LOGNAME': 'cltbld', 16:26:44 INFO - 'MAIL': '/var/mail/cltbld', 16:26:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:26:44 INFO - 'MOZ_NO_REMOTE': '1', 16:26:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:26:44 INFO - 'NO_EM_RESTART': '1', 16:26:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:26:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:26:44 INFO - 'PWD': '/builds/slave/test', 16:26:44 INFO - 'SHELL': '/bin/bash', 16:26:44 INFO - 'SHLVL': '1', 16:26:44 INFO - 'TERM': 'linux', 16:26:44 INFO - 'TMOUT': '86400', 16:26:44 INFO - 'USER': 'cltbld', 16:26:44 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:26:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:26:44 INFO - '_': '/tools/buildbot/bin/python'} 16:26:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:26:45 INFO - Running setup.py (path:/tmp/pip-kYVWcY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:26:45 INFO - Running setup.py (path:/tmp/pip-T8T7KL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:26:45 INFO - Running setup.py (path:/tmp/pip-NPBgwZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:26:45 INFO - Running setup.py (path:/tmp/pip-B8F9cN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:26:45 INFO - Running setup.py (path:/tmp/pip-iJj154-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:26:45 INFO - Running setup.py (path:/tmp/pip-Cki8P7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:26:45 INFO - Running setup.py (path:/tmp/pip-2sx0VH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:26:45 INFO - Running setup.py (path:/tmp/pip-Qdm9vN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:26:45 INFO - Running setup.py (path:/tmp/pip-i9vxTR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:26:45 INFO - Running setup.py (path:/tmp/pip-sQkeUT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:26:45 INFO - Running setup.py (path:/tmp/pip-aPCQ6g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:26:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:26:45 INFO - Running setup.py (path:/tmp/pip-fHK0DC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:26:46 INFO - Running setup.py (path:/tmp/pip-7rdaYQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:26:46 INFO - Running setup.py (path:/tmp/pip-bfxPFI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:26:46 INFO - Running setup.py (path:/tmp/pip-G2ZTVL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:26:46 INFO - Running setup.py (path:/tmp/pip-aqqmLm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:26:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:26:46 INFO - Running setup.py (path:/tmp/pip-T80yyq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:26:46 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:26:46 INFO - Running setup.py install for manifestparser 16:26:46 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:26:46 INFO - Running setup.py install for mozcrash 16:26:46 INFO - Running setup.py install for mozdebug 16:26:46 INFO - Running setup.py install for mozdevice 16:26:46 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:26:46 INFO - Running setup.py install for mozfile 16:26:46 INFO - Running setup.py install for mozhttpd 16:26:47 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Running setup.py install for mozinfo 16:26:47 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Running setup.py install for mozInstall 16:26:47 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Running setup.py install for mozleak 16:26:47 INFO - Running setup.py install for mozlog 16:26:47 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Running setup.py install for moznetwork 16:26:47 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Running setup.py install for mozprocess 16:26:47 INFO - Running setup.py install for mozprofile 16:26:47 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Running setup.py install for mozrunner 16:26:47 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:26:47 INFO - Running setup.py install for mozscreenshot 16:26:47 INFO - Running setup.py install for moztest 16:26:48 INFO - Running setup.py install for mozversion 16:26:48 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:26:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:26:48 INFO - Cleaning up... 16:26:48 INFO - Return code: 0 16:26:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:26:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:26:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:26:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24801f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27eef90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:26:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 16:26:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:26:48 INFO - Using env: {'DISPLAY': ':0', 16:26:48 INFO - 'HOME': '/home/cltbld', 16:26:48 INFO - 'LANG': 'en_US.UTF-8', 16:26:48 INFO - 'LANGUAGE': 'en_US:en', 16:26:48 INFO - 'LOGNAME': 'cltbld', 16:26:48 INFO - 'MAIL': '/var/mail/cltbld', 16:26:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:26:48 INFO - 'MOZ_NO_REMOTE': '1', 16:26:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:26:48 INFO - 'NO_EM_RESTART': '1', 16:26:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:26:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:26:48 INFO - 'PWD': '/builds/slave/test', 16:26:48 INFO - 'SHELL': '/bin/bash', 16:26:48 INFO - 'SHLVL': '1', 16:26:48 INFO - 'TERM': 'linux', 16:26:48 INFO - 'TMOUT': '86400', 16:26:48 INFO - 'USER': 'cltbld', 16:26:48 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:26:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:26:48 INFO - '_': '/tools/buildbot/bin/python'} 16:26:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:26:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:26:48 INFO - Running setup.py (path:/tmp/pip-TVqg0Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:26:48 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 16:26:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:26:48 INFO - Running setup.py (path:/tmp/pip-lzvmp0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:26:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:26:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:26:48 INFO - Running setup.py (path:/tmp/pip-Zm0H6q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:26:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 16:26:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:26:48 INFO - Running setup.py (path:/tmp/pip-uuoysN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:26:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:26:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:26:48 INFO - Running setup.py (path:/tmp/pip-SEzyhh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:26:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 16:26:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:26:48 INFO - Running setup.py (path:/tmp/pip-1Du2GX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:26:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 16:26:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:26:48 INFO - Running setup.py (path:/tmp/pip-PQYKZ2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:26:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 16:26:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:26:48 INFO - Running setup.py (path:/tmp/pip-m6tO6N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 16:26:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:26:49 INFO - Running setup.py (path:/tmp/pip-KBtuiq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 16:26:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:26:49 INFO - Running setup.py (path:/tmp/pip-uw1Yce-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:26:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:26:49 INFO - Running setup.py (path:/tmp/pip-HiL4YT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 16:26:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:26:49 INFO - Running setup.py (path:/tmp/pip-evctS6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 16:26:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:26:49 INFO - Running setup.py (path:/tmp/pip-LUPtWT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 16:26:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:26:49 INFO - Running setup.py (path:/tmp/pip-n2LVUl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 16:26:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:26:49 INFO - Running setup.py (path:/tmp/pip-yUIMGq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 16:26:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:26:49 INFO - Running setup.py (path:/tmp/pip-T33Zp3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 16:26:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:26:49 INFO - Running setup.py (path:/tmp/pip-XwFzHn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:26:49 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 16:26:49 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:26:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:50 INFO - Downloading blessings-1.6.tar.gz 16:26:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:26:50 INFO - Installing collected packages: blessings 16:26:50 INFO - Running setup.py install for blessings 16:26:51 INFO - Successfully installed blessings 16:26:51 INFO - Cleaning up... 16:26:51 INFO - Return code: 0 16:26:51 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:26:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:26:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:26:51 INFO - Reading from file tmpfile_stdout 16:26:51 INFO - Current package versions: 16:26:51 INFO - argparse == 1.2.1 16:26:51 INFO - blessings == 1.6 16:26:51 INFO - blobuploader == 1.2.4 16:26:51 INFO - docopt == 0.6.1 16:26:51 INFO - functools32 == 3.2.3-2 16:26:51 INFO - jsonschema == 2.5.1 16:26:51 INFO - manifestparser == 1.1 16:26:51 INFO - mozInstall == 1.13 16:26:51 INFO - mozcrash == 1.0 16:26:51 INFO - mozdebug == 0.1 16:26:51 INFO - mozdevice == 0.51 16:26:51 INFO - mozfile == 1.2 16:26:51 INFO - mozhttpd == 0.7 16:26:51 INFO - mozinfo == 0.10 16:26:51 INFO - mozleak == 0.1 16:26:51 INFO - mozlog == 3.5 16:26:51 INFO - moznetwork == 0.27 16:26:51 INFO - mozprocess == 0.25 16:26:51 INFO - mozprofile == 0.28 16:26:51 INFO - mozrunner == 6.13 16:26:51 INFO - mozscreenshot == 0.1 16:26:51 INFO - mozsystemmonitor == 0.3 16:26:51 INFO - moztest == 0.8 16:26:51 INFO - mozversion == 1.4 16:26:51 INFO - psutil == 3.1.1 16:26:51 INFO - requests == 1.2.3 16:26:51 INFO - wsgiref == 0.1.2 16:26:51 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:26:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:26:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:26:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24801f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27eef90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:26:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 16:26:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 16:26:51 INFO - Using env: {'DISPLAY': ':0', 16:26:51 INFO - 'HOME': '/home/cltbld', 16:26:51 INFO - 'LANG': 'en_US.UTF-8', 16:26:51 INFO - 'LANGUAGE': 'en_US:en', 16:26:51 INFO - 'LOGNAME': 'cltbld', 16:26:51 INFO - 'MAIL': '/var/mail/cltbld', 16:26:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:26:51 INFO - 'MOZ_NO_REMOTE': '1', 16:26:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:26:51 INFO - 'NO_EM_RESTART': '1', 16:26:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:26:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:26:51 INFO - 'PWD': '/builds/slave/test', 16:26:51 INFO - 'SHELL': '/bin/bash', 16:26:51 INFO - 'SHLVL': '1', 16:26:51 INFO - 'TERM': 'linux', 16:26:51 INFO - 'TMOUT': '86400', 16:26:51 INFO - 'USER': 'cltbld', 16:26:51 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:26:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:26:51 INFO - '_': '/tools/buildbot/bin/python'} 16:26:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:26:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:26:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 16:26:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 16:26:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 16:26:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 16:26:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 16:26:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 16:26:51 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 16:26:51 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 16:26:51 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 16:26:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:26:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:26:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 16:26:52 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:26:52 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 16:26:52 INFO - Installing collected packages: simplejson 16:26:52 INFO - Running setup.py install for simplejson 16:26:52 INFO - building 'simplejson._speedups' extension 16:26:52 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 16:26:53 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 16:26:53 INFO - Successfully installed simplejson 16:26:53 INFO - Cleaning up... 16:26:53 INFO - Return code: 0 16:26:53 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:26:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:26:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:26:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:26:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24801f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x264ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x27eef90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:26:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 16:26:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 16:26:53 INFO - Using env: {'DISPLAY': ':0', 16:26:53 INFO - 'HOME': '/home/cltbld', 16:26:53 INFO - 'LANG': 'en_US.UTF-8', 16:26:53 INFO - 'LANGUAGE': 'en_US:en', 16:26:53 INFO - 'LOGNAME': 'cltbld', 16:26:53 INFO - 'MAIL': '/var/mail/cltbld', 16:26:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:26:53 INFO - 'MOZ_NO_REMOTE': '1', 16:26:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:26:53 INFO - 'NO_EM_RESTART': '1', 16:26:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:26:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:26:53 INFO - 'PWD': '/builds/slave/test', 16:26:53 INFO - 'SHELL': '/bin/bash', 16:26:53 INFO - 'SHLVL': '1', 16:26:53 INFO - 'TERM': 'linux', 16:26:53 INFO - 'TMOUT': '86400', 16:26:53 INFO - 'USER': 'cltbld', 16:26:53 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:26:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:26:53 INFO - '_': '/tools/buildbot/bin/python'} 16:26:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:26:53 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 16:26:53 INFO - Cleaning up... 16:26:53 INFO - Return code: 0 16:26:53 INFO - Running post-action listener: _resource_record_post_action 16:26:53 INFO - Running post-action listener: _start_resource_monitoring 16:26:54 INFO - Starting resource monitoring. 16:26:54 INFO - [mozharness: 2017-08-22 23:26:54.015456Z] Finished create-virtualenv step (success) 16:26:54 INFO - [mozharness: 2017-08-22 23:26:54.016058Z] Running install step. 16:26:54 INFO - Running pre-action listener: _resource_record_pre_action 16:26:54 INFO - Running main action method: install 16:26:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:26:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:26:54 INFO - Reading from file tmpfile_stdout 16:26:54 INFO - Detecting whether we're running mozinstall >=1.0... 16:26:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:26:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:26:54 INFO - Reading from file tmpfile_stdout 16:26:54 INFO - Output received: 16:26:54 INFO - Usage: mozinstall [options] installer 16:26:54 INFO - Options: 16:26:54 INFO - -h, --help show this help message and exit 16:26:54 INFO - -d DEST, --destination=DEST 16:26:54 INFO - Directory to install application into. [default: 16:26:54 INFO - "/builds/slave/test"] 16:26:54 INFO - --app=APP Application being installed. [default: firefox] 16:26:54 INFO - mkdir: /builds/slave/test/build/application 16:26:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 16:26:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 16:27:12 INFO - Reading from file tmpfile_stdout 16:27:12 INFO - Output received: 16:27:12 INFO - /builds/slave/test/build/application/firefox/firefox 16:27:12 INFO - Running post-action listener: _resource_record_post_action 16:27:12 INFO - [mozharness: 2017-08-22 23:27:12.092430Z] Finished install step (success) 16:27:12 INFO - [mozharness: 2017-08-22 23:27:12.092709Z] Running setup-mitmproxy step. 16:27:12 INFO - Running pre-action listener: _resource_record_pre_action 16:27:12 INFO - Running main action method: setup_mitmproxy 16:27:12 INFO - Skipping: mitmproxy is not required 16:27:12 INFO - Running post-action listener: _resource_record_post_action 16:27:12 INFO - [mozharness: 2017-08-22 23:27:12.093893Z] Finished setup-mitmproxy step (success) 16:27:12 INFO - [mozharness: 2017-08-22 23:27:12.094112Z] Running run-tests step. 16:27:12 INFO - Running pre-action listener: _resource_record_pre_action 16:27:12 INFO - Running pre-action listener: _set_gcov_prefix 16:27:12 INFO - Running main action method: run_tests 16:27:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:27:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:27:12 INFO - Python 2.7.3 16:27:12 INFO - Return code: 0 16:27:12 INFO - grabbing minidump binary from tooltool 16:27:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:27:12 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ec130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27ed030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x27ed4c0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:27:12 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 16:27:12 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 16:27:12 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 16:27:12 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:27:12 INFO - Return code: 0 16:27:12 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:27:12 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:27:12 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:27:12 INFO - ENV: RUST_BACKTRACE is now full 16:27:12 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:27:12 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:27:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-056', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 16:27:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-056 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 16:27:12 INFO - Using env: {'DISPLAY': ':0', 16:27:12 INFO - 'HOME': '/home/cltbld', 16:27:12 INFO - 'LANG': 'en_US.UTF-8', 16:27:12 INFO - 'LANGUAGE': 'en_US:en', 16:27:12 INFO - 'LOGNAME': 'cltbld', 16:27:12 INFO - 'MAIL': '/var/mail/cltbld', 16:27:12 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:27:12 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:27:12 INFO - 'MOZ_ACCELERATED': '1', 16:27:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:12 INFO - 'MOZ_NO_REMOTE': '1', 16:27:12 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:27:12 INFO - 'MOZ_WEBRENDER': '1', 16:27:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:12 INFO - 'NO_EM_RESTART': '1', 16:27:12 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:12 INFO - 'PWD': '/builds/slave/test', 16:27:12 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:27:12 INFO - 'RUST_BACKTRACE': 'full', 16:27:12 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 16:27:12 INFO - 'SHELL': '/bin/bash', 16:27:12 INFO - 'SHLVL': '1', 16:27:12 INFO - 'TERM': 'linux', 16:27:12 INFO - 'TMOUT': '86400', 16:27:12 INFO - 'USER': 'cltbld', 16:27:12 INFO - 'XDG_SESSION_COOKIE': '52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090', 16:27:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:12 INFO - '_': '/tools/buildbot/bin/python'} 16:27:12 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-056', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 16:27:12 INFO - mozversion application_buildid: 20170822224030 16:27:12 INFO - mozversion application_changeset: 80fafbaaf8484104018976c2a0442c91805d3554 16:27:12 INFO - mozversion application_display_name: Nightly 16:27:12 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:27:12 INFO - mozversion application_name: Firefox 16:27:12 INFO - mozversion application_remotingname: firefox 16:27:12 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 16:27:12 INFO - mozversion application_vendor: Mozilla 16:27:12 INFO - mozversion application_version: 57.0a1 16:27:12 INFO - mozversion platform_buildid: 20170822224030 16:27:12 INFO - mozversion platform_changeset: 80fafbaaf8484104018976c2a0442c91805d3554 16:27:12 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 16:27:12 INFO - mozversion platform_version: 57.0a1 16:27:12 INFO - using testdate: 1503444432 16:27:12 INFO - actual date: 1503444432 16:27:12 INFO - starting webserver on 'localhost:52764' 16:27:12 INFO - SUITE-START | Running 2 tests 16:27:12 INFO - TEST-START | dromaeo_css 16:27:12 INFO - Initialising browser for dromaeo_css test... 16:27:12 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:52764/getInfo.html -profile /tmp/tmpwUj594/profile 16:27:12 INFO - TEST-INFO | started process 28996 (/builds/slave/test/build/application/firefox/firefox http://localhost:52764/getInfo.html) 16:27:19 INFO - TEST-INFO | 28996: exit 0 16:27:19 INFO - Browser initialized. 16:27:19 INFO - Running cycle 1/1 for dromaeo_css test... 16:27:19 INFO - TEST-INFO | started process 29183 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpwUj594/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 16:27:20 INFO - PID 29183 | WebRender - OpenGL version new 3.2.0 NVIDIA 361.42 16:27:20 INFO - PID 29183 | WebRender - OpenGL version new 3.2.0 NVIDIA 361.42 16:27:21 INFO - PID 29183 | 16:27:21 INFO - PID 29183 | (/builds/slave/test/build/application/firefox/firefox:29243): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 16:27:21 INFO - PID 29183 | 16:27:21 INFO - PID 29183 | 16:27:21 INFO - PID 29183 | (/builds/slave/test/build/application/firefox/firefox:29297): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 16:27:21 INFO - PID 29183 | 16:27:21 INFO - PID 29183 | __metrics Screen width/height:1600/1200 16:27:21 INFO - PID 29183 | colorDepth:24 16:27:21 INFO - PID 29183 | Browser inner width/height: 1024/768 16:27:21 INFO - PID 29183 | __metrics 16:27:31 INFO - PID 29183 | RSS: Main: 199073792 16:27:31 INFO - PID 29183 | 16:27:34 INFO - PID 29183 | WebRender - OpenGL version new 3.2.0 NVIDIA 361.42 16:30:31 INFO - PID 29183 | Cycle 1(1): loaded http://localhost:52764/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52764/tests/dromaeo/cssquery-ext.html) 16:30:32 INFO - PID 29183 | RSS: Main: 209682432 16:30:32 INFO - PID 29183 | 16:33:34 INFO - PID 29183 | Cycle 1(1): loaded http://localhost:52764/tests/dromaeo/cssquery-ext.html (next: http://localhost:52764/tests/dromaeo/cssquery-jquery.html) 16:33:35 INFO - PID 29183 | RSS: Main: 207429632 16:33:35 INFO - PID 29183 | 16:36:37 INFO - PID 29183 | Cycle 1(1): loaded http://localhost:52764/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52764/tests/dromaeo/cssquery-mootools.html) 16:36:38 INFO - PID 29183 | RSS: Main: 209920000 16:36:38 INFO - PID 29183 | 16:39:40 INFO - PID 29183 | Cycle 1(1): loaded http://localhost:52764/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52764/tests/dromaeo/cssquery-prototype.html) 16:39:41 INFO - PID 29183 | RSS: Main: 207646720 16:39:41 INFO - PID 29183 | 16:42:44 INFO - PID 29183 | Cycle 1(1): loaded http://localhost:52764/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52764/tests/dromaeo/cssquery-yui.html) 16:42:45 INFO - PID 29183 | RSS: Main: 211361792 16:42:45 INFO - PID 29183 | 16:45:47 INFO - PID 29183 | Cycle 1(1): loaded http://localhost:52764/tests/dromaeo/cssquery-yui.html (next: http://localhost:52764/tests/dromaeo/cssquery-dojo.html) 16:45:47 INFO - PID 29183 | RSS: Main: 211103744 16:45:47 INFO - PID 29183 | 16:45:47 INFO - PID 29183 | __start_tp_report 16:45:47 INFO - PID 29183 | _x_x_mozilla_page_load 16:45:47 INFO - PID 29183 | _x_x_mozilla_page_load_details 16:45:47 INFO - PID 29183 | |i|pagename|runs| 16:45:47 INFO - PID 29183 | |0;dojo.html;3162.0513845846226;3219.227385427498;3247.2531317796897;3253.349330133973;3277.4592192288274;6066.454019138277;6208.968955155218;6241.407066328703;6244.843878903024;6262.9060564091515;5983.49140323072;6073.969630151854;6107.4197951194565;6107.511399088074;6131.509479241661;5586.13414920688;5610.747516361774;5611.943880561183;5628.127640215773;5640.294963129609;5547.528460080898;5564.610477266593;5601.915971260414;5658.292713410824;5665.291838520185;5563.193336966137;5601.859953501154;5684.857878553028;5690.06113991191;5690.146478028288;5578.191162281487;5647.124695672177;5661.207430959669;5666.54667626591;5701.6864072476;5640.689762063085;5651.632643878134;5675.51758100562;5683.744231509592;5753.971230143864;5862.97068514659;5900.911486327708;5926.614770039977;6007.969960150172;6134.04922237054;6486.935130648728;6492.772752953671;6503.317151699051;6503.577267477599;6557.639329836857;6541.869162616768;6598.868022639568;6643.5017373697165;6671.499637527205;6765.086713293741;6132.754689812402;6170.074488826712;6180.536459765535;6252.624842509418;6301.495880329563;6739.59562426256;6796.76211332601;6800.727970881208;6928.61892595902;6929.099217101744;6284.717187726564;6315.526335524854;6353.904691429632;6360.109584658151;6365.427111559982;6445.9355406446275;6446.129772480749;6470.22357317125;6480.740770369132;6485.67571621417;6426.132472116298;6433.517486188554;6435.774747883802;6465.450436712838;6536.182977127859;6530.869382612321;6585.506087043491;6667.766628168088;6672.366125218096;6756.189257289157;5123.359580052494;5184.455632158569;5292.047431462373;5343.305370301913;5352.2506849041165;4495.887602809956;4587.885302867388;4596.241620132708;4602.217623004098;4618.49196588375;5778.451047150514;5785.0454674979;5799.072148456226;5806.738696758656;5831.941680583224;6617.966910165418;6636.30318816527;6683.966580167165;6725.529212955144;6739.764108256286;5609.242752228397;5737.139429085671;5828.737706803204;5839.065749480063;5842;5599.384067752625;5623.943760562423;5630.183623374588;5643.661380317194;5643.746031428595;6327.557071005078;6365.904511432333;6378.138951241615;6384.6169229846355;6400.135981642418;6520.087187793618;6527.15147030883;6599.439047681001;6610.471162306908;6615.106960560262;5499.450054994469;6226.937730622636;6359.682015899279;6363.5545511813725;6373.776917807854;6518.706658200297;6563;6565.310642382672;6578.407943285128;6653.401193892573;6583.769568065095;6627.105340778933;6708;6708.094407254958;6708.496862735412;6301.96849015752;6313.147725057059;6396.328385519453;6407.295197528361;6411.8717625646295;6329.272133704683;6330.9050364245495;6347.39699728525;6354.205724284465;6442;6330.52521060913;6425.261094974137;6441.033844923299;6446.161998940108;6450.387213214737;6479.028145778171;6491.935080649133;6591.736330546724;6595;6609.504287178384;6138.723757430837;6226.12834203221;6231.875362492634;6259.624422534663;6381.649009304533 16:45:47 INFO - PID 29183 | |1;ext.html;812.9471584347017;837.137748119437;864.3690106222457;866.6490071521032;1111;29924.85037574812;30614.234644133907;39492;40427;40431.59568404315;40474.39288410669;41097.7945110274;41112.17775644486;41309.58690413102;41365.58634413655;7543.283388078124;7554.320111189992;7572.432067594925;7604.657790399446;7728.227177282255;7432.368248698867;7493.512921660102;7510.399168066569;7530.887036694454;7604.885926711104;7061.435085193172;7614.809629759273;7668.884966725504;7673.923260767377;7700.768976930673;7446.255374462565;7523.623818809092;7539.623018849091;7543.622818859035;7548.622568871562;7442.962785186093;7519.736809211651;7545.924540754577;7563.886541701879;7566.697332106764;35864.462033069525;36521.817390913144;36732.44901326482;36820.44769328462;36847;3201.5677883485664;3238.9676103238903;3246.772725909187;3247.4479338512274;3250.6261779895376;30275.69724302751;30335.69664303351;30353.241168970733;30358.54462183069;30567.69432305693;5097.872553186163;5112.590992720573;5141.6143789215585;5141.820036298749;5179.430262671103;213255;214227;215145;215326;216549;46238.537614624096;46411;46730;46785;47030.76484617555;47396.5260347399;48221.27668084981;48285.5171448288;48288.517114829105;48406.75796621065;15354.692906141814;15740.60648483797;15796;15859.841401586067;15863.841361586236;12818.038647101504;12975.870241297465;12980.091393602546;12983.610491685264;13013.739725205633;13683.452661893612;13705.794413083811;13747.862521374858;13825.861741382658;13986.811121054825;4871.541844977496;5331.786728530816;5477.561795056466;5585.134304182858;5739.65562066269;1005.527402121002;1008.4302369161401;1019.6176433837311;1024.9897501025043;1025.9894004405655;22484.100635974704;22533.32400028002;22633;23243.53512929732;27850.860745696144;1092.5083712329324;1093.2456604942565;1093.8085834979006;1096.2271598523023;1127.3912087472672;11956.461959211856;12100.152989290666;12106.092043096804;12155.696107597381;12181.634550963485;224705;227031;228082;228813;229963;50819;51374.486255137715;51624.48375516197;51703.48296516987;51964.48035519672;1431.105559025609;1481.429649584896;1494.387301206522;1498.3482185249234;1502.7219964306419;22656;22675.433114172276;22947.6557851629;22963.081476740743;23008.19471318496;37218.44172337363;37688.2462350746;37876.431853521666;37899.431508527945;38030.23939521249;142000;142085;142958;143106.28446857698;143203.28398357943;33900;34127.82936085304;34236.82881585576;34286.65713342935;34580;38267;38793.80603096967;41504.169916602106;43085.13829723451;44550.55449445464;29163.7083629161;32300.515492268103;32508.349833003682;33298.5005224917;33317.666823331456;32084.839575801972;32298;32409.675903240666;32652.83673581617;32763.672363276062;36504.45243321406;36547.81726091352;36972.26055478821;37100;37294.25411491809;31877.521837171997;31990.36019279555;32301.838490808335;32880.50679239765;32942.34115317728;24261.393465163514;24553.877230613733;24770.25689229326;24774.628380573944;24943.87528062348 16:45:47 INFO - PID 29183 | |2;jquery.html;548.8079172289699;551.5973339462192;556.4018679919088;559.3483591615768;574.8189320364086;22213.44466388339;23085.076596936124;23121.653175202366;23141.537169256604;23194.188203412883;23435;25136.622950655754;25268.115615953444;25333.61999570003;25341.239762807098;6666.600003999752;6744.561603495782;6804.727810887559;6816.829579260509;6835.829104272383;5827.504662103705;6068.726907289182;6587;6642.734290628369;6655.633940133291;6299.748010079591;6307.590006649576;6308.810735677914;6313.368663133673;6358.904616430757;6301;6314.494840412779;6322.557420980534;6323.715432805535;6329.335419780926;5850.707464626794;5853.9414605854245;5867.325257595388;5878.235829342201;5896.823095307148;24600.876995615086;28291.575626365622;28803;28924.27689307763;29190.832366705305;2017.2536161620149;2046.2735728816206;2047.0890453748088;2047.4369548374168;2056.969145462804;19388.612227755508;19606.607867842707;19799.40601781949;19814.70277945832;19839.206431742714;2356.22244659262;2369.336585755991;2421.2494126820743;2422.842515236504;2446.8287219894614;131908;135497;137620;137896;138144.99999999898;14128.434862605587;14253.857461425461;14314.928425358015;14474.493392731203;14644.560663180122;22607.660885086738;22636.320910372386;22689.546209075725;22724.65913011306;22771.747553884365;9898;9953.701388958343;10049.949750251348;10173.389596624227;10280.897191028143;9305.953470232605;9350.111739384747;9379.671711490202;9397.389169703947;9515.762105947406;8489.660413583511;8622.482651040958;8899.866502002475;9057.411268267673;9110.453372797521;2681.8927242910063;2683.9731602684114;2717.782577393804;2751.1608959267614;2793.8603069846426;942.7501712046313;971.455984648599;972.3193764364972;976.104329847726;990.4849478271402;19573;22861.542769144526;23395.298141055795;24015.879920600284;24388;1003.1673710820002;1052.921030922684;1059.8940105989493;1074.08702602787;1078.2991055813627;10785.514651840685;11275.492602832892;11319.490622921989;11365.147613928988;11564.826527602092;500412;508585;512346;515771;516624.41687791323;125987;128522;129675;131533;133064;1202.4769225386985;1209.8124790657462;1268.7145392286845;1269.2701696524534;1278.9744205115846;20441.591168176852;20712.896435517727;21286.148554057665;21389.893050534647;21532.354029379145;58931;61626.38373616206;64051.35948640641;64929.67535162294;65694.34305657074;77351;79086;79735;83360.49918502454;84430;20171.596568068264;20269.898650506653;20751.377458676263;20760.06579703947;20806.583868322246;22854.657180141978;23282.76717232874;23283.417914552272;23485.76514234836;23500.529989400457;17704.645907082046;18207.18067686931;18365.724514132566;18518.074096294862;18623.53441163982;16114.597135071717;16513.83486165171;16772.412965546147;16981.320747169975;17275.65448690994;18519.53701157482;18763.718544221574;18892.433227003214;19148.712769308193;19153.138108785417;19572.21711131539;19728.210871564977;19804.20783168657;19845.900770496057;19969.60060798805;17654.558636034202;18074.734768566075;18110.73224874246;18132.274709011494;18250.17874195691 16:45:47 INFO - PID 29183 | |3;mootools.html;1244.912856100073;1298.2924306253096;1320.3596255815921;1323.7887333090223;1332.0675527131004;12374.319412432313;14164.150150990934;14770.556883293504;14798.852011479881;14800.925995370035;12264.264144151357;12527.436265368058;14306;14652;14786.334614942327;2629.6449979252843;2677.129932771847;2686.2478506018347;2690.233283514199;2692.824966377189;2576.6135079738;2681.1554360376417;2691.3944362518473;2692.488427198826;2696.986515067422;2591.287395966115;2696.3798326384945;2708.620793088969;2726.9045583404586;2753;2703.6890757562937;2716.076533978447;2740.328619488218;2743.7667798237176;2748.8625568721486;2617.084020592796;2639.9076032338967;2690.4753573053263;2697.986510067437;2716.1036857836866;14057.08628939126;14445.494407695785;14545.200013999225;14547.636309092251;14593.343299551545;7496.587687677175;7883.8029049273655;7885.487443316166;7896.960515197387;7899.131095579482;5307.973460132714;5497.752601132958;5501.202325662756;5558.666480011212;5573.052581061229;1767.7436771668035;1807.9276828926827;1825.233401971162;1861.2182883188957;1871.3450292397688;24419.755802441927;24524.754752452427;24570.385740356633;24637.753622463726;24693.87653061741;6512.6092434454085;6512.902306465407;6513;6738.528303018742;6765.1205343305055;16370.708100865888;16541.58646033859;16571.751423728652;16578.336866525206;16600.08699521538;7516.24837516244;7641.808954776175;7732.30409263169;7915.050193976645;7983.760487185394;7059.329363710542;7157.320054594805;7167.749128780468;7186.604736739425;7292.927070729331;5331.626786124934;5449.100898351728;5451.155070964007;5465.371482279509;5701.942980570141;1548.9380424782883;1684.9241784119745;1691.881568290208;1737.3137610643726;1746.5808206030715;692.62944324786;833.4499230507836;844.7043534762906;850;860.8665656823202;7371.8157046074275;7390.74132405374;7398.075240594926;8657.264132548678;8967.058458861726;960.6877764726491;978.8629591857145;986.5807032011367;986.8125056239292;987.4667679453158;5070.397211081775;5143.5113664201845;5236.136037553761;5255.658382205144;5334.839954801362;19862.801371986094;20648.58702825965;20654.17383304681;20681.89659051725;20704.275350362666;19489;20108.497287567636;20384.694229586567;20387.082581283878;20499;10725.141988641046;10787.946060269649;10932.180086493545;10935.343879367263;11095.55617775296;7523.699052038076;7604.733834315773;7735.149133595188;7753.844923101394;7784.260495252942;17185.226664800364;17482;17753;17830.286788528832;18193;17966.461006169837;18033.729494057337;18193.818061819213;18321.81678183201;18356.449306520826;9617.422954622745;9875.259355548505;9906;9907;9935.105840474393;13409.66475838112;13429.395677194745;13596.79604805909;13619.114757540729;13700.588982330546;10611.734706632396;10671.839922401325;10832.458377080957;10946.124310055016;11027.117830573696;10916.836247456136;11020.669379918616;11088.833667495155;11119.555217791198;11286.20996530235;9575.90424095778;9706.805863882824;9719.9028009719;9752.609895604097;9752.707418777449;7352.889706654298;7388.335049845539;7394.815129621803;7399.223081576357;7402.4078073755045;7234.89147662796;7362.263773622595;7394.630268486447;7403.481756277009;7478.962605186939 16:45:47 INFO - PID 29183 | |4;prototype.html;499.13649386561247;506.50362644608305;509.47524050228265;529.5102030621674;530.1252932661108;6115.226584290562;6130.233720784902;6177.691115444227;6194.690265486719;6247.531435142366;6078.240219972504;6133.693315334238;6133.846653833656;6144.53915956304;6176.660283684407;5029.673071250375;5073.822416215433;5083.491650834924;5087.720175390352;5136.8715782105555;5067.467915868818;5070.822521211759;5112.565431938289;5126.820561280356;5136.332276804011;4710.788014539354;4758.620689655172;4766.976165119187;4774.785134668949;5011.398632164127;4767.16464161297;4807.351007613962;4832.251001094818;4833.589144922686;4839.161118774879;4233.5554766749665;4288.742675439484;4299.161663475624;4335.653147748204;4338.956610433918;5878.941210587882;5886.705664716747;5915.940840591582;5940.584159108864;5950;5513.421090785449;5553.888922221573;5555.083411237181;5570.582206334541;5617.859553511154;6446.194225721785;6481.513886458534;6532.379423954764;6534.411902928759;6560.573562718408;4688.390509233812;4705.576628036564;4756.120117778222;4802.279658051285;4807.95192048082;6504.38208370204;6541.9345806541805;6552.475801935833;6739.326067393271;6847.691853866538;4858.416989961227;4871.634627402959;4901.36282283308;4921.9507804922205;4964.503549645006;4902.509749025069;4933.4819843915875;4955.975220123876;4965.329680493087;5029.245613157982;5460.153676180198;5545.944540554624;5560.081771788727;5573.749181286852;5645.23789288449;6395.456386207225;6445.742170313135;6456.160699109086;6517.348265173539;6614.618737254585;1728.110023337982;1738.8174241704692;1738.97391539127;1748.8950662960262;1749.8950062996007;1176.1061593189067;1188.417675339095;1209.5766481731323;1223.4127618742875;1226.8282440458343;5667.376588575254;5711.744750161157;5728.914066289009;5737.88524229513;5770.567207459458;6590.308017658077;6608.339166083353;6631.336866313427;6635;6673;5590.720463976785;5648.15277708347;5648.802291919763;5699.487046165865;5719.742611582489;3535.876244331436;3542.1498840278146;3544.627814079536;3556.946645800315;3565.7682250653625;6433.871322573522;6465.353464653497;6481.384268494486;6490.740370385226;6501.674916254168;6859;6888.276730943279;6916.962455631696;6917.031615573824;6931.202911665122;6515.902261466082;6523.967380163069;6547.181602299617;6571.145751052332;6586.80239592813;6629.834254143685;6635.8009259722285;6712.885441086238;6714.294999025227;6742.42689371409;6315.179026726496;6595.4393876521035;6619.602823830585;6672.232693240339;6679.432248258758;6257.186565746424;6370.4073981504625;6391.2330520337855;6448.5163612730175;6483.902741458787;4813.181759101031;4875.9512404875495;4879.121758083579;4882.853514394574;4898.975505122452;6491.383318584727;6601.240857301472;6650.135482387259;6682.766103186365;6708.362705542965;6180.907286390798;6404.391582799627;6456.12842266288;6456.257530384066;6556.672166391757;6429.2284925807335;6498.415142637185;6504.837379065561;6536.215654121535;6586.80239592813;6397.4562162216735;6428.357164283534;6455.4512866406885;6485.319041500575;6514.413702766774;6503.642299673564;6570.5400621956005;6582.80251592453;6598.802035938929;6610.239822420291;6284;6321.273053598711;6367.4081479630095;6368.057742388431;6446.5165112615805 16:45:47 INFO - PID 29183 | |5;yui.html;823.4153750836906;864.8745931839883;869.6130222051187;872.855978763504;892.1569117184259;18087.547811304725;18948.810511894877;19355.806441935594;19503.707444388347;19551.41345759626;16638.66722665546;16844.57888552787;18281.45155645333;20879.164833406645;20939.476513087182;951.4148798488914;965.3049804141007;972.2950860626025;973.9415635061919;980.62736160259;949.7198326493666;952.276270034775;956.4309236004566;960.812641534901;967.5742673223759;947.7488465556632;1000.9649662261822;1002.1431675917095;1002.4937406609688;1008.5058321422487;982.4645568165367;991.0733464210986;994.6469003503761;997.8104160209609;1005.1104772276515;705.9470539709491;719.9964000180019;725.4232884856551;726.8873324634637;728.3735987051132;18327.17527711256;18878.339258126038;19095.331663391855;19128.330508432136;19323;19735.703964440403;20004.69992950107;20321.695174572393;20444;20879.895600522053;14252.144871307652;15776.132312722795;15836.920815395964;16021;16041.037537747656;3661.377565813818;3690;3697.6672099510906;3707.443883417482;3711.9443208351895;124829.37585312016;128223.35888320592;131958.3402082993;132955.6704432953;133443.33278333643;15702.214889255492;15791.526254212393;16137;16225.67548649044;16330.183490825411;28587.428251434856;29099;29137.85431072831;29272.707272926997;29394.265143371587;8534.957325213334;8648.78378040554;8681.088485709037;8689.217970382695;8690.522021288889;4202.726822756511;4249.405083288342;4331.978340108342;4414.359917811899;4434.889127771831;5120.411152717411;5174.767135478913;5188.143956247177;5188.533032027136;5211.5830733541225;1026.030401270792;1047.4082143589;1068.8931106889404;1075.8924107589178;1077.922077922078;619.2816333053636;635.6376865186799;638.7540796793176;650.9414152726183;652.6345246661884;11404.714882128013;11660.300381976938;11844.940775296069;12111.939440302918;12116.212446191146;614.3334482086897;623.6507555768784;630.4420587779756;636.7357546618194;647.0811447744214;5250.238715386324;5282.947170528322;5304.893902121936;5451.700156491431;5460.180972854104;107213;110517;112009;112892;114411;101721.49139254405;103258.48370758098;103334;104024;105646;84930.15069849345;86937;88100;88872.11127888638;91125.08874911166;9744.512774361396;9792.755181120245;9860.753481163028;9980.2514811388;10078.092971632588;42043.369349460394;42282.78858605687;42348;42468.5753142477;44723.55276447194;71890.64054679693;73895.26104738883;75238;76007;76558.61720691361;18377.356792512197;18494.16776245099;18533.72199417037;18577.349792757188;18765.155567999198;17702.468925932244;19212.327568535035;19285.22859085677;19461.416157515298;19546.218151273788;18338.908305458386;18654.253829846653;18721.78308409949;19025.809741902405;19110.904445477685;18778.906105469385;19163.520911977314;19194.13626386844;19247;19767.20931162795;16184.514464566082;17974.101294935463;18349.54126146857;18625.44123676292;18872.622547549247;12703.872961270268;12877.613671589866;13248.867511325148;14095.154290742588;14209.644758881112;12980.935095324463;13242.139260948008;13369;13469.528566500125;13505.39225734864 16:45:47 INFO - PID 29183 | __end_tp_report 16:45:47 INFO - PID 29183 | __start_cc_report 16:45:47 INFO - PID 29183 | _x_x_mozilla_cycle_collect,375 16:45:47 INFO - PID 29183 | __end_cc_report 16:45:47 INFO - PID 29183 | __startTimestamp1503445547973__endTimestamp 16:45:47 INFO - PID 29183 | 16:45:47 INFO - PID 29183 | ------- Summary: start ------- 16:45:47 INFO - PID 29183 | Number of tests: 6 16:45:47 INFO - PID 29183 | 16:45:47 INFO - PID 29183 | [#0] dojo.html Cycles:165 Average:6054.78 Median:6301.97 stddev:702.45 (11.1%) stddev-sans-first:666.94 16:45:47 INFO - PID 29183 | Values: 3162.1 3219.2 3247.3 3253.3 3277.5 6066.5 6209.0 6241.4 6244.8 6262.9 5983.5 6074.0 6107.4 6107.5 6131.5 5586.1 5610.7 5611.9 5628.1 5640.3 5547.5 5564.6 5601.9 5658.3 5665.3 5563.2 5601.9 5684.9 5690.1 5690.1 5578.2 5647.1 5661.2 5666.5 5701.7 5640.7 5651.6 5675.5 5683.7 5754.0 5863.0 5900.9 5926.6 6008.0 6134.0 6486.9 6492.8 6503.3 6503.6 6557.6 6541.9 6598.9 6643.5 6671.5 6765.1 6132.8 6170.1 6180.5 6252.6 6301.5 6739.6 6796.8 6800.7 6928.6 6929.1 6284.7 6315.5 6353.9 6360.1 6365.4 6445.9 6446.1 6470.2 6480.7 6485.7 6426.1 6433.5 6435.8 6465.5 6536.2 6530.9 6585.5 6667.8 6672.4 6756.2 5123.4 5184.5 5292.0 5343.3 5352.3 4495.9 4587.9 4596.2 4602.2 4618.5 5778.5 5785.0 5799.1 5806.7 5831.9 6618.0 6636.3 6684.0 6725.5 6739.8 5609.2 5737.1 5828.7 5839.1 5842.0 5599.4 5623.9 5630.2 5643.7 5643.7 6327.6 6365.9 6378.1 6384.6 6400.1 6520.1 6527.2 6599.4 6610.5 6615.1 5499.5 6226.9 6359.7 6363.6 6373.8 6518.7 6563.0 6565.3 6578.4 6653.4 6583.8 6627.1 6708.0 6708.1 6708.5 6302.0 6313.1 6396.3 6407.3 6411.9 6329.3 6330.9 6347.4 6354.2 6442.0 6330.5 6425.3 6441.0 6446.2 6450.4 6479.0 6491.9 6591.7 6595.0 6609.5 6138.7 6226.1 6231.9 6259.6 6381.6 16:45:47 INFO - PID 29183 | 16:45:47 INFO - PID 29183 | [#1] ext.html Cycles:180 Average:36238.51 Median:33120.42 stddev:51553.69 (155.7%) stddev-sans-first:51629.68 16:45:47 INFO - PID 29183 | Values: 812.9 837.1 864.4 866.6 1111.0 29924.9 30614.2 39492.0 40427.0 40431.6 40474.4 41097.8 41112.2 41309.6 41365.6 7543.3 7554.3 7572.4 7604.7 7728.2 7432.4 7493.5 7510.4 7530.9 7604.9 7061.4 7614.8 7668.9 7673.9 7700.8 7446.3 7523.6 7539.6 7543.6 7548.6 7443.0 7519.7 7545.9 7563.9 7566.7 35864.5 36521.8 36732.4 36820.4 36847.0 3201.6 3239.0 3246.8 3247.4 3250.6 30275.7 30335.7 30353.2 30358.5 30567.7 5097.9 5112.6 5141.6 5141.8 5179.4 213255.0 214227.0 215145.0 215326.0 216549.0 46238.5 46411.0 46730.0 46785.0 47030.8 47396.5 48221.3 48285.5 48288.5 48406.8 15354.7 15740.6 15796.0 15859.8 15863.8 12818.0 12975.9 12980.1 12983.6 13013.7 13683.5 13705.8 13747.9 13825.9 13986.8 4871.5 5331.8 5477.6 5585.1 5739.7 1005.5 1008.4 1019.6 1025.0 1026.0 22484.1 22533.3 22633.0 23243.5 27850.9 1092.5 1093.2 1093.8 1096.2 1127.4 11956.5 12100.2 12106.1 12155.7 12181.6 224705.0 227031.0 228082.0 228813.0 229963.0 50819.0 51374.5 51624.5 51703.5 51964.5 1431.1 1481.4 1494.4 1498.3 1502.7 22656.0 22675.4 22947.7 22963.1 23008.2 37218.4 37688.2 37876.4 37899.4 38030.2 142000.0 142085.0 142958.0 143106.3 143203.3 33900.0 34127.8 34236.8 34286.7 34580.0 38267.0 38793.8 41504.2 43085.1 44550.6 29163.7 32300.5 32508.3 33298.5 33317.7 32084.8 32298.0 32409.7 32652.8 32763.7 36504.5 36547.8 36972.3 37100.0 37294.3 31877.5 31990.4 32301.8 32880.5 32942.3 24261.4 24553.9 24770.3 24774.6 24943.9 16:45:47 INFO - PID 29183 | 16:45:47 INFO - PID 29183 | [#2] jquery.html Cycles:180 Average:36522.17 Median:23238.48 stddev:86210.82 (371.0%) stddev-sans-first:86410.35 16:45:47 INFO - PID 29183 | Values: 548.8 551.6 556.4 559.3 574.8 22213.4 23085.1 23121.7 23141.5 23194.2 23435.0 25136.6 25268.1 25333.6 25341.2 6666.6 6744.6 6804.7 6816.8 6835.8 5827.5 6068.7 6587.0 6642.7 6655.6 6299.7 6307.6 6308.8 6313.4 6358.9 6301.0 6314.5 6322.6 6323.7 6329.3 5850.7 5853.9 5867.3 5878.2 5896.8 24600.9 28291.6 28803.0 28924.3 29190.8 2017.3 2046.3 2047.1 2047.4 2057.0 19388.6 19606.6 19799.4 19814.7 19839.2 2356.2 2369.3 2421.2 2422.8 2446.8 131908.0 135497.0 137620.0 137896.0 138145.0 14128.4 14253.9 14314.9 14474.5 14644.6 22607.7 22636.3 22689.5 22724.7 22771.7 9898.0 9953.7 10049.9 10173.4 10280.9 9306.0 9350.1 9379.7 9397.4 9515.8 8489.7 8622.5 8899.9 9057.4 9110.5 2681.9 2684.0 2717.8 2751.2 2793.9 942.8 971.5 972.3 976.1 990.5 19573.0 22861.5 23395.3 24015.9 24388.0 1003.2 1052.9 1059.9 1074.1 1078.3 10785.5 11275.5 11319.5 11365.1 11564.8 500412.0 508585.0 512346.0 515771.0 516624.4 125987.0 128522.0 129675.0 131533.0 133064.0 1202.5 1209.8 1268.7 1269.3 1279.0 20441.6 20712.9 21286.1 21389.9 21532.4 58931.0 61626.4 64051.4 64929.7 65694.3 77351.0 79086.0 79735.0 83360.5 84430.0 20171.6 20269.9 20751.4 20760.1 20806.6 22854.7 23282.8 23283.4 23485.8 23500.5 17704.6 18207.2 18365.7 18518.1 18623.5 16114.6 16513.8 16772.4 16981.3 17275.7 18519.5 18763.7 18892.4 19148.7 19153.1 19572.2 19728.2 19804.2 19845.9 19969.6 17654.6 18074.7 18110.7 18132.3 18250.2 16:45:47 INFO - PID 29183 | 16:45:47 INFO - PID 29183 | [#3] mootools.html Cycles:180 Average:8940.36 Median:2691.94 stddev:6219.67 (231.0%) stddev-sans-first:6210.24 16:45:47 INFO - PID 29183 | Values: 1244.9 1298.3 1320.4 1323.8 1332.1 12374.3 14164.2 14770.6 14798.9 14800.9 12264.3 12527.4 14306.0 14652.0 14786.3 2629.6 2677.1 2686.2 2690.2 2692.8 2576.6 2681.2 2691.4 2692.5 2697.0 2591.3 2696.4 2708.6 2726.9 2753.0 2703.7 2716.1 2740.3 2743.8 2748.9 2617.1 2639.9 2690.5 2698.0 2716.1 14057.1 14445.5 14545.2 14547.6 14593.3 7496.6 7883.8 7885.5 7897.0 7899.1 5308.0 5497.8 5501.2 5558.7 5573.1 1767.7 1807.9 1825.2 1861.2 1871.3 24419.8 24524.8 24570.4 24637.8 24693.9 6512.6 6512.9 6513.0 6738.5 6765.1 16370.7 16541.6 16571.8 16578.3 16600.1 7516.2 7641.8 7732.3 7915.1 7983.8 7059.3 7157.3 7167.7 7186.6 7292.9 5331.6 5449.1 5451.2 5465.4 5701.9 1548.9 1684.9 1691.9 1737.3 1746.6 692.6 833.4 844.7 850.0 860.9 7371.8 7390.7 7398.1 8657.3 8967.1 960.7 978.9 986.6 986.8 987.5 5070.4 5143.5 5236.1 5255.7 5334.8 19862.8 20648.6 20654.2 20681.9 20704.3 19489.0 20108.5 20384.7 20387.1 20499.0 10725.1 10787.9 10932.2 10935.3 11095.6 7523.7 7604.7 7735.1 7753.8 7784.3 17185.2 17482.0 17753.0 17830.3 18193.0 17966.5 18033.7 18193.8 18321.8 18356.4 9617.4 9875.3 9906.0 9907.0 9935.1 13409.7 13429.4 13596.8 13619.1 13700.6 10611.7 10671.8 10832.5 10946.1 11027.1 10916.8 11020.7 11088.8 11119.6 11286.2 9575.9 9706.8 9719.9 9752.6 9752.7 7352.9 7388.3 7394.8 7399.2 7402.4 7234.9 7362.3 7394.6 7403.5 7479.0 16:45:47 INFO - PID 29183 | 16:45:47 INFO - PID 29183 | [#4] prototype.html Cycles:180 Average:5447.20 Median:6096.73 stddev:1536.83 (25.2%) stddev-sans-first:1495.59 16:45:47 INFO - PID 29183 | Values: 499.1 506.5 509.5 529.5 530.1 6115.2 6130.2 6177.7 6194.7 6247.5 6078.2 6133.7 6133.8 6144.5 6176.7 5029.7 5073.8 5083.5 5087.7 5136.9 5067.5 5070.8 5112.6 5126.8 5136.3 4710.8 4758.6 4767.0 4774.8 5011.4 4767.2 4807.4 4832.3 4833.6 4839.2 4233.6 4288.7 4299.2 4335.7 4339.0 5878.9 5886.7 5915.9 5940.6 5950.0 5513.4 5553.9 5555.1 5570.6 5617.9 6446.2 6481.5 6532.4 6534.4 6560.6 4688.4 4705.6 4756.1 4802.3 4808.0 6504.4 6541.9 6552.5 6739.3 6847.7 4858.4 4871.6 4901.4 4922.0 4964.5 4902.5 4933.5 4956.0 4965.3 5029.2 5460.2 5545.9 5560.1 5573.7 5645.2 6395.5 6445.7 6456.2 6517.3 6614.6 1728.1 1738.8 1739.0 1748.9 1749.9 1176.1 1188.4 1209.6 1223.4 1226.8 5667.4 5711.7 5728.9 5737.9 5770.6 6590.3 6608.3 6631.3 6635.0 6673.0 5590.7 5648.2 5648.8 5699.5 5719.7 3535.9 3542.1 3544.6 3556.9 3565.8 6433.9 6465.4 6481.4 6490.7 6501.7 6859.0 6888.3 6917.0 6917.0 6931.2 6515.9 6524.0 6547.2 6571.1 6586.8 6629.8 6635.8 6712.9 6714.3 6742.4 6315.2 6595.4 6619.6 6672.2 6679.4 6257.2 6370.4 6391.2 6448.5 6483.9 4813.2 4876.0 4879.1 4882.9 4899.0 6491.4 6601.2 6650.1 6682.8 6708.4 6180.9 6404.4 6456.1 6456.3 6556.7 6429.2 6498.4 6504.8 6536.2 6586.8 6397.5 6428.4 6455.5 6485.3 6514.4 6503.6 6570.5 6582.8 6598.8 6610.2 6284.0 6321.3 6367.4 6368.1 6446.5 16:45:47 INFO - PID 29183 | 16:45:47 INFO - PID 29183 | [#5] yui.html Cycles:180 Average:24044.49 Median:20163.20 stddev:33360.37 (165.5%) stddev-sans-first:33408.38 16:45:47 INFO - PID 29183 | Values: 823.4 864.9 869.6 872.9 892.2 18087.5 18948.8 19355.8 19503.7 19551.4 16638.7 16844.6 18281.5 20879.2 20939.5 951.4 965.3 972.3 973.9 980.6 949.7 952.3 956.4 960.8 967.6 947.7 1001.0 1002.1 1002.5 1008.5 982.5 991.1 994.6 997.8 1005.1 705.9 720.0 725.4 726.9 728.4 18327.2 18878.3 19095.3 19128.3 19323.0 19735.7 20004.7 20321.7 20444.0 20879.9 14252.1 15776.1 15836.9 16021.0 16041.0 3661.4 3690.0 3697.7 3707.4 3711.9 124829.4 128223.4 131958.3 132955.7 133443.3 15702.2 15791.5 16137.0 16225.7 16330.2 28587.4 29099.0 29137.9 29272.7 29394.3 8535.0 8648.8 8681.1 8689.2 8690.5 4202.7 4249.4 4332.0 4414.4 4434.9 5120.4 5174.8 5188.1 5188.5 5211.6 1026.0 1047.4 1068.9 1075.9 1077.9 619.3 635.6 638.8 650.9 652.6 11404.7 11660.3 11844.9 12111.9 12116.2 614.3 623.7 630.4 636.7 647.1 5250.2 5282.9 5304.9 5451.7 5460.2 107213.0 110517.0 112009.0 112892.0 114411.0 101721.5 103258.5 103334.0 104024.0 105646.0 84930.2 86937.0 88100.0 88872.1 91125.1 9744.5 9792.8 9860.8 9980.3 10078.1 42043.4 42282.8 42348.0 42468.6 44723.6 71890.6 73895.3 75238.0 76007.0 76558.6 18377.4 18494.2 18533.7 18577.3 18765.2 17702.5 19212.3 19285.2 19461.4 19546.2 18338.9 18654.3 18721.8 19025.8 19110.9 18778.9 19163.5 19194.1 19247.0 19767.2 16184.5 17974.1 18349.5 18625.4 18872.6 12703.9 12877.6 13248.9 14095.2 14209.6 12980.9 13242.1 13369.0 13469.5 13505.4 16:45:47 INFO - PID 29183 | -------- Summary: end -------- 16:45:47 INFO - PID 29183 | 16:45:48 INFO - TEST-INFO | 29183: exit 0 16:45:48 INFO - TEST-OK | dromaeo_css | took 1116446ms 16:45:48 INFO - TEST-START | kraken 16:45:48 INFO - Initialising browser for kraken test... 16:45:48 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:52764/getInfo.html -profile /tmp/tmp973pPt/profile 16:45:48 INFO - TEST-INFO | started process 29608 (/builds/slave/test/build/application/firefox/firefox http://localhost:52764/getInfo.html) 16:45:55 INFO - TEST-INFO | 29608: exit 0 16:45:55 INFO - Browser initialized. 16:45:55 INFO - Running cycle 1/1 for kraken test... 16:45:55 INFO - TEST-INFO | started process 29792 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp973pPt/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 16:45:56 INFO - PID 29792 | WebRender - OpenGL version new 3.2.0 NVIDIA 361.42 16:45:57 INFO - PID 29792 | WebRender - OpenGL version new 3.2.0 NVIDIA 361.42 16:45:57 INFO - PID 29792 | 16:45:57 INFO - PID 29792 | (/builds/slave/test/build/application/firefox/firefox:29851): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 16:45:57 INFO - PID 29792 | 16:45:57 INFO - PID 29792 | 16:45:57 INFO - PID 29792 | (/builds/slave/test/build/application/firefox/firefox:29911): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 16:45:57 INFO - PID 29792 | 16:45:57 INFO - PID 29792 | __metrics Screen width/height:1600/1200 16:45:57 INFO - PID 29792 | colorDepth:24 16:45:57 INFO - PID 29792 | Browser inner width/height: 1024/768 16:45:57 INFO - PID 29792 | __metrics 16:46:07 INFO - PID 29792 | RSS: Main: 199479296 16:46:07 INFO - PID 29792 | 16:46:10 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52764/tests/kraken/driver.html?testName=audio-beat-detection) 16:46:11 INFO - PID 29792 | RSS: Main: 207138816 16:46:11 INFO - PID 29792 | 16:46:13 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52764/tests/kraken/driver.html?testName=audio-dft) 16:46:14 INFO - PID 29792 | RSS: Main: 208613376 16:46:14 INFO - PID 29792 | 16:46:17 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52764/tests/kraken/driver.html?testName=audio-fft) 16:46:18 INFO - PID 29792 | RSS: Main: 201637888 16:46:18 INFO - PID 29792 | 16:46:20 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52764/tests/kraken/driver.html?testName=audio-oscillator) 16:46:21 INFO - PID 29792 | RSS: Main: 203546624 16:46:21 INFO - PID 29792 | 16:46:23 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52764/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:46:24 INFO - PID 29792 | RSS: Main: 204140544 16:46:24 INFO - PID 29792 | 16:46:27 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52764/tests/kraken/driver.html?testName=imaging-darkroom) 16:46:27 INFO - PID 29792 | RSS: Main: 205082624 16:46:27 INFO - PID 29792 | 16:46:31 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52764/tests/kraken/driver.html?testName=imaging-desaturate) 16:46:32 INFO - PID 29792 | RSS: Main: 204103680 16:46:32 INFO - PID 29792 | 16:46:34 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52764/tests/kraken/driver.html?testName=json-parse-financial) 16:46:35 INFO - PID 29792 | RSS: Main: 205475840 16:46:35 INFO - PID 29792 | 16:46:37 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52764/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:46:37 INFO - PID 29792 | RSS: Main: 205041664 16:46:37 INFO - PID 29792 | 16:46:39 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52764/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:46:40 INFO - PID 29792 | RSS: Main: 205115392 16:46:40 INFO - PID 29792 | 16:46:42 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52764/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:46:43 INFO - PID 29792 | RSS: Main: 204673024 16:46:43 INFO - PID 29792 | 16:46:46 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52764/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:46:46 INFO - PID 29792 | RSS: Main: 205303808 16:46:46 INFO - PID 29792 | 16:46:49 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52764/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:46:50 INFO - PID 29792 | RSS: Main: 203968512 16:46:50 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | Cycle 1(1): loaded http://localhost:52764/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52764/tests/kraken/driver.html?testName=ai-astar) 16:46:52 INFO - PID 29792 | RSS: Main: 207962112 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | __start_tp_report 16:46:52 INFO - PID 29792 | _x_x_mozilla_page_load 16:46:52 INFO - PID 29792 | _x_x_mozilla_page_load_details 16:46:52 INFO - PID 29792 | |i|pagename|runs| 16:46:52 INFO - PID 29792 | |0;ai-astar;109;118;102;116;110;111;108;99;109;119 16:46:52 INFO - PID 29792 | |1;audio-beat-detection;150;121;144;191;119;153;153;119;181;124 16:46:52 INFO - PID 29792 | |2;audio-dft;173;165;168;165;167;177;169;173;168;167 16:46:52 INFO - PID 29792 | |3;audio-fft;79;77;75;180;75;81;90;91;98;78 16:46:52 INFO - PID 29792 | |4;audio-oscillator;89;83;133;79;86;90;132;86;79;124 16:46:52 INFO - PID 29792 | |5;imaging-gaussian-blur;120;115;115;118;116;126;116;118;120;116 16:46:52 INFO - PID 29792 | |6;imaging-darkroom;152;149;149;149;148;149;151;154;158;155 16:46:52 INFO - PID 29792 | |7;imaging-desaturate;102;103;104;95;95;96;98;94;98;104 16:46:52 INFO - PID 29792 | |8;json-parse-financial;55;54;58;55;54;54;59;56;60;54 16:46:52 INFO - PID 29792 | |9;json-stringify-tinderbox;66;63;57;57;56;68;58;57;60;61 16:46:52 INFO - PID 29792 | |10;stanford-crypto-aes;76;76;82;84;77;89;76;81;81;80 16:46:52 INFO - PID 29792 | |11;stanford-crypto-ccm;133;123;136;131;128;124;131;136;125;162 16:46:52 INFO - PID 29792 | |12;stanford-crypto-pbkdf2;171;173;186;188;172;177;175;171;204;175 16:46:52 INFO - PID 29792 | |13;stanford-crypto-sha256-iterative;74;66;68;66;65;71;64;64;72;68 16:46:52 INFO - PID 29792 | __end_tp_report 16:46:52 INFO - PID 29792 | __start_cc_report 16:46:52 INFO - PID 29792 | _x_x_mozilla_cycle_collect,947 16:46:52 INFO - PID 29792 | __end_cc_report 16:46:52 INFO - PID 29792 | __startTimestamp1503445612562__endTimestamp 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | ------- Summary: start ------- 16:46:52 INFO - PID 29792 | Number of tests: 14 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#0] ai-astar Cycles:10 Average:110.10 Median:113.50 stddev:6.44 (5.7%) stddev-sans-first:6.82 16:46:52 INFO - PID 29792 | Values: 109.0 118.0 102.0 116.0 110.0 111.0 108.0 99.0 109.0 119.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#1] audio-beat-detection Cycles:10 Average:145.50 Median:151.50 stddev:25.67 (16.9%) stddev-sans-first:27.18 16:46:52 INFO - PID 29792 | Values: 150.0 121.0 144.0 191.0 119.0 153.0 153.0 119.0 181.0 124.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#2] audio-dft Cycles:10 Average:169.20 Median:168.50 stddev:3.91 (2.3%) stddev-sans-first:3.90 16:46:52 INFO - PID 29792 | Values: 173.0 165.0 168.0 165.0 167.0 177.0 169.0 173.0 168.0 167.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#3] audio-fft Cycles:10 Average:92.40 Median:80.00 stddev:31.75 (39.7%) stddev-sans-first:33.30 16:46:52 INFO - PID 29792 | Values: 79.0 77.0 75.0 180.0 75.0 81.0 90.0 91.0 98.0 78.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#4] audio-oscillator Cycles:10 Average:98.10 Median:84.50 stddev:22.20 (26.3%) stddev-sans-first:23.30 16:46:52 INFO - PID 29792 | Values: 89.0 83.0 133.0 79.0 86.0 90.0 132.0 86.0 79.0 124.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#5] imaging-gaussian-blur Cycles:10 Average:118.00 Median:118.00 stddev:3.37 (2.9%) stddev-sans-first:3.49 16:46:52 INFO - PID 29792 | Values: 120.0 115.0 115.0 118.0 116.0 126.0 116.0 118.0 120.0 116.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#6] imaging-darkroom Cycles:10 Average:151.40 Median:151.50 stddev:3.31 (2.2%) stddev-sans-first:3.50 16:46:52 INFO - PID 29792 | Values: 152.0 149.0 149.0 149.0 148.0 149.0 151.0 154.0 158.0 155.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#7] imaging-desaturate Cycles:10 Average:98.90 Median:95.00 stddev:3.98 (4.2%) stddev-sans-first:4.07 16:46:52 INFO - PID 29792 | Values: 102.0 103.0 104.0 95.0 95.0 96.0 98.0 94.0 98.0 104.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#8] json-parse-financial Cycles:10 Average:55.90 Median:55.50 stddev:2.28 (4.1%) stddev-sans-first:2.40 16:46:52 INFO - PID 29792 | Values: 55.0 54.0 58.0 55.0 54.0 54.0 59.0 56.0 60.0 54.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#9] json-stringify-tinderbox Cycles:10 Average:60.30 Median:60.50 stddev:4.16 (6.9%) stddev-sans-first:3.87 16:46:52 INFO - PID 29792 | Values: 66.0 63.0 57.0 57.0 56.0 68.0 58.0 57.0 60.0 61.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#10] stanford-crypto-aes Cycles:10 Average:80.20 Median:81.00 stddev:4.21 (5.2%) stddev-sans-first:4.18 16:46:52 INFO - PID 29792 | Values: 76.0 76.0 82.0 84.0 77.0 89.0 76.0 81.0 81.0 80.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#11] stanford-crypto-ccm Cycles:10 Average:132.90 Median:132.00 stddev:11.24 (8.5%) stddev-sans-first:11.92 16:46:52 INFO - PID 29792 | Values: 133.0 123.0 136.0 131.0 128.0 124.0 131.0 136.0 125.0 162.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:179.20 Median:176.00 stddev:10.56 (6.0%) stddev-sans-first:10.78 16:46:52 INFO - PID 29792 | Values: 171.0 173.0 186.0 188.0 172.0 177.0 175.0 171.0 204.0 175.0 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.80 Median:68.00 stddev:3.49 (5.1%) stddev-sans-first:2.89 16:46:52 INFO - PID 29792 | Values: 74.0 66.0 68.0 66.0 65.0 71.0 64.0 64.0 72.0 68.0 16:46:52 INFO - PID 29792 | -------- Summary: end -------- 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | ###!!! [Parent][MessageChannel] Error: (msgtype=0x150079,name=PBrowser::Msg_Destroy) Closed channel: cannot send/recv 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | 16:46:52 INFO - PID 29792 | ###!!! [Child][MessageChannel] Error: (msgtype=0x150001,name=PBrowser::Msg_AsyncMessage) Closed channel: cannot send/recv 16:46:52 INFO - PID 29792 | 16:46:53 INFO - PID 29792 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 16:46:53 INFO - TEST-INFO | 29792: exit 0 16:46:53 INFO - TEST-OK | kraken | took 64785ms 16:46:53 INFO - SUITE-END | took 1181s 16:46:53 INFO - Completed test suite (00:19:41) 16:46:53 INFO - javascript benchmark 16:46:53 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8443.356217543364, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3162.0513845846226, 3219.227385427498, 3247.2531317796897, 3253.349330133973, 3277.4592192288274, 6066.454019138277, 6208.968955155218, 6241.407066328703, 6244.843878903024, 6262.9060564091515, 5983.49140323072, 6073.969630151854, 6107.4197951194565, 6107.511399088074, 6131.509479241661, 5586.13414920688, 5610.747516361774, 5611.943880561183, 5628.127640215773, 5640.294963129609, 5547.528460080898, 5564.610477266593, 5601.915971260414, 5658.292713410824, 5665.291838520185, 5563.193336966137, 5601.859953501154, 5684.857878553028, 5690.06113991191, 5690.146478028288, 5578.191162281487, 5647.124695672177, 5661.207430959669, 5666.54667626591, 5701.6864072476, 5640.689762063085, 5651.632643878134, 5675.51758100562, 5683.744231509592, 5753.971230143864, 5862.97068514659, 5900.911486327708, 5926.614770039977, 6007.969960150172, 6134.04922237054, 6486.935130648728, 6492.772752953671, 6503.317151699051, 6503.577267477599, 6557.639329836857, 6541.869162616768, 6598.868022639568, 6643.5017373697165, 6671.499637527205, 6765.086713293741, 6132.754689812402, 6170.074488826712, 6180.536459765535, 6252.624842509418, 6301.495880329563, 6739.59562426256, 6796.76211332601, 6800.727970881208, 6928.61892595902, 6929.099217101744, 6284.717187726564, 6315.526335524854, 6353.904691429632, 6360.109584658151, 6365.427111559982, 6445.9355406446275, 6446.129772480749, 6470.22357317125, 6480.740770369132, 6485.67571621417, 6426.132472116298, 6433.517486188554, 6435.774747883802, 6465.450436712838, 6536.182977127859, 6530.869382612321, 6585.506087043491, 6667.766628168088, 6672.366125218096, 6756.189257289157, 5123.359580052494, 5184.455632158569, 5292.047431462373, 5343.305370301913, 5352.2506849041165, 4495.887602809956, 4587.885302867388, 4596.241620132708, 4602.217623004098, 4618.49196588375, 5778.451047150514, 5785.0454674979, 5799.072148456226, 5806.738696758656, 5831.941680583224, 6617.966910165418, 6636.30318816527, 6683.966580167165, 6725.529212955144, 6739.764108256286, 5609.242752228397, 5737.139429085671, 5828.737706803204, 5839.065749480063, 5842.0, 5599.384067752625, 5623.943760562423, 5630.183623374588, 5643.661380317194, 5643.746031428595, 6327.557071005078, 6365.904511432333, 6378.138951241615, 6384.6169229846355, 6400.135981642418, 6520.087187793618, 6527.15147030883, 6599.439047681001, 6610.471162306908, 6615.106960560262, 5499.450054994469, 6226.937730622636, 6359.682015899279, 6363.5545511813725, 6373.776917807854, 6518.706658200297, 6563.0, 6565.310642382672, 6578.407943285128, 6653.401193892573, 6583.769568065095, 6627.105340778933, 6708.0, 6708.094407254958, 6708.496862735412, 6301.96849015752, 6313.147725057059, 6396.328385519453, 6407.295197528361, 6411.8717625646295, 6329.272133704683, 6330.9050364245495, 6347.39699728525, 6354.205724284465, 6442.0, 6330.52521060913, 6425.261094974137, 6441.033844923299, 6446.161998940108, 6450.387213214737, 6479.028145778171, 6491.935080649133, 6591.736330546724, 6595.0, 6609.504287178384, 6138.723757430837, 6226.12834203221, 6231.875362492634, 6259.624422534663, 6381.649009304533], "value": 6004.502496086278, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [812.9471584347017, 837.137748119437, 864.3690106222457, 866.6490071521032, 1111.0, 29924.85037574812, 30614.234644133907, 39492.0, 40427.0, 40431.59568404315, 40474.39288410669, 41097.7945110274, 41112.17775644486, 41309.58690413102, 41365.58634413655, 7543.283388078124, 7554.320111189992, 7572.432067594925, 7604.657790399446, 7728.227177282255, 7432.368248698867, 7493.512921660102, 7510.399168066569, 7530.887036694454, 7604.885926711104, 7061.435085193172, 7614.809629759273, 7668.884966725504, 7673.923260767377, 7700.768976930673, 7446.255374462565, 7523.623818809092, 7539.623018849091, 7543.622818859035, 7548.622568871562, 7442.962785186093, 7519.736809211651, 7545.924540754577, 7563.886541701879, 7566.697332106764, 35864.462033069525, 36521.817390913144, 36732.44901326482, 36820.44769328462, 36847.0, 3201.5677883485664, 3238.9676103238903, 3246.772725909187, 3247.4479338512274, 3250.6261779895376, 30275.69724302751, 30335.69664303351, 30353.241168970733, 30358.54462183069, 30567.69432305693, 5097.872553186163, 5112.590992720573, 5141.6143789215585, 5141.820036298749, 5179.430262671103, 213255.0, 214227.0, 215145.0, 215326.0, 216549.0, 46238.537614624096, 46411.0, 46730.0, 46785.0, 47030.76484617555, 47396.5260347399, 48221.27668084981, 48285.5171448288, 48288.517114829105, 48406.75796621065, 15354.692906141814, 15740.60648483797, 15796.0, 15859.841401586067, 15863.841361586236, 12818.038647101504, 12975.870241297465, 12980.091393602546, 12983.610491685264, 13013.739725205633, 13683.452661893612, 13705.794413083811, 13747.862521374858, 13825.861741382658, 13986.811121054825, 4871.541844977496, 5331.786728530816, 5477.561795056466, 5585.134304182858, 5739.65562066269, 1005.527402121002, 1008.4302369161401, 1019.6176433837311, 1024.9897501025043, 1025.9894004405655, 22484.100635974704, 22533.32400028002, 22633.0, 23243.53512929732, 27850.860745696144, 1092.5083712329324, 1093.2456604942565, 1093.8085834979006, 1096.2271598523023, 1127.3912087472672, 11956.461959211856, 12100.152989290666, 12106.092043096804, 12155.696107597381, 12181.634550963485, 224705.0, 227031.0, 228082.0, 228813.0, 229963.0, 50819.0, 51374.486255137715, 51624.48375516197, 51703.48296516987, 51964.48035519672, 1431.105559025609, 1481.429649584896, 1494.387301206522, 1498.3482185249234, 1502.7219964306419, 22656.0, 22675.433114172276, 22947.6557851629, 22963.081476740743, 23008.19471318496, 37218.44172337363, 37688.2462350746, 37876.431853521666, 37899.431508527945, 38030.23939521249, 142000.0, 142085.0, 142958.0, 143106.28446857698, 143203.28398357943, 33900.0, 34127.82936085304, 34236.82881585576, 34286.65713342935, 34580.0, 38267.0, 38793.80603096967, 41504.169916602106, 43085.13829723451, 44550.55449445464, 29163.7083629161, 32300.515492268103, 32508.349833003682, 33298.5005224917, 33317.666823331456, 32084.839575801972, 32298.0, 32409.675903240666, 32652.83673581617, 32763.672363276062, 36504.45243321406, 36547.81726091352, 36972.26055478821, 37100.0, 37294.25411491809, 31877.521837171997, 31990.36019279555, 32301.838490808335, 32880.50679239765, 32942.34115317728, 24261.393465163514, 24553.877230613733, 24770.25689229326, 24774.628380573944, 24943.87528062348], "value": 16808.510433649557, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [548.8079172289699, 551.5973339462192, 556.4018679919088, 559.3483591615768, 574.8189320364086, 22213.44466388339, 23085.076596936124, 23121.653175202366, 23141.537169256604, 23194.188203412883, 23435.0, 25136.622950655754, 25268.115615953444, 25333.61999570003, 25341.239762807098, 6666.600003999752, 6744.561603495782, 6804.727810887559, 6816.829579260509, 6835.829104272383, 5827.504662103705, 6068.726907289182, 6587.0, 6642.734290628369, 6655.633940133291, 6299.748010079591, 6307.590006649576, 6308.810735677914, 6313.368663133673, 6358.904616430757, 6301.0, 6314.494840412779, 6322.557420980534, 6323.715432805535, 6329.335419780926, 5850.707464626794, 5853.9414605854245, 5867.325257595388, 5878.235829342201, 5896.823095307148, 24600.876995615086, 28291.575626365622, 28803.0, 28924.27689307763, 29190.832366705305, 2017.2536161620149, 2046.2735728816206, 2047.0890453748088, 2047.4369548374168, 2056.969145462804, 19388.612227755508, 19606.607867842707, 19799.40601781949, 19814.70277945832, 19839.206431742714, 2356.22244659262, 2369.336585755991, 2421.2494126820743, 2422.842515236504, 2446.8287219894614, 131908.0, 135497.0, 137620.0, 137896.0, 138144.99999999898, 14128.434862605587, 14253.857461425461, 14314.928425358015, 14474.493392731203, 14644.560663180122, 22607.660885086738, 22636.320910372386, 22689.546209075725, 22724.65913011306, 22771.747553884365, 9898.0, 9953.701388958343, 10049.949750251348, 10173.389596624227, 10280.897191028143, 9305.953470232605, 9350.111739384747, 9379.671711490202, 9397.389169703947, 9515.762105947406, 8489.660413583511, 8622.482651040958, 8899.866502002475, 9057.411268267673, 9110.453372797521, 2681.8927242910063, 2683.9731602684114, 2717.782577393804, 2751.1608959267614, 2793.8603069846426, 942.7501712046313, 971.455984648599, 972.3193764364972, 976.104329847726, 990.4849478271402, 19573.0, 22861.542769144526, 23395.298141055795, 24015.879920600284, 24388.0, 1003.1673710820002, 1052.921030922684, 1059.8940105989493, 1074.08702602787, 1078.2991055813627, 10785.514651840685, 11275.492602832892, 11319.490622921989, 11365.147613928988, 11564.826527602092, 500412.0, 508585.0, 512346.0, 515771.0, 516624.41687791323, 125987.0, 128522.0, 129675.0, 131533.0, 133064.0, 1202.4769225386985, 1209.8124790657462, 1268.7145392286845, 1269.2701696524534, 1278.9744205115846, 20441.591168176852, 20712.896435517727, 21286.148554057665, 21389.893050534647, 21532.354029379145, 58931.0, 61626.38373616206, 64051.35948640641, 64929.67535162294, 65694.34305657074, 77351.0, 79086.0, 79735.0, 83360.49918502454, 84430.0, 20171.596568068264, 20269.898650506653, 20751.377458676263, 20760.06579703947, 20806.583868322246, 22854.657180141978, 23282.76717232874, 23283.417914552272, 23485.76514234836, 23500.529989400457, 17704.645907082046, 18207.18067686931, 18365.724514132566, 18518.074096294862, 18623.53441163982, 16114.597135071717, 16513.83486165171, 16772.412965546147, 16981.320747169975, 17275.65448690994, 18519.53701157482, 18763.718544221574, 18892.433227003214, 19148.712769308193, 19153.138108785417, 19572.21711131539, 19728.210871564977, 19804.20783168657, 19845.900770496057, 19969.60060798805, 17654.558636034202, 18074.734768566075, 18110.73224874246, 18132.274709011494, 18250.17874195691], "value": 12356.76947912276, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1244.912856100073, 1298.2924306253096, 1320.3596255815921, 1323.7887333090223, 1332.0675527131004, 12374.319412432313, 14164.150150990934, 14770.556883293504, 14798.852011479881, 14800.925995370035, 12264.264144151357, 12527.436265368058, 14306.0, 14652.0, 14786.334614942327, 2629.6449979252843, 2677.129932771847, 2686.2478506018347, 2690.233283514199, 2692.824966377189, 2576.6135079738, 2681.1554360376417, 2691.3944362518473, 2692.488427198826, 2696.986515067422, 2591.287395966115, 2696.3798326384945, 2708.620793088969, 2726.9045583404586, 2753.0, 2703.6890757562937, 2716.076533978447, 2740.328619488218, 2743.7667798237176, 2748.8625568721486, 2617.084020592796, 2639.9076032338967, 2690.4753573053263, 2697.986510067437, 2716.1036857836866, 14057.08628939126, 14445.494407695785, 14545.200013999225, 14547.636309092251, 14593.343299551545, 7496.587687677175, 7883.8029049273655, 7885.487443316166, 7896.960515197387, 7899.131095579482, 5307.973460132714, 5497.752601132958, 5501.202325662756, 5558.666480011212, 5573.052581061229, 1767.7436771668035, 1807.9276828926827, 1825.233401971162, 1861.2182883188957, 1871.3450292397688, 24419.755802441927, 24524.754752452427, 24570.385740356633, 24637.753622463726, 24693.87653061741, 6512.6092434454085, 6512.902306465407, 6513.0, 6738.528303018742, 6765.1205343305055, 16370.708100865888, 16541.58646033859, 16571.751423728652, 16578.336866525206, 16600.08699521538, 7516.24837516244, 7641.808954776175, 7732.30409263169, 7915.050193976645, 7983.760487185394, 7059.329363710542, 7157.320054594805, 7167.749128780468, 7186.604736739425, 7292.927070729331, 5331.626786124934, 5449.100898351728, 5451.155070964007, 5465.371482279509, 5701.942980570141, 1548.9380424782883, 1684.9241784119745, 1691.881568290208, 1737.3137610643726, 1746.5808206030715, 692.62944324786, 833.4499230507836, 844.7043534762906, 850.0, 860.8665656823202, 7371.8157046074275, 7390.74132405374, 7398.075240594926, 8657.264132548678, 8967.058458861726, 960.6877764726491, 978.8629591857145, 986.5807032011367, 986.8125056239292, 987.4667679453158, 5070.397211081775, 5143.5113664201845, 5236.136037553761, 5255.658382205144, 5334.839954801362, 19862.801371986094, 20648.58702825965, 20654.17383304681, 20681.89659051725, 20704.275350362666, 19489.0, 20108.497287567636, 20384.694229586567, 20387.082581283878, 20499.0, 10725.141988641046, 10787.946060269649, 10932.180086493545, 10935.343879367263, 11095.55617775296, 7523.699052038076, 7604.733834315773, 7735.149133595188, 7753.844923101394, 7784.260495252942, 17185.226664800364, 17482.0, 17753.0, 17830.286788528832, 18193.0, 17966.461006169837, 18033.729494057337, 18193.818061819213, 18321.81678183201, 18356.449306520826, 9617.422954622745, 9875.259355548505, 9906.0, 9907.0, 9935.105840474393, 13409.66475838112, 13429.395677194745, 13596.79604805909, 13619.114757540729, 13700.588982330546, 10611.734706632396, 10671.839922401325, 10832.458377080957, 10946.124310055016, 11027.117830573696, 10916.836247456136, 11020.669379918616, 11088.833667495155, 11119.555217791198, 11286.20996530235, 9575.90424095778, 9706.805863882824, 9719.9028009719, 9752.609895604097, 9752.707418777449, 7352.889706654298, 7388.335049845539, 7394.815129621803, 7399.223081576357, 7402.4078073755045, 7234.89147662796, 7362.263773622595, 7394.630268486447, 7403.481756277009, 7478.962605186939], "value": 6489.312142693374, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [499.13649386561247, 506.50362644608305, 509.47524050228265, 529.5102030621674, 530.1252932661108, 6115.226584290562, 6130.233720784902, 6177.691115444227, 6194.690265486719, 6247.531435142366, 6078.240219972504, 6133.693315334238, 6133.846653833656, 6144.53915956304, 6176.660283684407, 5029.673071250375, 5073.822416215433, 5083.491650834924, 5087.720175390352, 5136.8715782105555, 5067.467915868818, 5070.822521211759, 5112.565431938289, 5126.820561280356, 5136.332276804011, 4710.788014539354, 4758.620689655172, 4766.976165119187, 4774.785134668949, 5011.398632164127, 4767.16464161297, 4807.351007613962, 4832.251001094818, 4833.589144922686, 4839.161118774879, 4233.5554766749665, 4288.742675439484, 4299.161663475624, 4335.653147748204, 4338.956610433918, 5878.941210587882, 5886.705664716747, 5915.940840591582, 5940.584159108864, 5950.0, 5513.421090785449, 5553.888922221573, 5555.083411237181, 5570.582206334541, 5617.859553511154, 6446.194225721785, 6481.513886458534, 6532.379423954764, 6534.411902928759, 6560.573562718408, 4688.390509233812, 4705.576628036564, 4756.120117778222, 4802.279658051285, 4807.95192048082, 6504.38208370204, 6541.9345806541805, 6552.475801935833, 6739.326067393271, 6847.691853866538, 4858.416989961227, 4871.634627402959, 4901.36282283308, 4921.9507804922205, 4964.503549645006, 4902.509749025069, 4933.4819843915875, 4955.975220123876, 4965.329680493087, 5029.245613157982, 5460.153676180198, 5545.944540554624, 5560.081771788727, 5573.749181286852, 5645.23789288449, 6395.456386207225, 6445.742170313135, 6456.160699109086, 6517.348265173539, 6614.618737254585, 1728.110023337982, 1738.8174241704692, 1738.97391539127, 1748.8950662960262, 1749.8950062996007, 1176.1061593189067, 1188.417675339095, 1209.5766481731323, 1223.4127618742875, 1226.8282440458343, 5667.376588575254, 5711.744750161157, 5728.914066289009, 5737.88524229513, 5770.567207459458, 6590.308017658077, 6608.339166083353, 6631.336866313427, 6635.0, 6673.0, 5590.720463976785, 5648.15277708347, 5648.802291919763, 5699.487046165865, 5719.742611582489, 3535.876244331436, 3542.1498840278146, 3544.627814079536, 3556.946645800315, 3565.7682250653625, 6433.871322573522, 6465.353464653497, 6481.384268494486, 6490.740370385226, 6501.674916254168, 6859.0, 6888.276730943279, 6916.962455631696, 6917.031615573824, 6931.202911665122, 6515.902261466082, 6523.967380163069, 6547.181602299617, 6571.145751052332, 6586.80239592813, 6629.834254143685, 6635.8009259722285, 6712.885441086238, 6714.294999025227, 6742.42689371409, 6315.179026726496, 6595.4393876521035, 6619.602823830585, 6672.232693240339, 6679.432248258758, 6257.186565746424, 6370.4073981504625, 6391.2330520337855, 6448.5163612730175, 6483.902741458787, 4813.181759101031, 4875.9512404875495, 4879.121758083579, 4882.853514394574, 4898.975505122452, 6491.383318584727, 6601.240857301472, 6650.135482387259, 6682.766103186365, 6708.362705542965, 6180.907286390798, 6404.391582799627, 6456.12842266288, 6456.257530384066, 6556.672166391757, 6429.2284925807335, 6498.415142637185, 6504.837379065561, 6536.215654121535, 6586.80239592813, 6397.4562162216735, 6428.357164283534, 6455.4512866406885, 6485.319041500575, 6514.413702766774, 6503.642299673564, 6570.5400621956005, 6582.80251592453, 6598.802035938929, 6610.239822420291, 6284.0, 6321.273053598711, 6367.4081479630095, 6368.057742388431, 6446.5165112615805], "value": 4997.139122202766, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [823.4153750836906, 864.8745931839883, 869.6130222051187, 872.855978763504, 892.1569117184259, 18087.547811304725, 18948.810511894877, 19355.806441935594, 19503.707444388347, 19551.41345759626, 16638.66722665546, 16844.57888552787, 18281.45155645333, 20879.164833406645, 20939.476513087182, 951.4148798488914, 965.3049804141007, 972.2950860626025, 973.9415635061919, 980.62736160259, 949.7198326493666, 952.276270034775, 956.4309236004566, 960.812641534901, 967.5742673223759, 947.7488465556632, 1000.9649662261822, 1002.1431675917095, 1002.4937406609688, 1008.5058321422487, 982.4645568165367, 991.0733464210986, 994.6469003503761, 997.8104160209609, 1005.1104772276515, 705.9470539709491, 719.9964000180019, 725.4232884856551, 726.8873324634637, 728.3735987051132, 18327.17527711256, 18878.339258126038, 19095.331663391855, 19128.330508432136, 19323.0, 19735.703964440403, 20004.69992950107, 20321.695174572393, 20444.0, 20879.895600522053, 14252.144871307652, 15776.132312722795, 15836.920815395964, 16021.0, 16041.037537747656, 3661.377565813818, 3690.0, 3697.6672099510906, 3707.443883417482, 3711.9443208351895, 124829.37585312016, 128223.35888320592, 131958.3402082993, 132955.6704432953, 133443.33278333643, 15702.214889255492, 15791.526254212393, 16137.0, 16225.67548649044, 16330.183490825411, 28587.428251434856, 29099.0, 29137.85431072831, 29272.707272926997, 29394.265143371587, 8534.957325213334, 8648.78378040554, 8681.088485709037, 8689.217970382695, 8690.522021288889, 4202.726822756511, 4249.405083288342, 4331.978340108342, 4414.359917811899, 4434.889127771831, 5120.411152717411, 5174.767135478913, 5188.143956247177, 5188.533032027136, 5211.5830733541225, 1026.030401270792, 1047.4082143589, 1068.8931106889404, 1075.8924107589178, 1077.922077922078, 619.2816333053636, 635.6376865186799, 638.7540796793176, 650.9414152726183, 652.6345246661884, 11404.714882128013, 11660.300381976938, 11844.940775296069, 12111.939440302918, 12116.212446191146, 614.3334482086897, 623.6507555768784, 630.4420587779756, 636.7357546618194, 647.0811447744214, 5250.238715386324, 5282.947170528322, 5304.893902121936, 5451.700156491431, 5460.180972854104, 107213.0, 110517.0, 112009.0, 112892.0, 114411.0, 101721.49139254405, 103258.48370758098, 103334.0, 104024.0, 105646.0, 84930.15069849345, 86937.0, 88100.0, 88872.11127888638, 91125.08874911166, 9744.512774361396, 9792.755181120245, 9860.753481163028, 9980.2514811388, 10078.092971632588, 42043.369349460394, 42282.78858605687, 42348.0, 42468.5753142477, 44723.55276447194, 71890.64054679693, 73895.26104738883, 75238.0, 76007.0, 76558.61720691361, 18377.356792512197, 18494.16776245099, 18533.72199417037, 18577.349792757188, 18765.155567999198, 17702.468925932244, 19212.327568535035, 19285.22859085677, 19461.416157515298, 19546.218151273788, 18338.908305458386, 18654.253829846653, 18721.78308409949, 19025.809741902405, 19110.904445477685, 18778.906105469385, 19163.520911977314, 19194.13626386844, 19247.0, 19767.20931162795, 16184.514464566082, 17974.101294935463, 18349.54126146857, 18625.44123676292, 18872.622547549247, 12703.872961270268, 12877.613671589866, 13248.867511325148, 14095.154290742588, 14209.644758881112, 12980.935095324463, 13242.139260948008, 13369.0, 13469.528566500125, 13505.39225734864], "value": 8958.439495449531, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1559.9, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 118.0, 102.0, 116.0, 110.0, 111.0, 108.0, 99.0, 109.0, 119.0], "value": 110.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 121.0, 144.0, 191.0, 119.0, 153.0, 153.0, 119.0, 181.0, 124.0], "value": 145.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [173.0, 165.0, 168.0, 165.0, 167.0, 177.0, 169.0, 173.0, 168.0, 167.0], "value": 169.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 77.0, 75.0, 180.0, 75.0, 81.0, 90.0, 91.0, 98.0, 78.0], "value": 92.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 83.0, 133.0, 79.0, 86.0, 90.0, 132.0, 86.0, 79.0, 124.0], "value": 98.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [120.0, 115.0, 115.0, 118.0, 116.0, 126.0, 116.0, 118.0, 120.0, 116.0], "value": 118.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 149.0, 149.0, 149.0, 148.0, 149.0, 151.0, 154.0, 158.0, 155.0], "value": 151.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 103.0, 104.0, 95.0, 95.0, 96.0, 98.0, 94.0, 98.0, 104.0], "value": 98.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 54.0, 58.0, 55.0, 54.0, 54.0, 59.0, 56.0, 60.0, 54.0], "value": 55.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 63.0, 57.0, 57.0, 56.0, 68.0, 58.0, 57.0, 60.0, 61.0], "value": 60.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 82.0, 84.0, 77.0, 89.0, 76.0, 81.0, 81.0, 80.0], "value": 80.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [133.0, 123.0, 136.0, 131.0, 128.0, 124.0, 131.0, 136.0, 125.0, 162.0], "value": 132.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 173.0, 186.0, 188.0, 172.0, 177.0, 175.0, 171.0, 204.0, 175.0], "value": 179.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 66.0, 68.0, 66.0, 65.0, 71.0, 64.0, 64.0, 72.0, 68.0], "value": 67.8, "unit": "score"}]}]} 16:46:53 INFO - Return code: 0 16:46:53 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 16:46:53 INFO - # TBPL SUCCESS # 16:46:53 INFO - Running post-action listener: _package_coverage_data 16:46:53 INFO - Running post-action listener: _resource_record_post_action 16:46:53 INFO - [mozharness: 2017-08-22 23:46:53.837350Z] Finished run-tests step (success) 16:46:53 INFO - Running post-run listener: _resource_record_post_run 16:46:53 INFO - Total resource usage - Wall time: 1199s; CPU: 13.0%; Read bytes: 557056; Write bytes: 435695616; Read time: 1200; Write time: 404212 16:46:53 INFO - TinderboxPrint: CPU usage
13.3% 16:46:53 INFO - TinderboxPrint: I/O read bytes / time
557,056 / 1,200 16:46:53 INFO - TinderboxPrint: I/O write bytes / time
435,695,616 / 404,212 16:46:53 INFO - TinderboxPrint: CPU idle
8,281.4 (86.7%) 16:46:53 INFO - TinderboxPrint: CPU user
1,205.1 (12.6%) 16:46:53 INFO - TinderboxPrint: Swap in / out
0 / 0 16:46:53 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 4096; Write bytes: 106127360; Read time: 32; Write time: 135156 16:46:53 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 16:46:53 INFO - run-tests - Wall time: 1182s; CPU: 13.0%; Read bytes: 548864; Write bytes: 329568256; Read time: 1160; Write time: 269056 16:46:54 INFO - Running post-run listener: _upload_blobber_files 16:46:54 INFO - Blob upload gear active. 16:46:54 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:46:54 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 16:46:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 16:46:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 16:46:54 INFO - (blobuploader) - INFO - Open directory for files ... 16:46:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 16:46:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:46:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:46:55 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 16:46:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:46:55 INFO - (blobuploader) - INFO - Done attempting. 16:46:55 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 16:46:55 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:46:55 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:47:03 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 16:47:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:47:03 INFO - (blobuploader) - INFO - Done attempting. 16:47:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 16:47:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:47:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:47:03 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 16:47:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:47:03 INFO - (blobuploader) - INFO - Done attempting. 16:47:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 16:47:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:47:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:47:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 16:47:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:47:04 INFO - (blobuploader) - INFO - Done attempting. 16:47:04 INFO - (blobuploader) - INFO - Iteration through files over. 16:47:04 INFO - Return code: 0 16:47:04 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:47:04 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:47:04 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dcf9e61d8bca75f3b5a57d7927b892e4276119e307067c576d9e45ec9ff0c9fbcfa12752fb07f0931f84ffc9d977e24c149fef4a43a3e7f0f1b9d829512951b5", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4eba493755a7a67ac118ab23e34e3fcff7670409d9d23d171c496b5ed18b00534ef2eedccd76ee9b43f320772fc1cc005583dfc0af6637b9371110ca81a2fcf0", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4fcfc5d70d8269babf6cf81af0a4d9685e7aa7df6a4658629ac93f05b85c4fba40cefe934c7f0a8241ea144668b544a0b4cdcb59041d388da73bf20db02111ee", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/92d9316fe48a162109d3e1117e67f96b7a04ce67496ef6287c5e4497204fdc4b48042080b633629565acf7a01ca1ecd19d938abbd11f3ea33ab233a3ba15e8e2"} 16:47:04 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:47:04 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:47:04 INFO - Contents: 16:47:04 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dcf9e61d8bca75f3b5a57d7927b892e4276119e307067c576d9e45ec9ff0c9fbcfa12752fb07f0931f84ffc9d977e24c149fef4a43a3e7f0f1b9d829512951b5", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4eba493755a7a67ac118ab23e34e3fcff7670409d9d23d171c496b5ed18b00534ef2eedccd76ee9b43f320772fc1cc005583dfc0af6637b9371110ca81a2fcf0", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4fcfc5d70d8269babf6cf81af0a4d9685e7aa7df6a4658629ac93f05b85c4fba40cefe934c7f0a8241ea144668b544a0b4cdcb59041d388da73bf20db02111ee", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/92d9316fe48a162109d3e1117e67f96b7a04ce67496ef6287c5e4497204fdc4b48042080b633629565acf7a01ca1ecd19d938abbd11f3ea33ab233a3ba15e8e2"} 16:47:04 INFO - Running post-run listener: copy_logs_to_upload_dir 16:47:04 INFO - Copying logs to upload dir... 16:47:04 INFO - mkdir: /builds/slave/test/build/upload/logs 16:47:04 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1261.324210 ========= master_lag: -0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 1 secs) (at 2017-08-22 16:47:04.527758) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:04.531781) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dcf9e61d8bca75f3b5a57d7927b892e4276119e307067c576d9e45ec9ff0c9fbcfa12752fb07f0931f84ffc9d977e24c149fef4a43a3e7f0f1b9d829512951b5", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4eba493755a7a67ac118ab23e34e3fcff7670409d9d23d171c496b5ed18b00534ef2eedccd76ee9b43f320772fc1cc005583dfc0af6637b9371110ca81a2fcf0", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4fcfc5d70d8269babf6cf81af0a4d9685e7aa7df6a4658629ac93f05b85c4fba40cefe934c7f0a8241ea144668b544a0b4cdcb59041d388da73bf20db02111ee", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/92d9316fe48a162109d3e1117e67f96b7a04ce67496ef6287c5e4497204fdc4b48042080b633629565acf7a01ca1ecd19d938abbd11f3ea33ab233a3ba15e8e2"} build_url:https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011595 build_url: 'https://queue.taskcluster.net/v1/task/KRW8BKGhS3m3qhpOl1dvTA/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dcf9e61d8bca75f3b5a57d7927b892e4276119e307067c576d9e45ec9ff0c9fbcfa12752fb07f0931f84ffc9d977e24c149fef4a43a3e7f0f1b9d829512951b5", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4eba493755a7a67ac118ab23e34e3fcff7670409d9d23d171c496b5ed18b00534ef2eedccd76ee9b43f320772fc1cc005583dfc0af6637b9371110ca81a2fcf0", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4fcfc5d70d8269babf6cf81af0a4d9685e7aa7df6a4658629ac93f05b85c4fba40cefe934c7f0a8241ea144668b544a0b4cdcb59041d388da73bf20db02111ee", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/92d9316fe48a162109d3e1117e67f96b7a04ce67496ef6287c5e4497204fdc4b48042080b633629565acf7a01ca1ecd19d938abbd11f3ea33ab233a3ba15e8e2"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:04.558168) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:04.558487) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=52faae308a556c440401f8e5000001e8-1503444361.635677-1916818090 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004502 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-22 16:47:04.641357) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-22 16:47:04.641665) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-22 16:47:04.641948) ========= ========= Total master_lag: 0.16 =========