builder: mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s slave: talos-linux64-ix-029 starttime: 1505343459.98 results: success (0) revision: 8645a74bbbd06b67699317df1abf3897db0e43d5 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:39.979982) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:39.980749) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:39.981219) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:40.002738) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:40.003100) ========= 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=ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-13 15:57:40-- 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% 41.8M=0s 2017-09-13 15:57:40 (41.8 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.119561 ========= master_lag: 0.40 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:40.520655) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:40.521089) ========= 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=ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020589 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:40.563354) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:40.563714) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 8645a74bbbd06b67699317df1abf3897db0e43d5 --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 8645a74bbbd06b67699317df1abf3897db0e43d5 --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=ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-13 15:57:40,644 truncating revision to first 12 chars 2017-09-13 15:57:40,644 Setting DEBUG logging. 2017-09-13 15:57:40,644 attempt 1/10 2017-09-13 15:57:40,644 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/8645a74bbbd0?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-13 15:57:40,905 unpacking tar archive at: mozilla-central-8645a74bbbd0/testing/mozharness/ program finished with exit code 0 elapsedTime=0.538831 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:41.118905) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:41.119211) ========= script_repo_revision: 8645a74bbbd06b67699317df1abf3897db0e43d5 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:41.121664) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:41.121931) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-13 15:57:41.137673) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 42 secs) (at 2017-09-13 15:57:41.138027) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-stylo-disabled-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 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-stylo-disabled-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] 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=ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 15:57:41 INFO - MultiFileLogger online at 20170913 15:57:41 in /builds/slave/test 15:57:41 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-stylo-disabled-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 15:57:41 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:57:41 INFO - {'append_to_log': False, 15:57:41 INFO - 'base_work_dir': '/builds/slave/test', 15:57:41 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 15:57:41 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:57:41 INFO - 'branch': 'Firefox-Non-PGO', 15:57:41 INFO - 'buildbot_json_path': 'buildprops.json', 15:57:41 INFO - 'code_coverage': False, 15:57:41 INFO - 'config_files': ('talos/linux_config.py',), 15:57:41 INFO - 'default_actions': ('clobber', 15:57:41 INFO - 'read-buildbot-config', 15:57:41 INFO - 'download-and-extract', 15:57:41 INFO - 'populate-webroot', 15:57:41 INFO - 'create-virtualenv', 15:57:41 INFO - 'install', 15:57:41 INFO - 'setup-mitmproxy', 15:57:41 INFO - 'run-tests'), 15:57:41 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:57:41 INFO - 'disable_ccov_upload': False, 15:57:41 INFO - 'disable_stylo': False, 15:57:41 INFO - 'download_minidump_stackwalk': True, 15:57:41 INFO - 'download_symbols': 'ondemand', 15:57:41 INFO - 'enable_stylo': False, 15:57:41 INFO - 'enable_webrender': False, 15:57:41 INFO - 'exes': {'tooltool.py': '/tools/tooltool.py'}, 15:57:41 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:57:41 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:57:41 INFO - 'gecko_profile': False, 15:57:41 INFO - 'gecko_profile_interval': 0, 15:57:41 INFO - 'installer_path': 'installer.exe', 15:57:41 INFO - 'log_level': 'info', 15:57:41 INFO - 'log_name': 'talos', 15:57:41 INFO - 'log_to_console': True, 15:57:41 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 15:57:41 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 15:57:41 INFO - 'opt_config_files': (), 15:57:41 INFO - 'pip_index': False, 15:57:41 INFO - 'suite': 'dromaeojs-stylo-disabled-e10s', 15:57:41 INFO - 'system_bits': '32', 15:57:41 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:57:41 INFO - 'title': 'talos-linux64-ix-029', 15:57:41 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:57:41 INFO - 'use_talos_json': True, 15:57:41 INFO - 'verify': 'False', 15:57:41 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:57:41 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:57:41 INFO - 'work_dir': 'build'} 15:57:41 INFO - [mozharness: 2017-09-13 22:57:41.358858Z] Running clobber step. 15:57:41 INFO - Running pre-action listener: _resource_record_pre_action 15:57:41 INFO - Running main action method: clobber 15:57:41 INFO - rmtree: /builds/slave/test/build 15:57:41 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:57:42 INFO - Running post-action listener: _resource_record_post_action 15:57:42 INFO - [mozharness: 2017-09-13 22:57:42.373240Z] Finished clobber step (success) 15:57:42 INFO - [mozharness: 2017-09-13 22:57:42.373337Z] Running read-buildbot-config step. 15:57:42 INFO - Running pre-action listener: _resource_record_pre_action 15:57:42 INFO - Running main action method: read_buildbot_config 15:57:42 INFO - Using buildbot properties: 15:57:42 INFO - { 15:57:42 INFO - "project": "", 15:57:42 INFO - "product": "firefox", 15:57:42 INFO - "who": "archaeopteryx@coole-files.de", 15:57:42 INFO - "installer_path": "public/build/target.tar.bz2", 15:57:42 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s", 15:57:42 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 15:57:42 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-stylo-disabled-e10s", 15:57:42 INFO - "stage_platform": "linux64", 15:57:42 INFO - "basedir": "/builds/slave/test", 15:57:42 INFO - "buildnumber": 14, 15:57:42 INFO - "platform": "ubuntu64_hw", 15:57:42 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 15:57:42 INFO - "slavebuilddir": "test", 15:57:42 INFO - "taskId": "AMyEAAprSPSQZaCZ8D0swQ", 15:57:42 INFO - "branch": "mozilla-central", 15:57:42 INFO - "script_repo_revision": "production", 15:57:42 INFO - "revision": "8645a74bbbd06b67699317df1abf3897db0e43d5", 15:57:42 INFO - "slavename": "talos-linux64-ix-029", 15:57:42 INFO - "repo_path": "mozilla-central" 15:57:42 INFO - } 15:57:42 INFO - Finding installer, test and symbols from parent task. 15:57:42 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/AMyEAAprSPSQZaCZ8D0swQ'}, attempt #1 15:57:42 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/AMyEAAprSPSQZaCZ8D0swQ'}, attempt #1 15:57:43 INFO - Task dependencies: A1V4MAzpSR2fT4tPLmTCBw 15:57:43 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw'}, attempt #1 15:57:43 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.tar.bz2 15:57:43 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.test_packages.json 15:57:43 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.crashreporter-symbols.zip 15:57:43 INFO - Running post-action listener: _resource_record_post_action 15:57:43 INFO - [mozharness: 2017-09-13 22:57:43.757127Z] Finished read-buildbot-config step (success) 15:57:43 INFO - [mozharness: 2017-09-13 22:57:43.757355Z] Running download-and-extract step. 15:57:43 INFO - Running pre-action listener: _resource_record_pre_action 15:57:43 INFO - Running main action method: download_and_extract 15:57:43 INFO - mkdir: /builds/slave/test/build/tests 15:57:43 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')]} 15:57:43 INFO - trying https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.test_packages.json 15:57:43 INFO - Downloading https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 15:57:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 15:57:44 INFO - Downloaded 989 bytes. 15:57:44 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 15:57:44 INFO - Using the following test package requirements: 15:57:44 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 15:57:44 INFO - u'common': [u'target.common.tests.zip'], 15:57:44 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 15:57:44 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 15:57:44 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 15:57:44 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 15:57:44 INFO - u'mozbase': [u'target.common.tests.zip'], 15:57:44 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 15:57:44 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 15:57:44 INFO - u'web-platform': [u'target.common.tests.zip', 15:57:44 INFO - u'target.web-platform.tests.tar.gz'], 15:57:44 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 15:57:44 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 15:57:44 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.common.tests.zip 15:57:44 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.common.tests.zip'}, attempt #1 15:57:44 INFO - Fetch https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.common.tests.zip into memory 15:57:45 INFO - Content-Length response header: 54572657 15:57:45 INFO - Bytes received: 54572657 15:57:56 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.talos.tests.zip 15:57:56 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 15:57:56 INFO - Fetch https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.talos.tests.zip into memory 15:57:56 INFO - Content-Length response header: 14500351 15:57:56 INFO - Bytes received: 14500351 15:57:57 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')]} 15:57:57 INFO - trying https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.tar.bz2 15:57:57 INFO - Downloading https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 15:57:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 15:57:58 INFO - Downloaded 61287064 bytes. 15:57:58 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.tar.bz2 15:57:58 INFO - mkdir: /builds/slave/test/properties 15:57:58 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:57:58 INFO - Writing to file /builds/slave/test/properties/build_url 15:57:58 INFO - Contents: 15:57:58 INFO - build_url:https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.tar.bz2 15:57:58 INFO - Running post-action listener: _resource_record_post_action 15:57:58 INFO - Running post-action listener: find_tests_for_verification 15:57:58 INFO - Running post-action listener: set_extra_try_arguments 15:57:58 INFO - [mozharness: 2017-09-13 22:57:58.328408Z] Finished download-and-extract step (success) 15:57:58 INFO - [mozharness: 2017-09-13 22:57:58.328505Z] Running populate-webroot step. 15:57:58 INFO - Running pre-action listener: _resource_record_pre_action 15:57:58 INFO - Running main action method: populate_webroot 15:57:58 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 15:57:58 INFO - 'chromez-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['tresize', 15:57:58 INFO - 'tcanvasmark']}, 15:57:58 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 15:57:58 INFO - 'dromaeojs-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['dromaeo_css', 15:57:58 INFO - 'kraken']}, 15:57:58 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 15:57:58 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:57:58 INFO - 'g1-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 15:57:58 INFO - 'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:57:58 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 15:57:58 INFO - 'tests': ['damp', 'tps']}, 15:57:58 INFO - 'g2-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 15:57:58 INFO - 'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['damp', 'tps']}, 15:57:58 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:57:58 INFO - 'g3-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['dromaeo_dom']}, 15:57:58 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 15:57:58 INFO - 'g4-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['basic_compositor_video', 15:57:58 INFO - 'glvideo']}, 15:57:58 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 15:57:58 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 15:57:58 INFO - 'g5-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 15:57:58 INFO - 'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['ts_paint_webext', 15:57:58 INFO - 'tp5o_webext']}, 15:57:58 INFO - 'other-e10s': {'tests': ['a11yr', 15:57:58 INFO - 'ts_paint', 15:57:58 INFO - 'tpaint', 15:57:58 INFO - 'sessionrestore', 15:57:58 INFO - 'sessionrestore_many_windows', 15:57:58 INFO - 'sessionrestore_no_auto_restore', 15:57:58 INFO - 'tabpaint']}, 15:57:58 INFO - 'other-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['a11yr', 15:57:58 INFO - 'ts_paint', 15:57:58 INFO - 'tpaint', 15:57:58 INFO - 'sessionrestore', 15:57:58 INFO - 'sessionrestore_many_windows', 15:57:58 INFO - 'sessionrestore_no_auto_restore', 15:57:58 INFO - 'tabpaint']}, 15:57:58 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 15:57:58 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 15:57:58 INFO - 'perf-reftest-singletons-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['bloom_basic_singleton']}, 15:57:58 INFO - 'perf-reftest-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['bloom_basic']}, 15:57:58 INFO - 'svgr-e10s': {'tests': ['tsvgx', 15:57:58 INFO - 'tsvgr_opacity', 15:57:58 INFO - 'tart', 15:57:58 INFO - 'tscrollx', 15:57:58 INFO - 'tsvg_static']}, 15:57:58 INFO - 'svgr-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['tsvgx', 15:57:58 INFO - 'tsvgr_opacity', 15:57:58 INFO - 'tart', 15:57:58 INFO - 'tscrollx', 15:57:58 INFO - 'tsvg_static']}, 15:57:58 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 15:57:58 INFO - 'tp5o-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 15:57:58 INFO - 'talos_options': ['--disable-stylo'], 15:57:58 INFO - 'tests': ['tp5o']}, 15:57:58 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 15:57:58 INFO - 'talos_options': ['--mitmproxy', 15:57:58 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 15:57:58 INFO - '--firstNonBlankPaint'], 15:57:58 INFO - 'tests': ['tp6_google', 15:57:58 INFO - 'tp6_youtube', 15:57:58 INFO - 'tp6_amazon', 15:57:58 INFO - 'tp6_facebook']}, 15:57:58 INFO - 'tp6-stylo-disabled-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 15:57:58 INFO - 'talos_options': ['--disable-stylo', 15:57:58 INFO - '--mitmproxy', 15:57:58 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 15:57:58 INFO - '--firstNonBlankPaint'], 15:57:58 INFO - 'tests': ['tp6_google', 15:57:58 INFO - 'tp6_youtube', 15:57:58 INFO - 'tp6_amazon', 15:57:58 INFO - 'tp6_facebook']}, 15:57:58 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 15:57:58 INFO - 'talos_options': ['--stylo-threads=1', 15:57:58 INFO - '--mitmproxy', 15:57:58 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 15:57:58 INFO - '--firstNonBlankPaint'], 15:57:58 INFO - 'tests': ['tp6_google', 15:57:58 INFO - 'tp6_youtube', 15:57:58 INFO - 'tp6_amazon', 15:57:58 INFO - 'tp6_facebook']}, 15:57:58 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 15:57:58 INFO - 'talos_options': ['--xperf_path', 15:57:58 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:57:58 INFO - 'tests': ['tp5n']}, 15:57:58 INFO - 'xperf-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 15:57:58 INFO - 'talos_options': ['--disable-stylo', 15:57:58 INFO - '--xperf_path', 15:57:58 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:57:58 INFO - 'tests': ['tp5n']}}} 15:57:58 INFO - Running post-action listener: _resource_record_post_action 15:57:58 INFO - [mozharness: 2017-09-13 22:57:58.343499Z] Finished populate-webroot step (success) 15:57:58 INFO - [mozharness: 2017-09-13 22:57:58.343588Z] Running create-virtualenv step. 15:57:58 INFO - Running pre-action listener: _resource_record_pre_action 15:57:58 INFO - Running main action method: create_virtualenv 15:57:58 INFO - Creating virtualenv /builds/slave/test/build/venv 15:57:58 INFO - Running command: ['virtualenv', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 15:57:58 INFO - Copy/paste: virtualenv --no-site-packages --distribute /builds/slave/test/build/venv 15:57:58 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 15:57:58 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:57:58 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:57:59 INFO - Installing distribute.............................................................................................................................................................................................done. 15:58:00 INFO - Installing pip...............done. 15:58:00 INFO - Return code: 0 15:58:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 15:58:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 15:58:00 INFO - Reading from file tmpfile_stdout 15:58:00 INFO - Output received: 15:58:00 INFO - pip 1.1 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.1-py2.7.egg (python 2.7) 15:58:00 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:58:00 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')]} 15:58:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:58:00 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')]} 15:58:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:58:00 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 0xd781f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf41a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, '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': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', '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 15:58:00 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 15:58:00 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 15:58:00 INFO - Using env: {'DISPLAY': ':0', 15:58:00 INFO - 'HOME': '/home/cltbld', 15:58:00 INFO - 'LANG': 'en_US.UTF-8', 15:58:00 INFO - 'LANGUAGE': 'en_US:en', 15:58:00 INFO - 'LOGNAME': 'cltbld', 15:58:00 INFO - 'MAIL': '/var/mail/cltbld', 15:58:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:00 INFO - 'MOZ_NO_REMOTE': '1', 15:58:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:00 INFO - 'NO_EM_RESTART': '1', 15:58:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:00 INFO - 'PWD': '/builds/slave/test', 15:58:00 INFO - 'SHELL': '/bin/bash', 15:58:00 INFO - 'SHLVL': '1', 15:58:00 INFO - 'TERM': 'linux', 15:58:00 INFO - 'TMOUT': '86400', 15:58:00 INFO - 'USER': 'cltbld', 15:58:00 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:00 INFO - '_': '/tools/buildbot/bin/python'} 15:58:01 INFO - Ignoring indexes: http://pypi.python.org/simple/ 15:58:01 INFO - Downloading/unpacking pip>=1.5 15:58:01 INFO - Running setup.py egg_info for package pip 15:58:01 INFO - warning: no files found matching 'pip/cacert.pem' 15:58:01 INFO - warning: no files found matching '*.html' under directory 'docs' 15:58:01 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 15:58:01 INFO - no previously-included directories found matching 'docs/_build/_sources' 15:58:01 INFO - Installing collected packages: pip 15:58:01 INFO - Found existing installation: pip 1.1 15:58:01 INFO - Uninstalling pip: 15:58:01 INFO - Successfully uninstalled pip 15:58:01 INFO - Running setup.py install for pip 15:58:01 INFO - warning: no files found matching 'pip/cacert.pem' 15:58:01 INFO - warning: no files found matching '*.html' under directory 'docs' 15:58:01 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 15:58:01 INFO - no previously-included directories found matching 'docs/_build/_sources' 15:58:01 INFO - Installing pip script to /builds/slave/test/build/venv/bin 15:58:01 INFO - Installing pip2.7 script to /builds/slave/test/build/venv/bin 15:58:01 INFO - Installing pip2 script to /builds/slave/test/build/venv/bin 15:58:01 INFO - Successfully installed pip 15:58:01 INFO - Cleaning up... 15:58:01 INFO - Return code: 0 15:58:01 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 15:58:01 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')]} 15:58:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:58:01 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')]} 15:58:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:58:01 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 0xd781f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf41a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, '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': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', '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 15:58:01 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 15:58:01 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 15:58:01 INFO - Using env: {'DISPLAY': ':0', 15:58:01 INFO - 'HOME': '/home/cltbld', 15:58:01 INFO - 'LANG': 'en_US.UTF-8', 15:58:01 INFO - 'LANGUAGE': 'en_US:en', 15:58:01 INFO - 'LOGNAME': 'cltbld', 15:58:01 INFO - 'MAIL': '/var/mail/cltbld', 15:58:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:01 INFO - 'MOZ_NO_REMOTE': '1', 15:58:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:01 INFO - 'NO_EM_RESTART': '1', 15:58:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:01 INFO - 'PWD': '/builds/slave/test', 15:58:01 INFO - 'SHELL': '/bin/bash', 15:58:01 INFO - 'SHLVL': '1', 15:58:01 INFO - 'TERM': 'linux', 15:58:01 INFO - 'TMOUT': '86400', 15:58:01 INFO - 'USER': 'cltbld', 15:58:01 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:01 INFO - '_': '/tools/buildbot/bin/python'} 15:58:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:58:01 INFO - Downloading/unpacking psutil>=3.1.1 15:58:01 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 15:58:01 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 15:58:01 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 15:58:01 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 15:58:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:58:02 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:58:02 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:58:02 INFO - Installing collected packages: psutil 15:58:02 INFO - Running setup.py install for psutil 15:58:03 INFO - building 'psutil._psutil_linux' extension 15:58:03 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 15:58:03 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 15:58:03 INFO - building 'psutil._psutil_posix' extension 15:58:03 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 15:58:03 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 15:58:03 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:58:03 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:58:03 INFO - Successfully installed psutil 15:58:03 INFO - Cleaning up... 15:58:03 INFO - Return code: 0 15:58:03 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 15:58:03 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')]} 15:58:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:58:03 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')]} 15:58:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:58:03 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 0xd781f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf41a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, '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': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', '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 15:58:03 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 15:58:03 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 15:58:03 INFO - Using env: {'DISPLAY': ':0', 15:58:03 INFO - 'HOME': '/home/cltbld', 15:58:03 INFO - 'LANG': 'en_US.UTF-8', 15:58:03 INFO - 'LANGUAGE': 'en_US:en', 15:58:03 INFO - 'LOGNAME': 'cltbld', 15:58:03 INFO - 'MAIL': '/var/mail/cltbld', 15:58:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:03 INFO - 'MOZ_NO_REMOTE': '1', 15:58:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:03 INFO - 'NO_EM_RESTART': '1', 15:58:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:03 INFO - 'PWD': '/builds/slave/test', 15:58:03 INFO - 'SHELL': '/bin/bash', 15:58:03 INFO - 'SHLVL': '1', 15:58:03 INFO - 'TERM': 'linux', 15:58:03 INFO - 'TMOUT': '86400', 15:58:03 INFO - 'USER': 'cltbld', 15:58:03 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:03 INFO - '_': '/tools/buildbot/bin/python'} 15:58:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:58:03 INFO - Downloading/unpacking mozsystemmonitor==0.3 15:58:03 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 15:58:03 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 15:58:03 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 15:58:03 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 15:58:04 INFO - Downloading mozsystemmonitor-0.3.tar.gz 15:58:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:58:04 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 15:58:04 INFO - Installing collected packages: mozsystemmonitor 15:58:04 INFO - Running setup.py install for mozsystemmonitor 15:58:05 INFO - Successfully installed mozsystemmonitor 15:58:05 INFO - Cleaning up... 15:58:07 INFO - Return code: 0 15:58:07 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 15:58:07 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')]} 15:58:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:58:07 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')]} 15:58:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:58:07 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 0xd781f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf41a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, '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': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', '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 15:58:07 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 15:58:07 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 15:58:07 INFO - Using env: {'DISPLAY': ':0', 15:58:07 INFO - 'HOME': '/home/cltbld', 15:58:07 INFO - 'LANG': 'en_US.UTF-8', 15:58:07 INFO - 'LANGUAGE': 'en_US:en', 15:58:07 INFO - 'LOGNAME': 'cltbld', 15:58:07 INFO - 'MAIL': '/var/mail/cltbld', 15:58:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:07 INFO - 'MOZ_NO_REMOTE': '1', 15:58:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:07 INFO - 'NO_EM_RESTART': '1', 15:58:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:07 INFO - 'PWD': '/builds/slave/test', 15:58:07 INFO - 'SHELL': '/bin/bash', 15:58:07 INFO - 'SHLVL': '1', 15:58:07 INFO - 'TERM': 'linux', 15:58:07 INFO - 'TMOUT': '86400', 15:58:07 INFO - 'USER': 'cltbld', 15:58:07 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:07 INFO - '_': '/tools/buildbot/bin/python'} 15:58:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:58:07 INFO - Downloading/unpacking jsonschema==2.5.1 15:58:07 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 15:58:07 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 15:58:07 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 15:58:07 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 15:58:08 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:58:08 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 15:58:08 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 15:58:08 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 15:58:08 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 15:58:08 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 15:58:08 INFO - Downloading functools32-3.2.3-2.tar.gz 15:58:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:58:08 INFO - warning: no files found matching '*.txt' 15:58:08 INFO - no previously-included directories found matching 'build' 15:58:08 INFO - no previously-included directories found matching 'dist' 15:58:08 INFO - no previously-included directories found matching '.git*' 15:58:08 INFO - Installing collected packages: jsonschema, functools32 15:58:09 INFO - Running setup.py install for functools32 15:58:09 INFO - warning: no files found matching '*.txt' 15:58:09 INFO - no previously-included directories found matching 'build' 15:58:09 INFO - no previously-included directories found matching 'dist' 15:58:09 INFO - no previously-included directories found matching '.git*' 15:58:09 INFO - Successfully installed jsonschema functools32 15:58:09 INFO - Cleaning up... 15:58:09 INFO - Return code: 0 15:58:09 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 15:58:09 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')]} 15:58:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:58:09 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')]} 15:58:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:58:09 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 0xd781f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf41a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, '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': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', '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 15:58:09 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 15:58:09 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 15:58:09 INFO - Using env: {'DISPLAY': ':0', 15:58:09 INFO - 'HOME': '/home/cltbld', 15:58:09 INFO - 'LANG': 'en_US.UTF-8', 15:58:09 INFO - 'LANGUAGE': 'en_US:en', 15:58:09 INFO - 'LOGNAME': 'cltbld', 15:58:09 INFO - 'MAIL': '/var/mail/cltbld', 15:58:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:09 INFO - 'MOZ_NO_REMOTE': '1', 15:58:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:09 INFO - 'NO_EM_RESTART': '1', 15:58:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:09 INFO - 'PWD': '/builds/slave/test', 15:58:09 INFO - 'SHELL': '/bin/bash', 15:58:09 INFO - 'SHLVL': '1', 15:58:09 INFO - 'TERM': 'linux', 15:58:09 INFO - 'TMOUT': '86400', 15:58:09 INFO - 'USER': 'cltbld', 15:58:09 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:09 INFO - '_': '/tools/buildbot/bin/python'} 15:58:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:58:09 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 15:58:09 INFO - Cleaning up... 15:58:09 INFO - Return code: 0 15:58:09 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:58:09 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')]} 15:58:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:58:09 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')]} 15:58:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:58:09 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 0xd781f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf41a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, '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': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', '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 15:58:09 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 15:58:09 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 15:58:09 INFO - Using env: {'DISPLAY': ':0', 15:58:09 INFO - 'HOME': '/home/cltbld', 15:58:09 INFO - 'LANG': 'en_US.UTF-8', 15:58:09 INFO - 'LANGUAGE': 'en_US:en', 15:58:09 INFO - 'LOGNAME': 'cltbld', 15:58:09 INFO - 'MAIL': '/var/mail/cltbld', 15:58:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:09 INFO - 'MOZ_NO_REMOTE': '1', 15:58:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:09 INFO - 'NO_EM_RESTART': '1', 15:58:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:09 INFO - 'PWD': '/builds/slave/test', 15:58:09 INFO - 'SHELL': '/bin/bash', 15:58:09 INFO - 'SHLVL': '1', 15:58:09 INFO - 'TERM': 'linux', 15:58:09 INFO - 'TMOUT': '86400', 15:58:09 INFO - 'USER': 'cltbld', 15:58:09 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:09 INFO - '_': '/tools/buildbot/bin/python'} 15:58:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:58:10 INFO - Downloading/unpacking blobuploader==1.2.4 15:58:10 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 15:58:10 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 15:58:10 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 15:58:10 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 15:58:11 INFO - Downloading blobuploader-1.2.4.tar.gz 15:58:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:58:12 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:58:12 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 15:58:12 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 15:58:12 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 15:58:12 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 15:58:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:58:12 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:58:12 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 15:58:12 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 15:58:12 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 15:58:12 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 15:58:12 INFO - Downloading docopt-0.6.1.tar.gz 15:58:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:58:12 INFO - Installing collected packages: blobuploader, requests, docopt 15:58:12 INFO - Running setup.py install for blobuploader 15:58:12 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:58:12 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:58:12 INFO - Running setup.py install for requests 15:58:12 INFO - Running setup.py install for docopt 15:58:13 INFO - Successfully installed blobuploader requests docopt 15:58:13 INFO - Cleaning up... 15:58:13 INFO - Return code: 0 15:58:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:58:13 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')]} 15:58:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:58:13 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')]} 15:58:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:58:13 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 0xd781f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf41a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, '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': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', '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 15:58:13 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 15:58:13 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 15:58:13 INFO - Using env: {'DISPLAY': ':0', 15:58:13 INFO - 'HOME': '/home/cltbld', 15:58:13 INFO - 'LANG': 'en_US.UTF-8', 15:58:13 INFO - 'LANGUAGE': 'en_US:en', 15:58:13 INFO - 'LOGNAME': 'cltbld', 15:58:13 INFO - 'MAIL': '/var/mail/cltbld', 15:58:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:13 INFO - 'MOZ_NO_REMOTE': '1', 15:58:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:13 INFO - 'NO_EM_RESTART': '1', 15:58:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:13 INFO - 'PWD': '/builds/slave/test', 15:58:13 INFO - 'SHELL': '/bin/bash', 15:58:13 INFO - 'SHLVL': '1', 15:58:13 INFO - 'TERM': 'linux', 15:58:13 INFO - 'TMOUT': '86400', 15:58:13 INFO - 'USER': 'cltbld', 15:58:13 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:13 INFO - '_': '/tools/buildbot/bin/python'} 15:58:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:58:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:58:13 INFO - Running setup.py (path:/tmp/pip-gH6JQu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:58:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:58:13 INFO - Running setup.py (path:/tmp/pip-eop_eS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:58:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:58:13 INFO - Running setup.py (path:/tmp/pip-t6Mwxr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:58:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:58:13 INFO - Running setup.py (path:/tmp/pip-S5PWQm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:58:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:58:13 INFO - Running setup.py (path:/tmp/pip-IuBbeC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:58:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:58:13 INFO - Running setup.py (path:/tmp/pip-phHAxp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:58:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:58:13 INFO - Running setup.py (path:/tmp/pip-_Jdzhh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:58:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:58:13 INFO - Running setup.py (path:/tmp/pip-3B0ZsB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:58:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:58:13 INFO - Running setup.py (path:/tmp/pip-N7WPVP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:58:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:58:13 INFO - Running setup.py (path:/tmp/pip-Xa7wDv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:58:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:58:14 INFO - Running setup.py (path:/tmp/pip-wmT3Ke-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:58:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:58:14 INFO - Running setup.py (path:/tmp/pip-P1EIXZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:58:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:58:14 INFO - Running setup.py (path:/tmp/pip-23qM_J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:58:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:58:14 INFO - Running setup.py (path:/tmp/pip-74Fvpx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:58:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:58:14 INFO - Running setup.py (path:/tmp/pip-r2opn1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:58:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:58:14 INFO - Running setup.py (path:/tmp/pip-W7ym5T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:58:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:58:14 INFO - Running setup.py (path:/tmp/pip-4xEVWV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:58:14 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:58:14 INFO - Running setup.py install for manifestparser 15:58:14 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:58:14 INFO - Running setup.py install for mozcrash 15:58:14 INFO - Running setup.py install for mozdebug 15:58:14 INFO - Running setup.py install for mozdevice 15:58:14 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:58:14 INFO - Running setup.py install for mozfile 15:58:15 INFO - Running setup.py install for mozhttpd 15:58:15 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Running setup.py install for mozinfo 15:58:15 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Running setup.py install for mozInstall 15:58:15 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Running setup.py install for mozleak 15:58:15 INFO - Running setup.py install for mozlog 15:58:15 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Running setup.py install for moznetwork 15:58:15 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Running setup.py install for mozprocess 15:58:15 INFO - Running setup.py install for mozprofile 15:58:15 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:58:15 INFO - Running setup.py install for mozrunner 15:58:16 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:58:16 INFO - Running setup.py install for mozscreenshot 15:58:16 INFO - Running setup.py install for moztest 15:58:16 INFO - Running setup.py install for mozversion 15:58:16 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:58:16 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:58:16 INFO - Cleaning up... 15:58:16 INFO - Return code: 0 15:58:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:58:16 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')]} 15:58:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:58:16 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')]} 15:58:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:58:16 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 0xd781f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf41a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, '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': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', '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 15:58:16 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 15:58:16 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 15:58:16 INFO - Using env: {'DISPLAY': ':0', 15:58:16 INFO - 'HOME': '/home/cltbld', 15:58:16 INFO - 'LANG': 'en_US.UTF-8', 15:58:16 INFO - 'LANGUAGE': 'en_US:en', 15:58:16 INFO - 'LOGNAME': 'cltbld', 15:58:16 INFO - 'MAIL': '/var/mail/cltbld', 15:58:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:16 INFO - 'MOZ_NO_REMOTE': '1', 15:58:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:16 INFO - 'NO_EM_RESTART': '1', 15:58:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:16 INFO - 'PWD': '/builds/slave/test', 15:58:16 INFO - 'SHELL': '/bin/bash', 15:58:16 INFO - 'SHLVL': '1', 15:58:16 INFO - 'TERM': 'linux', 15:58:16 INFO - 'TMOUT': '86400', 15:58:16 INFO - 'USER': 'cltbld', 15:58:16 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:16 INFO - '_': '/tools/buildbot/bin/python'} 15:58:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:58:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:58:16 INFO - Running setup.py (path:/tmp/pip-NFoRye-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:58:16 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)) 15:58:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:58:16 INFO - Running setup.py (path:/tmp/pip-YTu9T0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:58:16 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)) 15:58:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:58:16 INFO - Running setup.py (path:/tmp/pip-reYyRX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:58:16 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)) 15:58:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:58:16 INFO - Running setup.py (path:/tmp/pip-7hYGQZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:58:16 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)) 15:58:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:58:16 INFO - Running setup.py (path:/tmp/pip-hHP_jI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:58:16 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)) 15:58:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:58:16 INFO - Running setup.py (path:/tmp/pip-ZZjlmx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:58:16 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)) 15:58:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:58:16 INFO - Running setup.py (path:/tmp/pip-XZhxMs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:58:17 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)) 15:58:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:58:17 INFO - Running setup.py (path:/tmp/pip-qEeOGk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:58:17 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)) 15:58:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:58:17 INFO - Running setup.py (path:/tmp/pip-dUF0WP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:58:17 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)) 15:58:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:58:17 INFO - Running setup.py (path:/tmp/pip-EEmfE6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:58:17 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)) 15:58:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:58:17 INFO - Running setup.py (path:/tmp/pip-GmhlDt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:58:17 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)) 15:58:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:58:17 INFO - Running setup.py (path:/tmp/pip-TS7cME-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:58:17 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)) 15:58:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:58:17 INFO - Running setup.py (path:/tmp/pip-AiiPCG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:58:17 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)) 15:58:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:58:17 INFO - Running setup.py (path:/tmp/pip-2_B8DP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:58:17 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)) 15:58:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:58:17 INFO - Running setup.py (path:/tmp/pip-eYpGAe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:58:17 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)) 15:58:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:58:17 INFO - Running setup.py (path:/tmp/pip-OJHn_d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:58:17 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)) 15:58:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:58:17 INFO - Running setup.py (path:/tmp/pip-riJYxx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:58:17 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)) 15:58:17 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)) 15:58:17 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)) 15:58:17 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)) 15:58:17 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)) 15:58:17 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)) 15:58:17 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)) 15:58:17 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:58:17 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 15:58:17 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 15:58:17 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 15:58:17 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 15:58:18 INFO - Downloading blessings-1.6.tar.gz 15:58:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:58:18 INFO - Installing collected packages: blessings 15:58:18 INFO - Running setup.py install for blessings 15:58:19 INFO - Successfully installed blessings 15:58:19 INFO - Cleaning up... 15:58:19 INFO - Return code: 0 15:58:19 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:58:19 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:58:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:58:19 INFO - Reading from file tmpfile_stdout 15:58:19 INFO - Current package versions: 15:58:19 INFO - argparse == 1.2.1 15:58:19 INFO - blessings == 1.6 15:58:19 INFO - blobuploader == 1.2.4 15:58:19 INFO - docopt == 0.6.1 15:58:19 INFO - functools32 == 3.2.3-2 15:58:19 INFO - jsonschema == 2.5.1 15:58:19 INFO - manifestparser == 1.1 15:58:19 INFO - mozInstall == 1.13 15:58:19 INFO - mozcrash == 1.0 15:58:19 INFO - mozdebug == 0.1 15:58:19 INFO - mozdevice == 0.51 15:58:19 INFO - mozfile == 1.2 15:58:19 INFO - mozhttpd == 0.7 15:58:19 INFO - mozinfo == 0.10 15:58:19 INFO - mozleak == 0.1 15:58:19 INFO - mozlog == 3.5 15:58:19 INFO - moznetwork == 0.27 15:58:19 INFO - mozprocess == 0.25 15:58:19 INFO - mozprofile == 0.28 15:58:19 INFO - mozrunner == 6.13 15:58:19 INFO - mozscreenshot == 0.1 15:58:19 INFO - mozsystemmonitor == 0.3 15:58:19 INFO - moztest == 0.8 15:58:19 INFO - mozversion == 1.4 15:58:19 INFO - psutil == 3.1.1 15:58:19 INFO - requests == 1.2.3 15:58:19 INFO - wsgiref == 0.1.2 15:58:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:58:19 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')]} 15:58:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:58:19 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')]} 15:58:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:58:19 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 0xd781f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf41a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, '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': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', '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 15:58:19 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 15:58:19 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 15:58:19 INFO - Using env: {'DISPLAY': ':0', 15:58:19 INFO - 'HOME': '/home/cltbld', 15:58:19 INFO - 'LANG': 'en_US.UTF-8', 15:58:19 INFO - 'LANGUAGE': 'en_US:en', 15:58:19 INFO - 'LOGNAME': 'cltbld', 15:58:19 INFO - 'MAIL': '/var/mail/cltbld', 15:58:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:19 INFO - 'MOZ_NO_REMOTE': '1', 15:58:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:19 INFO - 'NO_EM_RESTART': '1', 15:58:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:19 INFO - 'PWD': '/builds/slave/test', 15:58:19 INFO - 'SHELL': '/bin/bash', 15:58:19 INFO - 'SHLVL': '1', 15:58:19 INFO - 'TERM': 'linux', 15:58:19 INFO - 'TMOUT': '86400', 15:58:19 INFO - 'USER': 'cltbld', 15:58:19 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:19 INFO - '_': '/tools/buildbot/bin/python'} 15:58:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:58:19 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)) 15:58:19 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)) 15:58:19 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)) 15:58:19 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)) 15:58:19 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)) 15:58:19 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)) 15:58:19 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)) 15:58:19 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)) 15:58:19 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)) 15:58:19 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 15:58:19 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 15:58:19 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 15:58:19 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 15:58:19 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 15:58:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 15:58:20 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)) 15:58:20 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)) 15:58:20 INFO - Installing collected packages: simplejson 15:58:20 INFO - Running setup.py install for simplejson 15:58:20 INFO - building 'simplejson._speedups' extension 15:58:20 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 15:58:21 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 15:58:21 INFO - Successfully installed simplejson 15:58:21 INFO - Cleaning up... 15:58:21 INFO - Return code: 0 15:58:21 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 15:58:21 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')]} 15:58:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:58:21 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')]} 15:58:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:58:21 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 0xd781f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf41a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10e4a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, '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': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', '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 15:58:21 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 15:58:21 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 15:58:21 INFO - Using env: {'DISPLAY': ':0', 15:58:21 INFO - 'HOME': '/home/cltbld', 15:58:21 INFO - 'LANG': 'en_US.UTF-8', 15:58:21 INFO - 'LANGUAGE': 'en_US:en', 15:58:21 INFO - 'LOGNAME': 'cltbld', 15:58:21 INFO - 'MAIL': '/var/mail/cltbld', 15:58:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:21 INFO - 'MOZ_NO_REMOTE': '1', 15:58:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:21 INFO - 'NO_EM_RESTART': '1', 15:58:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:21 INFO - 'PWD': '/builds/slave/test', 15:58:21 INFO - 'SHELL': '/bin/bash', 15:58:21 INFO - 'SHLVL': '1', 15:58:21 INFO - 'TERM': 'linux', 15:58:21 INFO - 'TMOUT': '86400', 15:58:21 INFO - 'USER': 'cltbld', 15:58:21 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:21 INFO - '_': '/tools/buildbot/bin/python'} 15:58:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:58:21 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 15:58:21 INFO - Cleaning up... 15:58:21 INFO - Return code: 0 15:58:21 INFO - Running post-action listener: _resource_record_post_action 15:58:21 INFO - Running post-action listener: _start_resource_monitoring 15:58:21 INFO - Starting resource monitoring. 15:58:21 INFO - [mozharness: 2017-09-13 22:58:21.999727Z] Finished create-virtualenv step (success) 15:58:22 INFO - [mozharness: 2017-09-13 22:58:22.000189Z] Running install step. 15:58:22 INFO - Running pre-action listener: _resource_record_pre_action 15:58:22 INFO - Running main action method: install 15:58:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:58:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:58:22 INFO - Reading from file tmpfile_stdout 15:58:22 INFO - Detecting whether we're running mozinstall >=1.0... 15:58:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:58:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:58:22 INFO - Reading from file tmpfile_stdout 15:58:22 INFO - Output received: 15:58:22 INFO - Usage: mozinstall [options] installer 15:58:22 INFO - Options: 15:58:22 INFO - -h, --help show this help message and exit 15:58:22 INFO - -d DEST, --destination=DEST 15:58:22 INFO - Directory to install application into. [default: 15:58:22 INFO - "/builds/slave/test"] 15:58:22 INFO - --app=APP Application being installed. [default: firefox] 15:58:22 INFO - mkdir: /builds/slave/test/build/application 15:58:22 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'] 15:58:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 15:58:40 INFO - Reading from file tmpfile_stdout 15:58:40 INFO - Output received: 15:58:40 INFO - /builds/slave/test/build/application/firefox/firefox 15:58:40 INFO - Running post-action listener: _resource_record_post_action 15:58:40 INFO - [mozharness: 2017-09-13 22:58:40.060318Z] Finished install step (success) 15:58:40 INFO - [mozharness: 2017-09-13 22:58:40.060463Z] Running setup-mitmproxy step. 15:58:40 INFO - Running pre-action listener: _resource_record_pre_action 15:58:40 INFO - Running main action method: setup_mitmproxy 15:58:40 INFO - Skipping: mitmproxy is not required 15:58:40 INFO - Running post-action listener: _resource_record_post_action 15:58:40 INFO - [mozharness: 2017-09-13 22:58:40.060989Z] Finished setup-mitmproxy step (success) 15:58:40 INFO - [mozharness: 2017-09-13 22:58:40.061107Z] Running run-tests step. 15:58:40 INFO - Running pre-action listener: _resource_record_pre_action 15:58:40 INFO - Running pre-action listener: _set_gcov_prefix 15:58:40 INFO - Running main action method: run_tests 15:58:40 WARNING - Try message not found. 15:58:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:58:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:58:40 INFO - Python 2.7.3 15:58:40 INFO - Return code: 0 15:58:40 INFO - grabbing minidump binary from tooltool 15:58: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')]} 15:58:40 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--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 0x10e8090>, '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 0x10e8d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10e2f90>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:58:40 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--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 15:58:40 INFO - Copy/paste: /tools/tooltool.py --url https://tooltool.mozilla-releng.net/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 15:58:40 INFO - Calling ['/tools/tooltool.py', '--url', 'https://tooltool.mozilla-releng.net/', '--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 15:58:40 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:58:40 INFO - Return code: 0 15:58:40 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 15:58:40 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:58:40 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:58:40 INFO - ENV: RUST_BACKTRACE is now full 15:58:40 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 15:58:40 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:58:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-stylo-disabled-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-029', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log'] in /builds/slave/test/build 15:58:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs-stylo-disabled-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-029 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log 15:58:40 INFO - Using env: {'DISPLAY': ':0', 15:58:40 INFO - 'HOME': '/home/cltbld', 15:58:40 INFO - 'LANG': 'en_US.UTF-8', 15:58:40 INFO - 'LANGUAGE': 'en_US:en', 15:58:40 INFO - 'LOGNAME': 'cltbld', 15:58:40 INFO - 'MAIL': '/var/mail/cltbld', 15:58:40 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:58:40 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:58:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:40 INFO - 'MOZ_NO_REMOTE': '1', 15:58:40 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:58:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:40 INFO - 'NO_EM_RESTART': '1', 15:58:40 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:40 INFO - 'PWD': '/builds/slave/test', 15:58:40 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:58:40 INFO - 'RUST_BACKTRACE': 'full', 15:58:40 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 15:58:40 INFO - 'SHELL': '/bin/bash', 15:58:40 INFO - 'SHLVL': '1', 15:58:40 INFO - 'TERM': 'linux', 15:58:40 INFO - 'TMOUT': '86400', 15:58:40 INFO - 'USER': 'cltbld', 15:58:40 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:40 INFO - '_': '/tools/buildbot/bin/python'} 15:58:40 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-stylo-disabled-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-029', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log'] with output_timeout 3600 15:58:40 INFO - mozversion application_buildid: 20170913215920 15:58:40 INFO - mozversion application_changeset: 8645a74bbbd06b67699317df1abf3897db0e43d5 15:58:40 INFO - mozversion application_display_name: Nightly 15:58:40 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:58:40 INFO - mozversion application_name: Firefox 15:58:40 INFO - mozversion application_remotingname: firefox 15:58:40 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 15:58:40 INFO - mozversion application_vendor: Mozilla 15:58:40 INFO - mozversion application_version: 57.0a1 15:58:40 INFO - mozversion platform_buildid: 20170913215920 15:58:40 INFO - mozversion platform_changeset: 8645a74bbbd06b67699317df1abf3897db0e43d5 15:58:40 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 15:58:40 INFO - mozversion platform_version: 57.0a1 15:58:40 INFO - using testdate: 1505343520 15:58:40 INFO - actual date: 1505343520 15:58:40 INFO - starting webserver on 'localhost:46618' 15:58:40 INFO - SUITE-START | Running 2 tests 15:58:40 INFO - TEST-START | dromaeo_css 15:58:40 INFO - Initialising browser for dromaeo_css test... 15:58:40 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:46618/getInfo.html -profile /tmp/tmpEzsos1/profile 15:58:40 INFO - TEST-INFO | started process 25631 (/builds/slave/test/build/application/firefox/firefox http://localhost:46618/getInfo.html) 15:58:46 INFO - TEST-INFO | 25631: exit 0 15:58:46 INFO - Browser initialized. 15:58:46 INFO - Running cycle 1/1 for dromaeo_css test... 15:58:46 INFO - Using env: {'DISPLAY': ':0', 15:58:46 INFO - 'HOME': '/home/cltbld', 15:58:46 INFO - 'JSGC_DISABLE_POISONING': '1', 15:58:46 INFO - 'LANG': 'en_US.UTF-8', 15:58:46 INFO - 'LANGUAGE': 'en_US:en', 15:58:46 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 15:58:46 INFO - 'LOGNAME': 'cltbld', 15:58:46 INFO - 'MAIL': '/var/mail/cltbld', 15:58:46 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:58:46 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:58:46 INFO - 'MOZ_CRASHREPORTER': '1', 15:58:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:58:46 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 15:58:46 INFO - 'MOZ_NO_REMOTE': '1', 15:58:46 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:58:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:58:46 INFO - 'NO_EM_RESTART': '1', 15:58:46 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:58:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:58:46 INFO - 'PWD': '/builds/slave/test', 15:58:46 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:58:46 INFO - 'RUST_BACKTRACE': 'full', 15:58:46 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 15:58:46 INFO - 'SHELL': '/bin/bash', 15:58:46 INFO - 'SHLVL': '1', 15:58:46 INFO - 'STYLO_FORCE_DISABLED': '1', 15:58:46 INFO - 'TERM': 'linux', 15:58:46 INFO - 'TMOUT': '86400', 15:58:46 INFO - 'USER': 'cltbld', 15:58:46 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 15:58:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:58:46 INFO - '_': '/tools/buildbot/bin/python'} 15:58:46 INFO - TEST-INFO | started process 25860 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpEzsos1/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 15:58:47 INFO - PID 25860 | 15:58:47 INFO - PID 25860 | (/builds/slave/test/build/application/firefox/firefox:25909): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 15:58:47 INFO - PID 25860 | 15:58:58 INFO - PID 25860 | RSS: Main: 173334528 15:58:58 INFO - PID 25860 | 16:01:55 INFO - PID 25860 | Cycle 1(1): loaded http://localhost:46618/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46618/tests/dromaeo/cssquery-ext.html) 16:01:56 INFO - PID 25860 | RSS: Main: 176472064 16:01:56 INFO - PID 25860 | 16:04:58 INFO - PID 25860 | Cycle 1(1): loaded http://localhost:46618/tests/dromaeo/cssquery-ext.html (next: http://localhost:46618/tests/dromaeo/cssquery-jquery.html) 16:04:59 INFO - PID 25860 | RSS: Main: 172204032 16:04:59 INFO - PID 25860 | 16:08:00 INFO - PID 25860 | Cycle 1(1): loaded http://localhost:46618/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46618/tests/dromaeo/cssquery-mootools.html) 16:08:01 INFO - PID 25860 | RSS: Main: 175030272 16:08:01 INFO - PID 25860 | 16:11:03 INFO - PID 25860 | Cycle 1(1): loaded http://localhost:46618/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46618/tests/dromaeo/cssquery-prototype.html) 16:11:03 INFO - PID 25860 | RSS: Main: 173965312 16:11:03 INFO - PID 25860 | 16:14:06 INFO - PID 25860 | Cycle 1(1): loaded http://localhost:46618/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46618/tests/dromaeo/cssquery-yui.html) 16:14:07 INFO - PID 25860 | RSS: Main: 175136768 16:14:07 INFO - PID 25860 | 16:17:09 INFO - PID 25860 | Cycle 1(1): loaded http://localhost:46618/tests/dromaeo/cssquery-yui.html (next: http://localhost:46618/tests/dromaeo/cssquery-dojo.html) 16:17:09 INFO - PID 25860 | RSS: Main: 177180672 16:17:09 INFO - PID 25860 | 16:17:09 INFO - PID 25860 | __start_tp_report 16:17:09 INFO - PID 25860 | _x_x_mozilla_page_load 16:17:09 INFO - PID 25860 | _x_x_mozilla_page_load_details 16:17:09 INFO - PID 25860 | |i|pagename|runs| 16:17:09 INFO - PID 25860 | |0;dojo.html;3121.1416860363397;3127.358891427257;3151.448496513111;3158.4630612795822;3169.3661267746456;6175.783847565336;6207.9068813967715;6276.309605943343;6324.430801227889;6379.489640828734;6240.43836054755;6246.219222597176;6259.46794522465;6289.559730818844;6297.685115744217;5738.7991420300295;5742.511886489643;5756.453136951983;5761.222234998285;5836.15375770513;5785.103308987113;5853.941460585404;5857.297124345063;5900.1739756434135;5918.585699001072;5800.883982320351;5826.708664566776;5881.705914704269;5886.381929897363;5907;5612.550995920316;5718.79984200551;5751.1085781703905;5765.3369862465515;5841.211436456109;5751.712414379264;5754.597178197528;5810;5818;5822.417758224186;6167.198264225622;6192.102145188967;6232.906506402408;6240.102462780297;6303.401176888188;6769.356911093439;6823.420009299216;6826.658667066677;6826.897596536056;6840.521163518556;6853.554518956252;6894.034835123087;6930.30696930308;6936.132983377078;6938.236793952661;6071.969640151815;6182.907256391158;6189.535784816112;6261.718222679945;6321;6993.580385176906;7050.5769653820935;7072.115985501812;7073.575585464889;7078.893816592756;6541.705623246965;6601.73593056282;6667.399934005963;6746.696398662072;6750.966245168743;6661.666916654245;6748.392644662004;6794.252632210453;6805.557638753465;6806.42145417645;6785.660716964132;6830.897536536956;6831.28271531492;6836.794896153124;6841.657917104125;6781.152355955505;6788.49086318528;6789.422899053636;6879.3120687930805;6900.516963812585;5236.214567814782;5310.256564081032;5316.175992721134;5406.2701535292235;5416.891662166813;4652.418447694038;4688.109259240733;4701.741404222732;4737.976310118427;4752.833650822274;5821.388754180834;5888.381719919433;5890.2342695449315;5893.086571581412;5893.410658934158;6628.204615446178;6788.558743681645;6801.591904485746;6877.518573699793;6879.58722476653;5772.336181339116;5791.218185544897;5795.159701843209;5803.709814509258;5884.617499862496;5808.157817116495;5865.67738774363;5867.765289388462;5890.028145356054;5890.911636325459;6487.416132547999;6497.870042599122;6508.511861610398;6597.835054123685;6598.538102332886;6640.634765087966;6715.697793599202;6735.68654112463;6743.426808721314;6745.763898263537;6401.55189136756;6456.483481321577;6528.869422611616;6548.639824809681;6588.736450541925;6655.035019921987;6676;6739.629320387426;6761.695723692347;6768.56004359715;6680.665966701548;6757.358050985148;6832.521723479507;6849.965750171217;6883.483738719516;6568.507361947777;6569.310222426577;6641.867162656817;6654.633995130314;6660.400563949268;6420.6789660517725;6513.413792758674;6546.869062618816;6581.078648989241;6616.66916654175;6540.574862633914;6560.639164845788;6608.570442921195;6611.173603299588;6619.702113405005;6601.801945941629;6618.70215840298;6642.036904648702;6682.966585167043;6749.865002700017;6276.905846412216;6426.582272152295;6481.092647029325;6509.902351464826;6520.836979075371 16:17:09 INFO - PID 25860 | |1;ext.html;831.2850948184564;859.9183077607627;873.3231745397317;874.278720055954;881.4931414436696;40973.79513102434;42077.78961105194;42093.7895310523;42199.36700949485;42219.15561688764;38670;38748.612513874854;42607.573924260745;43041;43278.783606081925;7807.804804879866;7907.16974717655;7909.960450197741;7917.643706033214;7924;7833.843323133534;7952;7956.443048986574;7966.681332746683;7968.163342849004;7956.164602716689;7983.201679832028;7983.800404989864;7986;7989.800254993614;7920.128785833554;7961.60191990401;7968;7971.561564113971;7972.24263694951;7734.806629834299;7790.493617914817;7791.181925897756;7796.532208067534;7797;38561.421578676345;38784.22431551353;38838.61161388378;38840.61159388398;38860.222795544214;3515.542979412686;3547.592026916912;3557.1107223194203;3557.8932632021083;3558.3594952908725;31729.365412691848;31800.681993180002;31891;31927.52108718371;32038.679613204036;5021.799128034874;5178.016176926372;5211;5217.034848552992;5281.973590132025;182653;182773;182971;183676;184213.07893460582;47694.5230547697;47864.282035769495;47892.28161577579;47966;47985;50244.49755502471;50333.496665033614;50356.74821625868;50390.496095039314;50411.49588504068;15101;15431.768523471932;15439.61400964985;15445;15459;12666.050046246568;12687.873121268669;12719.364031798374;12738.936305318413;12745.17156384832;12302.323372214614;12316.50733970649;12399.938000309941;12449.128561000824;12449.190802597803;4856.781444834991;5044.798208071709;5055.823046193365;5074.898502029939;5076.466970968069;943.2454036770556;991.548845275398;998.670438755209;1009.7828966772179;1014.7564584499814;22379.440513986956;22507.212247571257;22591.548169036527;22620.321390358316;22684.206052788075;1041.1670663469345;1098.7967226063204;1100.9229353945148;1101.7851518953887;1117.1844553476008;11837.585684501;11955.701107472383;12003.939980300043;12006.87993120075;12083.939580302042;221563;223322;224184;224330;224375;52250;52406;52490.47509524932;55347;55356;1431.8210223722035;1432.4986254810733;1436.6408397900525;1445.7831325301331;1463.8828893688478;26117;26145;26205.737942621094;26369.4726105473;26944.461110777283;37416.6258337424;37693.246135077694;37697;37701.24597508089;37713.43429848499;193098;193126;193404;193456;193685;32875.835620821745;32940.34119317648;33308.833455832566;33350;33443.83278083594;41857.37213941854;42033.75670111325;42236.155276893674;42619;42674.78662606667;30739.846300768353;30874;31003.534946975364;31278.37443251168;31720.206994825316;30403.54394684126;30577;30748.846255768578;31067.223319417197;31146.377072458876;35339.409726561855;35568.644313556535;35759.106022349646;35857;35857.46213806743;30781.23046923845;31149.377012460078;31200.375992480476;31275.374492510477;31943.520847186846;22549.774502255423;22723.318300451014;22889.31332060041;22933.312000640006;23010.424739381648 16:17:09 INFO - PID 25860 | |2;jquery.html;560.2716468590834;573.4781348972435;573.9095718135542;575.5338176077378;587.248322147651;21643.350699479022;22421.551568968633;22459.55080898381;22517;22552.323430297118;23146.305610831703;24296.63555046671;24423.75576244237;24545;24970.50058998819;6439.678016099199;6532.8040158795075;6568.540202185849;6570.540062195648;6575.93424065758;6263.467605253536;6462.483001359903;6497.22033355998;6560.606363618174;6574.967125164368;6508.02379643055;6508.902366464483;6512.772052978123;6515.185601799775;6516.185476815398;6464.935350646504;6478.805635830932;6512.088307636935;6514.543981921267;6524.086627872101;6017.308009578867;6031.487323577501;6054.606450580743;6055.788047418319;6057.697115144225;27047.323816904536;27724.861375693195;28062.43875122486;28245.29386765327;28279.85860070707;1966.2921348314596;2000.8899510526915;2001.109506269696;2004.3986803958753;2005.91976320947;18135.274589016422;18535.721964170414;19060.904695476434;19768.308109216254;19859.106340214727;2445.963310550343;2463.1132792194794;2486.191987604036;2489.253224032783;2508.5359208546297;124320.37839810744;128649;135925;135930;143022.56977430196;14713.55859324222;14754.557363279118;14938.60982242836;15072.246387680572;15134.848651513565;22293.55412891733;22324.767523247545;22352.441188970082;22359.66460503094;22364.88817555902;10059.949700251453;10147.441890695934;10165.135963443043;10184.847227291448;10341.948290258651;9515.57179926905;9531.285153613506;9570.808583828284;9668.129868311886;9691.854622180674;8926.152015558642;9007.324450666096;9011.594478248495;9072.95463522678;9344.486053266999;2594.260635718811;2614.8169628125847;2640.6699162604673;2753.8347699138117;2756.724327567267;937.901520340368;938.877945867033;941.2187884056217;945.9905400945902;948.3788118782209;18111.275548977894;18226.362077327496;18689.81310186908;18785.436436906915;18938.81061189398;981.342500524636;993.076438911819;995.1491474789096;1000.8048430555972;1007.0684616729496;10190.847137292947;10267.640632577824;10347.482625868677;10398.168146548258;10567.101796347397;496613;502707;508369;518110;518672;111155.44422277837;113562;114819.42590286995;114830;115097;1010.8129995950626;1054.8734151901822;1135.954561817518;1154.1055681846635;1169.2516789254885;19506.609867802847;19532.90233548823;19592.902035489733;19619.313324033592;19867.105980230634;53278.2008269884;54032;54583;55553.444465556444;56859.71570142123;70508.64745676238;70661;70800.29199707937;70820.64589677019;71128.64435677789;13872;14130.293485325486;14172.149671019772;14209.715805684034;14299.356528956014;21984.45038874041;21985.120595176653;22160.88919555392;22336.441588960406;22380.216692415688;17531.298748049936;17756.733648995534;17828.19773110239;17878.374256901465;17894.731579026586;15854.682906341577;15964.201789910227;16578;16631.667366652357;16728.41450549225;17065.89071710335;17508.037057961934;17769.289228430716;18229;18300.81699182991;13821.170729756246;13901.513447029305;14015.439382424589;14035.36840842185;14037.087589306662;17240;17434.651306974043;17775;17897.821021789616;17953.910230448764 16:17:09 INFO - PID 25860 | |3;mootools.html;1325.138659871084;1387.945161677125;1402.8807551358136;1405.1428628536598;1429.8069760582318;14703.33834977426;15307.770383444244;15323.310451029702;15326.693466130671;15370.385184592631;15054.84945150548;15117.773233401507;15140.924295378536;15179.089254644728;15185.468508602202;2689.798265130123;2705.7564819166273;2738.945221095577;2755.9586606200924;2762.074704973836;2693;2726.577380506015;2735.2341344423594;2735.603337516059;2743.1359121876544;2578.200757765099;2646.76179143877;2752.2018614601843;2761.5443451830424;2766.958495622567;2691.851948142851;2701.770349520283;2725.11433784021;2728.249731323902;2734.671839379277;2602.7267136950536;2608.321836322551;2621.108823000189;2621.2267381122615;2624.3307956471167;14947.476838310715;15045.623859403602;15190.240487975558;15199.696006079927;15205.695886082216;7907.920920790776;8172.632231549535;8177.918220817775;8184.140665230184;8184.468009579358;5151.330327057496;5296.814611488618;5301.390340110898;5321.494458026481;5384.057789886754;1794.97307540387;1843.8709290349682;1845.6954602490573;1881.2663061406063;1891.8391936685398;26479.205623831123;26806.463870722673;26872.328191795164;26902.730972690024;26922.461550768876;6796.35434633709;6814.216365117975;6870.793876183722;6985.301469852974;6990;17165;17173.656526869392;17203.65592688164;17211.741823872653;17247;7670.27132422419;7793.337566306814;7800.804979875548;7803.297703206738;7804.492707973964;7132.393746531499;7176.210616832144;7252.673629686677;7332.8900066499045;7463.626818659154;5003.674761140514;5134.332536770196;5140.40885298188;5202.791888324425;5203.60972927032;1571.7406627906266;1575.4328441760956;1581.6362236685397;1584.896981696186;1594.4897632757638;787.4527203593562;900.1628485508539;908.4957848394205;933.4725879877983;937.0676177203726;8628.39601227908;8691.782705432288;8737.475751454806;8766.693165739296;8801.823963520694;978.2760757039881;1015.6851376073441;1018.1193267823279;1025.108155904368;1032.948352582368;5251.632385732962;5265.894682106336;5266.289050978069;5378.489043540857;5516.613837031369;20261.29085482001;21289.68065479019;21385.67921481179;21971.121155153614;22013.22953696613;21588.136474540843;21812.89093554522;21933.341999740034;22031.66952495714;22060;9893.703188904345;10452.843207351896;10462;10584.312019718695;10632.362058276374;8230.42387032902;8328.875066874123;8352.206540378655;8409.075001749925;8423.831523369376;18296;18445.81554184441;18721.53196170107;18915.71626425577;19078.61842763165;18862.24551017999;19012.429627111207;19015.80984190196;19098.52253693669;19469.805301947366;10920.453977301262;11032.393218373067;11083.390413527011;11088.501017454395;11093.611723589636;13263.403146858607;13500.122492037986;13595.252261125734;13595.660108497366;13660.453581857011;11225.60710375133;11402.771944561227;11404.885951140383;11588.304701717923;11660.941695291809;11178;11183.32900026001;11284.492197850952;11327.433628318717;11497.137714671266;9880.950595246977;9941.105300522988;9955.751106222402;10087.24345674092;10104.09063184317;7075.787726368218;7150.821229469305;7194.1726701427915;7210.423166146591;7242.348188663045;7224.602646854473;7343.302386273295;7387.704491820267;7431.962840185764;7461.328480436787 16:17:09 INFO - PID 25860 | |4;prototype.html;488.73608251544164;507.7309026216104;516.7312997241432;520.7812718658163;530.8009496438835;6255.937440625592;6313.842153946153;6341.270753863307;6346.555741098114;6395.232572091344;6285.5914365566205;6286.779962701306;6288.5912415693065;6293.150424692665;6324.462420694246;5198.506141916512;5200.115980283361;5206.01085793698;5215.504527069932;5241.685498870061;4859.951400485986;4978.825741099062;5181.689098654074;5194.71429071401;5224.843254702365;4974.035256073848;4974.303597496353;4977.47736487669;4996.4503904570465;5018.623603229754;4957.975210123926;4960.70235785854;4965.726885021322;4978.452370239271;4995.400551933755;4291.7854107294825;4424.557544245582;4466.062126953344;4504.324351347292;4506.301523263899;6131.877362452726;6160.322364539897;6165.136880836686;6169.259688837368;6177.69111544421;5656.830295091113;5675.801346952837;5734.122524412469;5755;5787;6641.335866413368;6652.334766523358;6679.165104361955;6679.966600166968;6699.564528305645;4844.806207751686;4851.345068415754;4888.242322440027;4888.682235654671;4918.360613120307;6539.803805885784;6680.3987641112535;6831.897521537181;6871.278515755874;6924.965375173142;4925.13810083234;4951.306817045616;4993.65171403719;5004.549590536796;5019.623528235397;5003.249512573143;5009.841831280029;5059.772310246048;5081.8729531762;5088.211327244283;5650.378458369576;5684.943150568524;5702.8289151325525;5703.201551782754;5703.201551782754;6459.320576650105;6603.273639899608;6618.007298905107;6650.600963942082;6656.201255849232;1730.2127531972922;1739.1912760566397;1766.9911650441666;1769.2038582637865;1776.875618706678;1145.6963904565298;1192.2369683402628;1200.6938230751102;1216.4100411300512;1229.9016078713682;5704.743286552115;5708.343540492813;5718.599698021098;5722.971385143048;5742.827715168552;6549.181352330958;6685.966570167216;6686.4985126115735;6713.295104014008;6737.686151200567;5597.697358558388;5627.943720562824;5717.885642287131;5741.85645358861;5781.277340332458;3519.155402703384;3559.6974257187912;3578.7315951303235;3594.101474631342;3613.638636136365;6402.135711678957;6413.486921046305;6472.417482426604;6473.935260647428;6482;6750.35871592198;6806.251312355637;6826.726930922708;6829.385355317946;6863.6568171591225;6319.873602527924;6359.713812878432;6420.839479012875;6459.321771214049;6482.611043337415;6546.072356586201;6555.6066636002;6585.769498067544;6602.273749887605;6621.205455345389;6633.3035031321015;6754.459643228432;6754.763583274562;6762.695678694569;6766;6377.649229292433;6444.742210311535;6461.418472337512;6463.127477790438;6514.641694706647;5349.224362467498;5519.972400138135;5535.418781027934;5542.667439953616;5555.972220138873;6322.407812796731;6406.295307516077;6498.252700939453;6795.3204679531655;6877.243503214542;6461.903071454026;6500.70746816385;6527.379898909596;6530.346965303432;6568.47452203813;6471.676416179078;6473.417392434703;6527.967360163168;6539.901901471387;6587.242467116152;6372.55392122547;6407.949456174166;6454.096041667814;6464.644444555594;6493.740250389931;6585.617020425572;6637.668116594247;6639.734410623521;6649.60102393858;6658.067870498231;6242.875142497215;6310.6213627182515;6349.523785715997;6413.2945376007665;6414.711337989708 16:17:09 INFO - PID 25860 | |5;yui.html;882.139913584255;914.7301546043917;933.8832645919256;934.1825902335461;939.4222553129825;16106;16680.916595417035;16763;16771;16781.328746850126;17279.74080388795;17547.73678394825;17749.29002839885;17796.46610601684;17888.552786180353;958.8993155718654;972.3728195314018;974.532224532225;976.0142256321132;976.2336565795852;906.8367693815111;975.2052077556804;977.5161295158871;996.0338471682456;999.9650012249573;1029.8197815382316;1048.6015314180602;1050.1074087026043;1051.4217180550704;1051.7791263834565;1025.4821315235795;1043.233223580664;1043.4782608695652;1043.7599352148973;1044.3785947361307;755.1579988313047;764.3388468974352;764.9043869516311;770.2836362183167;770.2951799103869;17484.737728934077;17531.211095500734;17775.644487110185;17915.462536123938;17931;21953.560928781335;21970.121195152176;22289.55420891589;22415;22441.214557490573;17834.84073535216;17846.107694615217;17979.550511237194;18095;18100.094995250183;3776.018235258825;3808.1431677872533;3845.1348446599573;3848.749831260987;3855.036240939765;135616;136221;137112;137392.31303843416;139434;16104.75842862358;16206.270717817726;16324.428644997368;16488.422905198502;16511.587210319838;31112.533312000338;31678.366432671217;31766.2058448536;31813.52279715806;31828.840855795574;7956.880646790303;8048.879266811003;8126;8167.509949403055;8203.097659257477;4132.152908653718;4209.915801683949;4214.009707718684;4214.7471151731;4229.97885010573;5386.380566234855;5472.534834539029;5473.917891231635;5527;5530.861728456821;985.3693636072919;1021.5505177721778;1024.2420608749471;1025.7948410317817;1028.7325295423243;664.1764212376618;693.6739732325799;710.4245561095529;712.3659942650941;717.5694583250008;11002.779944401067;11533.826992595117;11917.821232681517;12124.818127728091;12451.25292482454;704.3942209699654;708.3660124188822;709.2800807180715;711.416638356553;716.3910675925525;5376.91934620981;5414.891702166014;5417.106177480671;5437.809676661298;5541.251930989265;115697.42151289358;121680.39159804145;122270;123619;125812;104032.47983760033;106416;107900.46049769701;108350.45824770826;109067.45466272776;98226;98885;99229.50385248172;99288.5035574803;99860;9868.358556693793;10149.64476243328;10191;10322.845157322496;10345.431001295;41169.58830411657;42460.78769606132;42624;42627.7868610655;42662.57337426586;55091.17363239635;55244.72377638086;55361.44638553563;55481;55698.72150639221;15802.841971580598;15825.287862046005;15858.444954426539;15939.60150996188;16031.599210019844;14421.351039203471;14454.566363009126;14528;14690;14703.92648036753;16204.918975405048;16407.753883691516;16449.095299758148;16481.25834337434;16500.504984850475;13363.732725345633;13613.591592252249;13653.044286899822;13689.794653080411;13692.110012849133;14984.026038307475;15137.470188543348;15301.846981530041;15304.846951530342;15306.77039844381;10615.522301496605;10823.134149268197;10978.341299522055;11069.5018724156;11118.388488633203;10786.784264314512;10899.945500272448;11020.779584408107;11059.61291354831;11243.775124497628 16:17:09 INFO - PID 25860 | __end_tp_report 16:17:09 INFO - PID 25860 | __start_cc_report 16:17:09 INFO - PID 25860 | _x_x_mozilla_cycle_collect,362 16:17:09 INFO - PID 25860 | __end_cc_report 16:17:09 INFO - PID 25860 | __startTimestamp1505344629270__endTimestamp 16:17:09 INFO - PID 25860 | 16:17:09 INFO - PID 25860 | ------- Summary: start ------- 16:17:09 INFO - PID 25860 | Number of tests: 6 16:17:09 INFO - PID 25860 | 16:17:09 INFO - PID 25860 | [#0] dojo.html Cycles:165 Average:6227.64 Median:6497.87 stddev:754.01 (11.6%) stddev-sans-first:715.86 16:17:09 INFO - PID 25860 | Values: 3121.1 3127.4 3151.4 3158.5 3169.4 6175.8 6207.9 6276.3 6324.4 6379.5 6240.4 6246.2 6259.5 6289.6 6297.7 5738.8 5742.5 5756.5 5761.2 5836.2 5785.1 5853.9 5857.3 5900.2 5918.6 5800.9 5826.7 5881.7 5886.4 5907.0 5612.6 5718.8 5751.1 5765.3 5841.2 5751.7 5754.6 5810.0 5818.0 5822.4 6167.2 6192.1 6232.9 6240.1 6303.4 6769.4 6823.4 6826.7 6826.9 6840.5 6853.6 6894.0 6930.3 6936.1 6938.2 6072.0 6182.9 6189.5 6261.7 6321.0 6993.6 7050.6 7072.1 7073.6 7078.9 6541.7 6601.7 6667.4 6746.7 6751.0 6661.7 6748.4 6794.3 6805.6 6806.4 6785.7 6830.9 6831.3 6836.8 6841.7 6781.2 6788.5 6789.4 6879.3 6900.5 5236.2 5310.3 5316.2 5406.3 5416.9 4652.4 4688.1 4701.7 4738.0 4752.8 5821.4 5888.4 5890.2 5893.1 5893.4 6628.2 6788.6 6801.6 6877.5 6879.6 5772.3 5791.2 5795.2 5803.7 5884.6 5808.2 5865.7 5867.8 5890.0 5890.9 6487.4 6497.9 6508.5 6597.8 6598.5 6640.6 6715.7 6735.7 6743.4 6745.8 6401.6 6456.5 6528.9 6548.6 6588.7 6655.0 6676.0 6739.6 6761.7 6768.6 6680.7 6757.4 6832.5 6850.0 6883.5 6568.5 6569.3 6641.9 6654.6 6660.4 6420.7 6513.4 6546.9 6581.1 6616.7 6540.6 6560.6 6608.6 6611.2 6619.7 6601.8 6618.7 6642.0 6683.0 6749.9 6276.9 6426.6 6481.1 6509.9 6520.8 16:17:09 INFO - PID 25860 | 16:17:09 INFO - PID 25860 | [#1] ext.html Cycles:180 Average:36934.51 Median:19562.88 stddev:51998.28 (265.8%) stddev-sans-first:52073.48 16:17:09 INFO - PID 25860 | Values: 831.3 859.9 873.3 874.3 881.5 40973.8 42077.8 42093.8 42199.4 42219.2 38670.0 38748.6 42607.6 43041.0 43278.8 7807.8 7907.2 7910.0 7917.6 7924.0 7833.8 7952.0 7956.4 7966.7 7968.2 7956.2 7983.2 7983.8 7986.0 7989.8 7920.1 7961.6 7968.0 7971.6 7972.2 7734.8 7790.5 7791.2 7796.5 7797.0 38561.4 38784.2 38838.6 38840.6 38860.2 3515.5 3547.6 3557.1 3557.9 3558.4 31729.4 31800.7 31891.0 31927.5 32038.7 5021.8 5178.0 5211.0 5217.0 5282.0 182653.0 182773.0 182971.0 183676.0 184213.1 47694.5 47864.3 47892.3 47966.0 47985.0 50244.5 50333.5 50356.7 50390.5 50411.5 15101.0 15431.8 15439.6 15445.0 15459.0 12666.1 12687.9 12719.4 12738.9 12745.2 12302.3 12316.5 12399.9 12449.1 12449.2 4856.8 5044.8 5055.8 5074.9 5076.5 943.2 991.5 998.7 1009.8 1014.8 22379.4 22507.2 22591.5 22620.3 22684.2 1041.2 1098.8 1100.9 1101.8 1117.2 11837.6 11955.7 12003.9 12006.9 12083.9 221563.0 223322.0 224184.0 224330.0 224375.0 52250.0 52406.0 52490.5 55347.0 55356.0 1431.8 1432.5 1436.6 1445.8 1463.9 26117.0 26145.0 26205.7 26369.5 26944.5 37416.6 37693.2 37697.0 37701.2 37713.4 193098.0 193126.0 193404.0 193456.0 193685.0 32875.8 32940.3 33308.8 33350.0 33443.8 41857.4 42033.8 42236.2 42619.0 42674.8 30739.8 30874.0 31003.5 31278.4 31720.2 30403.5 30577.0 30748.8 31067.2 31146.4 35339.4 35568.6 35759.1 35857.0 35857.5 30781.2 31149.4 31200.4 31275.4 31943.5 22549.8 22723.3 22889.3 22933.3 23010.4 16:17:09 INFO - PID 25860 | 16:17:09 INFO - PID 25860 | [#2] jquery.html Cycles:180 Average:34801.06 Median:22362.28 stddev:85337.90 (381.6%) stddev-sans-first:85538.57 16:17:09 INFO - PID 25860 | Values: 560.3 573.5 573.9 575.5 587.2 21643.4 22421.6 22459.6 22517.0 22552.3 23146.3 24296.6 24423.8 24545.0 24970.5 6439.7 6532.8 6568.5 6570.5 6575.9 6263.5 6462.5 6497.2 6560.6 6575.0 6508.0 6508.9 6512.8 6515.2 6516.2 6464.9 6478.8 6512.1 6514.5 6524.1 6017.3 6031.5 6054.6 6055.8 6057.7 27047.3 27724.9 28062.4 28245.3 28279.9 1966.3 2000.9 2001.1 2004.4 2005.9 18135.3 18535.7 19060.9 19768.3 19859.1 2446.0 2463.1 2486.2 2489.3 2508.5 124320.4 128649.0 135925.0 135930.0 143022.6 14713.6 14754.6 14938.6 15072.2 15134.8 22293.6 22324.8 22352.4 22359.7 22364.9 10059.9 10147.4 10165.1 10184.8 10341.9 9515.6 9531.3 9570.8 9668.1 9691.9 8926.2 9007.3 9011.6 9073.0 9344.5 2594.3 2614.8 2640.7 2753.8 2756.7 937.9 938.9 941.2 946.0 948.4 18111.3 18226.4 18689.8 18785.4 18938.8 981.3 993.1 995.1 1000.8 1007.1 10190.8 10267.6 10347.5 10398.2 10567.1 496613.0 502707.0 508369.0 518110.0 518672.0 111155.4 113562.0 114819.4 114830.0 115097.0 1010.8 1054.9 1136.0 1154.1 1169.3 19506.6 19532.9 19592.9 19619.3 19867.1 53278.2 54032.0 54583.0 55553.4 56859.7 70508.6 70661.0 70800.3 70820.6 71128.6 13872.0 14130.3 14172.1 14209.7 14299.4 21984.5 21985.1 22160.9 22336.4 22380.2 17531.3 17756.7 17828.2 17878.4 17894.7 15854.7 15964.2 16578.0 16631.7 16728.4 17065.9 17508.0 17769.3 18229.0 18300.8 13821.2 13901.5 14015.4 14035.4 14037.1 17240.0 17434.7 17775.0 17897.8 17953.9 16:17:09 INFO - PID 25860 | 16:17:09 INFO - PID 25860 | [#3] mootools.html Cycles:180 Average:9330.32 Median:2635.55 stddev:6683.15 (253.6%) stddev-sans-first:6674.83 16:17:09 INFO - PID 25860 | Values: 1325.1 1387.9 1402.9 1405.1 1429.8 14703.3 15307.8 15323.3 15326.7 15370.4 15054.8 15117.8 15140.9 15179.1 15185.5 2689.8 2705.8 2738.9 2756.0 2762.1 2693.0 2726.6 2735.2 2735.6 2743.1 2578.2 2646.8 2752.2 2761.5 2767.0 2691.9 2701.8 2725.1 2728.2 2734.7 2602.7 2608.3 2621.1 2621.2 2624.3 14947.5 15045.6 15190.2 15199.7 15205.7 7907.9 8172.6 8177.9 8184.1 8184.5 5151.3 5296.8 5301.4 5321.5 5384.1 1795.0 1843.9 1845.7 1881.3 1891.8 26479.2 26806.5 26872.3 26902.7 26922.5 6796.4 6814.2 6870.8 6985.3 6990.0 17165.0 17173.7 17203.7 17211.7 17247.0 7670.3 7793.3 7800.8 7803.3 7804.5 7132.4 7176.2 7252.7 7332.9 7463.6 5003.7 5134.3 5140.4 5202.8 5203.6 1571.7 1575.4 1581.6 1584.9 1594.5 787.5 900.2 908.5 933.5 937.1 8628.4 8691.8 8737.5 8766.7 8801.8 978.3 1015.7 1018.1 1025.1 1032.9 5251.6 5265.9 5266.3 5378.5 5516.6 20261.3 21289.7 21385.7 21971.1 22013.2 21588.1 21812.9 21933.3 22031.7 22060.0 9893.7 10452.8 10462.0 10584.3 10632.4 8230.4 8328.9 8352.2 8409.1 8423.8 18296.0 18445.8 18721.5 18915.7 19078.6 18862.2 19012.4 19015.8 19098.5 19469.8 10920.5 11032.4 11083.4 11088.5 11093.6 13263.4 13500.1 13595.3 13595.7 13660.5 11225.6 11402.8 11404.9 11588.3 11660.9 11178.0 11183.3 11284.5 11327.4 11497.1 9881.0 9941.1 9955.8 10087.2 10104.1 7075.8 7150.8 7194.2 7210.4 7242.3 7224.6 7343.3 7387.7 7432.0 7461.3 16:17:09 INFO - PID 25860 | 16:17:09 INFO - PID 25860 | [#4] prototype.html Cycles:180 Average:5526.26 Median:6249.41 stddev:1538.13 (24.6%) stddev-sans-first:1495.25 16:17:09 INFO - PID 25860 | Values: 488.7 507.7 516.7 520.8 530.8 6255.9 6313.8 6341.3 6346.6 6395.2 6285.6 6286.8 6288.6 6293.2 6324.5 5198.5 5200.1 5206.0 5215.5 5241.7 4860.0 4978.8 5181.7 5194.7 5224.8 4974.0 4974.3 4977.5 4996.5 5018.6 4958.0 4960.7 4965.7 4978.5 4995.4 4291.8 4424.6 4466.1 4504.3 4506.3 6131.9 6160.3 6165.1 6169.3 6177.7 5656.8 5675.8 5734.1 5755.0 5787.0 6641.3 6652.3 6679.2 6680.0 6699.6 4844.8 4851.3 4888.2 4888.7 4918.4 6539.8 6680.4 6831.9 6871.3 6925.0 4925.1 4951.3 4993.7 5004.5 5019.6 5003.2 5009.8 5059.8 5081.9 5088.2 5650.4 5684.9 5702.8 5703.2 5703.2 6459.3 6603.3 6618.0 6650.6 6656.2 1730.2 1739.2 1767.0 1769.2 1776.9 1145.7 1192.2 1200.7 1216.4 1229.9 5704.7 5708.3 5718.6 5723.0 5742.8 6549.2 6686.0 6686.5 6713.3 6737.7 5597.7 5627.9 5717.9 5741.9 5781.3 3519.2 3559.7 3578.7 3594.1 3613.6 6402.1 6413.5 6472.4 6473.9 6482.0 6750.4 6806.3 6826.7 6829.4 6863.7 6319.9 6359.7 6420.8 6459.3 6482.6 6546.1 6555.6 6585.8 6602.3 6621.2 6633.3 6754.5 6754.8 6762.7 6766.0 6377.6 6444.7 6461.4 6463.1 6514.6 5349.2 5520.0 5535.4 5542.7 5556.0 6322.4 6406.3 6498.3 6795.3 6877.2 6461.9 6500.7 6527.4 6530.3 6568.5 6471.7 6473.4 6528.0 6539.9 6587.2 6372.6 6407.9 6454.1 6464.6 6493.7 6585.6 6637.7 6639.7 6649.6 6658.1 6242.9 6310.6 6349.5 6413.3 6414.7 16:17:09 INFO - PID 25860 | 16:17:09 INFO - PID 25860 | [#5] yui.html Cycles:180 Average:23828.26 Median:17840.47 stddev:35125.92 (196.9%) stddev-sans-first:35182.20 16:17:09 INFO - PID 25860 | Values: 882.1 914.7 933.9 934.2 939.4 16106.0 16680.9 16763.0 16771.0 16781.3 17279.7 17547.7 17749.3 17796.5 17888.6 958.9 972.4 974.5 976.0 976.2 906.8 975.2 977.5 996.0 1000.0 1029.8 1048.6 1050.1 1051.4 1051.8 1025.5 1043.2 1043.5 1043.8 1044.4 755.2 764.3 764.9 770.3 770.3 17484.7 17531.2 17775.6 17915.5 17931.0 21953.6 21970.1 22289.6 22415.0 22441.2 17834.8 17846.1 17979.6 18095.0 18100.1 3776.0 3808.1 3845.1 3848.7 3855.0 135616.0 136221.0 137112.0 137392.3 139434.0 16104.8 16206.3 16324.4 16488.4 16511.6 31112.5 31678.4 31766.2 31813.5 31828.8 7956.9 8048.9 8126.0 8167.5 8203.1 4132.2 4209.9 4214.0 4214.7 4230.0 5386.4 5472.5 5473.9 5527.0 5530.9 985.4 1021.6 1024.2 1025.8 1028.7 664.2 693.7 710.4 712.4 717.6 11002.8 11533.8 11917.8 12124.8 12451.3 704.4 708.4 709.3 711.4 716.4 5376.9 5414.9 5417.1 5437.8 5541.3 115697.4 121680.4 122270.0 123619.0 125812.0 104032.5 106416.0 107900.5 108350.5 109067.5 98226.0 98885.0 99229.5 99288.5 99860.0 9868.4 10149.6 10191.0 10322.8 10345.4 41169.6 42460.8 42624.0 42627.8 42662.6 55091.2 55244.7 55361.4 55481.0 55698.7 15802.8 15825.3 15858.4 15939.6 16031.6 14421.4 14454.6 14528.0 14690.0 14703.9 16204.9 16407.8 16449.1 16481.3 16500.5 13363.7 13613.6 13653.0 13689.8 13692.1 14984.0 15137.5 15301.8 15304.8 15306.8 10615.5 10823.1 10978.3 11069.5 11118.4 10786.8 10899.9 11020.8 11059.6 11243.8 16:17:09 INFO - PID 25860 | -------- Summary: end -------- 16:17:09 INFO - PID 25860 | 16:17:10 INFO - TEST-INFO | 25860: exit 0 16:17:10 INFO - TEST-OK | dromaeo_css | took 1109700ms 16:17:10 INFO - TEST-START | kraken 16:17:10 INFO - Initialising browser for kraken test... 16:17:10 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:46618/getInfo.html -profile /tmp/tmp5LPXQN/profile 16:17:10 INFO - TEST-INFO | started process 26224 (/builds/slave/test/build/application/firefox/firefox http://localhost:46618/getInfo.html) 16:17:15 INFO - TEST-INFO | 26224: exit 0 16:17:15 INFO - Browser initialized. 16:17:15 INFO - Running cycle 1/1 for kraken test... 16:17:15 INFO - Using env: {'DISPLAY': ':0', 16:17:15 INFO - 'HOME': '/home/cltbld', 16:17:15 INFO - 'JSGC_DISABLE_POISONING': '1', 16:17:15 INFO - 'LANG': 'en_US.UTF-8', 16:17:15 INFO - 'LANGUAGE': 'en_US:en', 16:17:15 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 16:17:15 INFO - 'LOGNAME': 'cltbld', 16:17:15 INFO - 'MAIL': '/var/mail/cltbld', 16:17:15 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:17:15 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:17:15 INFO - 'MOZ_CRASHREPORTER': '1', 16:17:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:17:15 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 16:17:15 INFO - 'MOZ_NO_REMOTE': '1', 16:17:15 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:17:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:17:15 INFO - 'NO_EM_RESTART': '1', 16:17:15 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:17:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:17:15 INFO - 'PWD': '/builds/slave/test', 16:17:15 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:17:15 INFO - 'RUST_BACKTRACE': 'full', 16:17:15 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 16:17:15 INFO - 'SHELL': '/bin/bash', 16:17:15 INFO - 'SHLVL': '1', 16:17:15 INFO - 'STYLO_FORCE_DISABLED': '1', 16:17:15 INFO - 'TERM': 'linux', 16:17:15 INFO - 'TMOUT': '86400', 16:17:15 INFO - 'USER': 'cltbld', 16:17:15 INFO - 'XDG_SESSION_COOKIE': 'ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102', 16:17:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:17:15 INFO - '_': '/tools/buildbot/bin/python'} 16:17:15 INFO - TEST-INFO | started process 26455 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5LPXQN/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 16:17:16 INFO - PID 26455 | 16:17:16 INFO - PID 26455 | (/builds/slave/test/build/application/firefox/firefox:26504): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 16:17:16 INFO - PID 26455 | 16:17:27 INFO - PID 26455 | RSS: Main: 173641728 16:17:27 INFO - PID 26455 | 16:17:29 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46618/tests/kraken/driver.html?testName=audio-beat-detection) 16:17:30 INFO - PID 26455 | RSS: Main: 178253824 16:17:30 INFO - PID 26455 | 16:17:33 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46618/tests/kraken/driver.html?testName=audio-dft) 16:17:34 INFO - PID 26455 | RSS: Main: 178159616 16:17:34 INFO - PID 26455 | 16:17:37 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46618/tests/kraken/driver.html?testName=audio-fft) 16:17:37 INFO - PID 26455 | RSS: Main: 174534656 16:17:37 INFO - PID 26455 | 16:17:39 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46618/tests/kraken/driver.html?testName=audio-oscillator) 16:17:40 INFO - PID 26455 | RSS: Main: 175230976 16:17:40 INFO - PID 26455 | 16:17:42 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46618/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:17:43 INFO - PID 26455 | RSS: Main: 175951872 16:17:43 INFO - PID 26455 | 16:17:46 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46618/tests/kraken/driver.html?testName=imaging-darkroom) 16:17:47 INFO - PID 26455 | RSS: Main: 178401280 16:17:47 INFO - PID 26455 | 16:17:50 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46618/tests/kraken/driver.html?testName=imaging-desaturate) 16:17:51 INFO - PID 26455 | RSS: Main: 177942528 16:17:51 INFO - PID 26455 | 16:17:54 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46618/tests/kraken/driver.html?testName=json-parse-financial) 16:17:54 INFO - PID 26455 | RSS: Main: 178618368 16:17:54 INFO - PID 26455 | 16:17:56 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46618/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:17:57 INFO - PID 26455 | RSS: Main: 178446336 16:17:57 INFO - PID 26455 | 16:17:58 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46618/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:17:59 INFO - PID 26455 | RSS: Main: 178184192 16:17:59 INFO - PID 26455 | 16:18:01 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46618/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:18:02 INFO - PID 26455 | RSS: Main: 175820800 16:18:02 INFO - PID 26455 | 16:18:04 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46618/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:18:05 INFO - PID 26455 | RSS: Main: 175509504 16:18:05 INFO - PID 26455 | 16:18:08 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46618/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:18:08 INFO - PID 26455 | RSS: Main: 175648768 16:18:08 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | Cycle 1(1): loaded http://localhost:46618/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46618/tests/kraken/driver.html?testName=ai-astar) 16:18:10 INFO - PID 26455 | RSS: Main: 177373184 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | __start_tp_report 16:18:10 INFO - PID 26455 | _x_x_mozilla_page_load 16:18:10 INFO - PID 26455 | _x_x_mozilla_page_load_details 16:18:10 INFO - PID 26455 | |i|pagename|runs| 16:18:10 INFO - PID 26455 | |0;ai-astar;108;108;108;106;107;110;109;106;107;106 16:18:10 INFO - PID 26455 | |1;audio-beat-detection;120;120;116;120;150;119;115;149;120;121 16:18:10 INFO - PID 26455 | |2;audio-dft;161;161;161;162;161;161;166;167;167;163 16:18:10 INFO - PID 26455 | |3;audio-fft;76;73;73;72;73;74;74;73;77;75 16:18:10 INFO - PID 26455 | |4;audio-oscillator;78;79;79;80;78;79;80;79;81;80 16:18:10 INFO - PID 26455 | |5;imaging-gaussian-blur;116;113;114;116;113;117;113;116;114;117 16:18:10 INFO - PID 26455 | |6;imaging-darkroom;149;149;149;150;148;146;148;149;148;148 16:18:10 INFO - PID 26455 | |7;imaging-desaturate;94;94;94;94;94;94;94;94;95;95 16:18:10 INFO - PID 26455 | |8;json-parse-financial;54;52;52;53;52;52;51;51;52;58 16:18:10 INFO - PID 26455 | |9;json-stringify-tinderbox;40;37;38;37;38;38;37;37;39;37 16:18:10 INFO - PID 26455 | |10;stanford-crypto-aes;75;73;75;74;72;74;75;74;74;75 16:18:10 INFO - PID 26455 | |11;stanford-crypto-ccm;114;113;111;111;116;113;120;109;114;112 16:18:10 INFO - PID 26455 | |12;stanford-crypto-pbkdf2;173;171;167;170;169;166;167;175;170;173 16:18:10 INFO - PID 26455 | |13;stanford-crypto-sha256-iterative;69;65;65;64;63;66;66;66;65;64 16:18:10 INFO - PID 26455 | __end_tp_report 16:18:10 INFO - PID 26455 | __start_cc_report 16:18:10 INFO - PID 26455 | _x_x_mozilla_cycle_collect,924 16:18:10 INFO - PID 26455 | __end_cc_report 16:18:10 INFO - PID 26455 | __startTimestamp1505344690940__endTimestamp 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | ------- Summary: start ------- 16:18:10 INFO - PID 26455 | Number of tests: 14 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#0] ai-astar Cycles:10 Average:107.50 Median:108.00 stddev:1.35 (1.3%) stddev-sans-first:1.42 16:18:10 INFO - PID 26455 | Values: 108.0 108.0 108.0 106.0 107.0 110.0 109.0 106.0 107.0 106.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#1] audio-beat-detection Cycles:10 Average:125.00 Median:120.00 stddev:13.06 (10.9%) stddev-sans-first:13.72 16:18:10 INFO - PID 26455 | Values: 120.0 120.0 116.0 120.0 150.0 119.0 115.0 149.0 120.0 121.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#2] audio-dft Cycles:10 Average:163.00 Median:162.50 stddev:2.62 (1.6%) stddev-sans-first:2.68 16:18:10 INFO - PID 26455 | Values: 161.0 161.0 161.0 162.0 161.0 161.0 166.0 167.0 167.0 163.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#3] audio-fft Cycles:10 Average:74.00 Median:74.00 stddev:1.56 (2.1%) stddev-sans-first:1.48 16:18:10 INFO - PID 26455 | Values: 76.0 73.0 73.0 72.0 73.0 74.0 74.0 73.0 77.0 75.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#4] audio-oscillator Cycles:10 Average:79.30 Median:79.50 stddev:0.95 (1.2%) stddev-sans-first:0.88 16:18:10 INFO - PID 26455 | Values: 78.0 79.0 79.0 80.0 78.0 79.0 80.0 79.0 81.0 80.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#5] imaging-gaussian-blur Cycles:10 Average:114.90 Median:116.00 stddev:1.66 (1.4%) stddev-sans-first:1.72 16:18:10 INFO - PID 26455 | Values: 116.0 113.0 114.0 116.0 113.0 117.0 113.0 116.0 114.0 117.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#6] imaging-darkroom Cycles:10 Average:148.40 Median:149.00 stddev:1.07 (0.7%) stddev-sans-first:1.12 16:18:10 INFO - PID 26455 | Values: 149.0 149.0 149.0 150.0 148.0 146.0 148.0 149.0 148.0 148.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#7] imaging-desaturate Cycles:10 Average:94.20 Median:94.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 16:18:10 INFO - PID 26455 | Values: 94.0 94.0 94.0 94.0 94.0 94.0 94.0 94.0 95.0 95.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#8] json-parse-financial Cycles:10 Average:52.70 Median:52.00 stddev:2.06 (4.0%) stddev-sans-first:2.13 16:18:10 INFO - PID 26455 | Values: 54.0 52.0 52.0 53.0 52.0 52.0 51.0 51.0 52.0 58.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#9] json-stringify-tinderbox Cycles:10 Average:37.80 Median:38.00 stddev:1.03 (2.7%) stddev-sans-first:0.73 16:18:10 INFO - PID 26455 | Values: 40.0 37.0 38.0 37.0 38.0 38.0 37.0 37.0 39.0 37.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#10] stanford-crypto-aes Cycles:10 Average:74.10 Median:74.50 stddev:0.99 (1.3%) stddev-sans-first:1.00 16:18:10 INFO - PID 26455 | Values: 75.0 73.0 75.0 74.0 72.0 74.0 75.0 74.0 74.0 75.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#11] stanford-crypto-ccm Cycles:10 Average:113.30 Median:113.50 stddev:3.06 (2.7%) stddev-sans-first:3.23 16:18:10 INFO - PID 26455 | Values: 114.0 113.0 111.0 111.0 116.0 113.0 120.0 109.0 114.0 112.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:170.10 Median:170.50 stddev:2.96 (1.7%) stddev-sans-first:2.95 16:18:10 INFO - PID 26455 | Values: 173.0 171.0 167.0 170.0 169.0 166.0 167.0 175.0 170.0 173.0 16:18:10 INFO - PID 26455 | 16:18:10 INFO - PID 26455 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.30 Median:65.50 stddev:1.64 (2.5%) stddev-sans-first:1.05 16:18:10 INFO - PID 26455 | Values: 69.0 65.0 65.0 64.0 63.0 66.0 66.0 66.0 65.0 64.0 16:18:10 INFO - PID 26455 | -------- Summary: end -------- 16:18:10 INFO - PID 26455 | 16:18:11 INFO - PID 26455 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 16:18:11 INFO - TEST-INFO | 26455: exit 0 16:18:11 INFO - TEST-OK | kraken | took 61645ms 16:18:11 INFO - SUITE-END | took 1171s 16:18:12 INFO - Completed test suite (00:19:31) 16:18:12 INFO - javascript benchmark 16:18:12 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s", "stylo_disabled"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8448.347887879341, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3121.1416860363397, 3127.358891427257, 3151.448496513111, 3158.4630612795822, 3169.3661267746456, 6175.783847565336, 6207.9068813967715, 6276.309605943343, 6324.430801227889, 6379.489640828734, 6240.43836054755, 6246.219222597176, 6259.46794522465, 6289.559730818844, 6297.685115744217, 5738.7991420300295, 5742.511886489643, 5756.453136951983, 5761.222234998285, 5836.15375770513, 5785.103308987113, 5853.941460585404, 5857.297124345063, 5900.1739756434135, 5918.585699001072, 5800.883982320351, 5826.708664566776, 5881.705914704269, 5886.381929897363, 5907.0, 5612.550995920316, 5718.79984200551, 5751.1085781703905, 5765.3369862465515, 5841.211436456109, 5751.712414379264, 5754.597178197528, 5810.0, 5818.0, 5822.417758224186, 6167.198264225622, 6192.102145188967, 6232.906506402408, 6240.102462780297, 6303.401176888188, 6769.356911093439, 6823.420009299216, 6826.658667066677, 6826.897596536056, 6840.521163518556, 6853.554518956252, 6894.034835123087, 6930.30696930308, 6936.132983377078, 6938.236793952661, 6071.969640151815, 6182.907256391158, 6189.535784816112, 6261.718222679945, 6321.0, 6993.580385176906, 7050.5769653820935, 7072.115985501812, 7073.575585464889, 7078.893816592756, 6541.705623246965, 6601.73593056282, 6667.399934005963, 6746.696398662072, 6750.966245168743, 6661.666916654245, 6748.392644662004, 6794.252632210453, 6805.557638753465, 6806.42145417645, 6785.660716964132, 6830.897536536956, 6831.28271531492, 6836.794896153124, 6841.657917104125, 6781.152355955505, 6788.49086318528, 6789.422899053636, 6879.3120687930805, 6900.516963812585, 5236.214567814782, 5310.256564081032, 5316.175992721134, 5406.2701535292235, 5416.891662166813, 4652.418447694038, 4688.109259240733, 4701.741404222732, 4737.976310118427, 4752.833650822274, 5821.388754180834, 5888.381719919433, 5890.2342695449315, 5893.086571581412, 5893.410658934158, 6628.204615446178, 6788.558743681645, 6801.591904485746, 6877.518573699793, 6879.58722476653, 5772.336181339116, 5791.218185544897, 5795.159701843209, 5803.709814509258, 5884.617499862496, 5808.157817116495, 5865.67738774363, 5867.765289388462, 5890.028145356054, 5890.911636325459, 6487.416132547999, 6497.870042599122, 6508.511861610398, 6597.835054123685, 6598.538102332886, 6640.634765087966, 6715.697793599202, 6735.68654112463, 6743.426808721314, 6745.763898263537, 6401.55189136756, 6456.483481321577, 6528.869422611616, 6548.639824809681, 6588.736450541925, 6655.035019921987, 6676.0, 6739.629320387426, 6761.695723692347, 6768.56004359715, 6680.665966701548, 6757.358050985148, 6832.521723479507, 6849.965750171217, 6883.483738719516, 6568.507361947777, 6569.310222426577, 6641.867162656817, 6654.633995130314, 6660.400563949268, 6420.6789660517725, 6513.413792758674, 6546.869062618816, 6581.078648989241, 6616.66916654175, 6540.574862633914, 6560.639164845788, 6608.570442921195, 6611.173603299588, 6619.702113405005, 6601.801945941629, 6618.70215840298, 6642.036904648702, 6682.966585167043, 6749.865002700017, 6276.905846412216, 6426.582272152295, 6481.092647029325, 6509.902351464826, 6520.836979075371], "value": 6169.549517337342, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [831.2850948184564, 859.9183077607627, 873.3231745397317, 874.278720055954, 881.4931414436696, 40973.79513102434, 42077.78961105194, 42093.7895310523, 42199.36700949485, 42219.15561688764, 38670.0, 38748.612513874854, 42607.573924260745, 43041.0, 43278.783606081925, 7807.804804879866, 7907.16974717655, 7909.960450197741, 7917.643706033214, 7924.0, 7833.843323133534, 7952.0, 7956.443048986574, 7966.681332746683, 7968.163342849004, 7956.164602716689, 7983.201679832028, 7983.800404989864, 7986.0, 7989.800254993614, 7920.128785833554, 7961.60191990401, 7968.0, 7971.561564113971, 7972.24263694951, 7734.806629834299, 7790.493617914817, 7791.181925897756, 7796.532208067534, 7797.0, 38561.421578676345, 38784.22431551353, 38838.61161388378, 38840.61159388398, 38860.222795544214, 3515.542979412686, 3547.592026916912, 3557.1107223194203, 3557.8932632021083, 3558.3594952908725, 31729.365412691848, 31800.681993180002, 31891.0, 31927.52108718371, 32038.679613204036, 5021.799128034874, 5178.016176926372, 5211.0, 5217.034848552992, 5281.973590132025, 182653.0, 182773.0, 182971.0, 183676.0, 184213.07893460582, 47694.5230547697, 47864.282035769495, 47892.28161577579, 47966.0, 47985.0, 50244.49755502471, 50333.496665033614, 50356.74821625868, 50390.496095039314, 50411.49588504068, 15101.0, 15431.768523471932, 15439.61400964985, 15445.0, 15459.0, 12666.050046246568, 12687.873121268669, 12719.364031798374, 12738.936305318413, 12745.17156384832, 12302.323372214614, 12316.50733970649, 12399.938000309941, 12449.128561000824, 12449.190802597803, 4856.781444834991, 5044.798208071709, 5055.823046193365, 5074.898502029939, 5076.466970968069, 943.2454036770556, 991.548845275398, 998.670438755209, 1009.7828966772179, 1014.7564584499814, 22379.440513986956, 22507.212247571257, 22591.548169036527, 22620.321390358316, 22684.206052788075, 1041.1670663469345, 1098.7967226063204, 1100.9229353945148, 1101.7851518953887, 1117.1844553476008, 11837.585684501, 11955.701107472383, 12003.939980300043, 12006.87993120075, 12083.939580302042, 221563.0, 223322.0, 224184.0, 224330.0, 224375.0, 52250.0, 52406.0, 52490.47509524932, 55347.0, 55356.0, 1431.8210223722035, 1432.4986254810733, 1436.6408397900525, 1445.7831325301331, 1463.8828893688478, 26117.0, 26145.0, 26205.737942621094, 26369.4726105473, 26944.461110777283, 37416.6258337424, 37693.246135077694, 37697.0, 37701.24597508089, 37713.43429848499, 193098.0, 193126.0, 193404.0, 193456.0, 193685.0, 32875.835620821745, 32940.34119317648, 33308.833455832566, 33350.0, 33443.83278083594, 41857.37213941854, 42033.75670111325, 42236.155276893674, 42619.0, 42674.78662606667, 30739.846300768353, 30874.0, 31003.534946975364, 31278.37443251168, 31720.206994825316, 30403.54394684126, 30577.0, 30748.846255768578, 31067.223319417197, 31146.377072458876, 35339.409726561855, 35568.644313556535, 35759.106022349646, 35857.0, 35857.46213806743, 30781.23046923845, 31149.377012460078, 31200.375992480476, 31275.374492510477, 31943.520847186846, 22549.774502255423, 22723.318300451014, 22889.31332060041, 22933.312000640006, 23010.424739381648], "value": 16976.06516526383, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [560.2716468590834, 573.4781348972435, 573.9095718135542, 575.5338176077378, 587.248322147651, 21643.350699479022, 22421.551568968633, 22459.55080898381, 22517.0, 22552.323430297118, 23146.305610831703, 24296.63555046671, 24423.75576244237, 24545.0, 24970.50058998819, 6439.678016099199, 6532.8040158795075, 6568.540202185849, 6570.540062195648, 6575.93424065758, 6263.467605253536, 6462.483001359903, 6497.22033355998, 6560.606363618174, 6574.967125164368, 6508.02379643055, 6508.902366464483, 6512.772052978123, 6515.185601799775, 6516.185476815398, 6464.935350646504, 6478.805635830932, 6512.088307636935, 6514.543981921267, 6524.086627872101, 6017.308009578867, 6031.487323577501, 6054.606450580743, 6055.788047418319, 6057.697115144225, 27047.323816904536, 27724.861375693195, 28062.43875122486, 28245.29386765327, 28279.85860070707, 1966.2921348314596, 2000.8899510526915, 2001.109506269696, 2004.3986803958753, 2005.91976320947, 18135.274589016422, 18535.721964170414, 19060.904695476434, 19768.308109216254, 19859.106340214727, 2445.963310550343, 2463.1132792194794, 2486.191987604036, 2489.253224032783, 2508.5359208546297, 124320.37839810744, 128649.0, 135925.0, 135930.0, 143022.56977430196, 14713.55859324222, 14754.557363279118, 14938.60982242836, 15072.246387680572, 15134.848651513565, 22293.55412891733, 22324.767523247545, 22352.441188970082, 22359.66460503094, 22364.88817555902, 10059.949700251453, 10147.441890695934, 10165.135963443043, 10184.847227291448, 10341.948290258651, 9515.57179926905, 9531.285153613506, 9570.808583828284, 9668.129868311886, 9691.854622180674, 8926.152015558642, 9007.324450666096, 9011.594478248495, 9072.95463522678, 9344.486053266999, 2594.260635718811, 2614.8169628125847, 2640.6699162604673, 2753.8347699138117, 2756.724327567267, 937.901520340368, 938.877945867033, 941.2187884056217, 945.9905400945902, 948.3788118782209, 18111.275548977894, 18226.362077327496, 18689.81310186908, 18785.436436906915, 18938.81061189398, 981.342500524636, 993.076438911819, 995.1491474789096, 1000.8048430555972, 1007.0684616729496, 10190.847137292947, 10267.640632577824, 10347.482625868677, 10398.168146548258, 10567.101796347397, 496613.0, 502707.0, 508369.0, 518110.0, 518672.0, 111155.44422277837, 113562.0, 114819.42590286995, 114830.0, 115097.0, 1010.8129995950626, 1054.8734151901822, 1135.954561817518, 1154.1055681846635, 1169.2516789254885, 19506.609867802847, 19532.90233548823, 19592.902035489733, 19619.313324033592, 19867.105980230634, 53278.2008269884, 54032.0, 54583.0, 55553.444465556444, 56859.71570142123, 70508.64745676238, 70661.0, 70800.29199707937, 70820.64589677019, 71128.64435677789, 13872.0, 14130.293485325486, 14172.149671019772, 14209.715805684034, 14299.356528956014, 21984.45038874041, 21985.120595176653, 22160.88919555392, 22336.441588960406, 22380.216692415688, 17531.298748049936, 17756.733648995534, 17828.19773110239, 17878.374256901465, 17894.731579026586, 15854.682906341577, 15964.201789910227, 16578.0, 16631.667366652357, 16728.41450549225, 17065.89071710335, 17508.037057961934, 17769.289228430716, 18229.0, 18300.81699182991, 13821.170729756246, 13901.513447029305, 14015.439382424589, 14035.36840842185, 14037.087589306662, 17240.0, 17434.651306974043, 17775.0, 17897.821021789616, 17953.910230448764], "value": 11747.231132714744, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1325.138659871084, 1387.945161677125, 1402.8807551358136, 1405.1428628536598, 1429.8069760582318, 14703.33834977426, 15307.770383444244, 15323.310451029702, 15326.693466130671, 15370.385184592631, 15054.84945150548, 15117.773233401507, 15140.924295378536, 15179.089254644728, 15185.468508602202, 2689.798265130123, 2705.7564819166273, 2738.945221095577, 2755.9586606200924, 2762.074704973836, 2693.0, 2726.577380506015, 2735.2341344423594, 2735.603337516059, 2743.1359121876544, 2578.200757765099, 2646.76179143877, 2752.2018614601843, 2761.5443451830424, 2766.958495622567, 2691.851948142851, 2701.770349520283, 2725.11433784021, 2728.249731323902, 2734.671839379277, 2602.7267136950536, 2608.321836322551, 2621.108823000189, 2621.2267381122615, 2624.3307956471167, 14947.476838310715, 15045.623859403602, 15190.240487975558, 15199.696006079927, 15205.695886082216, 7907.920920790776, 8172.632231549535, 8177.918220817775, 8184.140665230184, 8184.468009579358, 5151.330327057496, 5296.814611488618, 5301.390340110898, 5321.494458026481, 5384.057789886754, 1794.97307540387, 1843.8709290349682, 1845.6954602490573, 1881.2663061406063, 1891.8391936685398, 26479.205623831123, 26806.463870722673, 26872.328191795164, 26902.730972690024, 26922.461550768876, 6796.35434633709, 6814.216365117975, 6870.793876183722, 6985.301469852974, 6990.0, 17165.0, 17173.656526869392, 17203.65592688164, 17211.741823872653, 17247.0, 7670.27132422419, 7793.337566306814, 7800.804979875548, 7803.297703206738, 7804.492707973964, 7132.393746531499, 7176.210616832144, 7252.673629686677, 7332.8900066499045, 7463.626818659154, 5003.674761140514, 5134.332536770196, 5140.40885298188, 5202.791888324425, 5203.60972927032, 1571.7406627906266, 1575.4328441760956, 1581.6362236685397, 1584.896981696186, 1594.4897632757638, 787.4527203593562, 900.1628485508539, 908.4957848394205, 933.4725879877983, 937.0676177203726, 8628.39601227908, 8691.782705432288, 8737.475751454806, 8766.693165739296, 8801.823963520694, 978.2760757039881, 1015.6851376073441, 1018.1193267823279, 1025.108155904368, 1032.948352582368, 5251.632385732962, 5265.894682106336, 5266.289050978069, 5378.489043540857, 5516.613837031369, 20261.29085482001, 21289.68065479019, 21385.67921481179, 21971.121155153614, 22013.22953696613, 21588.136474540843, 21812.89093554522, 21933.341999740034, 22031.66952495714, 22060.0, 9893.703188904345, 10452.843207351896, 10462.0, 10584.312019718695, 10632.362058276374, 8230.42387032902, 8328.875066874123, 8352.206540378655, 8409.075001749925, 8423.831523369376, 18296.0, 18445.81554184441, 18721.53196170107, 18915.71626425577, 19078.61842763165, 18862.24551017999, 19012.429627111207, 19015.80984190196, 19098.52253693669, 19469.805301947366, 10920.453977301262, 11032.393218373067, 11083.390413527011, 11088.501017454395, 11093.611723589636, 13263.403146858607, 13500.122492037986, 13595.252261125734, 13595.660108497366, 13660.453581857011, 11225.60710375133, 11402.771944561227, 11404.885951140383, 11588.304701717923, 11660.941695291809, 11178.0, 11183.32900026001, 11284.492197850952, 11327.433628318717, 11497.137714671266, 9880.950595246977, 9941.105300522988, 9955.751106222402, 10087.24345674092, 10104.09063184317, 7075.787726368218, 7150.821229469305, 7194.1726701427915, 7210.423166146591, 7242.348188663045, 7224.602646854473, 7343.302386273295, 7387.704491820267, 7431.962840185764, 7461.328480436787], "value": 6684.111001108917, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [488.73608251544164, 507.7309026216104, 516.7312997241432, 520.7812718658163, 530.8009496438835, 6255.937440625592, 6313.842153946153, 6341.270753863307, 6346.555741098114, 6395.232572091344, 6285.5914365566205, 6286.779962701306, 6288.5912415693065, 6293.150424692665, 6324.462420694246, 5198.506141916512, 5200.115980283361, 5206.01085793698, 5215.504527069932, 5241.685498870061, 4859.951400485986, 4978.825741099062, 5181.689098654074, 5194.71429071401, 5224.843254702365, 4974.035256073848, 4974.303597496353, 4977.47736487669, 4996.4503904570465, 5018.623603229754, 4957.975210123926, 4960.70235785854, 4965.726885021322, 4978.452370239271, 4995.400551933755, 4291.7854107294825, 4424.557544245582, 4466.062126953344, 4504.324351347292, 4506.301523263899, 6131.877362452726, 6160.322364539897, 6165.136880836686, 6169.259688837368, 6177.69111544421, 5656.830295091113, 5675.801346952837, 5734.122524412469, 5755.0, 5787.0, 6641.335866413368, 6652.334766523358, 6679.165104361955, 6679.966600166968, 6699.564528305645, 4844.806207751686, 4851.345068415754, 4888.242322440027, 4888.682235654671, 4918.360613120307, 6539.803805885784, 6680.3987641112535, 6831.897521537181, 6871.278515755874, 6924.965375173142, 4925.13810083234, 4951.306817045616, 4993.65171403719, 5004.549590536796, 5019.623528235397, 5003.249512573143, 5009.841831280029, 5059.772310246048, 5081.8729531762, 5088.211327244283, 5650.378458369576, 5684.943150568524, 5702.8289151325525, 5703.201551782754, 5703.201551782754, 6459.320576650105, 6603.273639899608, 6618.007298905107, 6650.600963942082, 6656.201255849232, 1730.2127531972922, 1739.1912760566397, 1766.9911650441666, 1769.2038582637865, 1776.875618706678, 1145.6963904565298, 1192.2369683402628, 1200.6938230751102, 1216.4100411300512, 1229.9016078713682, 5704.743286552115, 5708.343540492813, 5718.599698021098, 5722.971385143048, 5742.827715168552, 6549.181352330958, 6685.966570167216, 6686.4985126115735, 6713.295104014008, 6737.686151200567, 5597.697358558388, 5627.943720562824, 5717.885642287131, 5741.85645358861, 5781.277340332458, 3519.155402703384, 3559.6974257187912, 3578.7315951303235, 3594.101474631342, 3613.638636136365, 6402.135711678957, 6413.486921046305, 6472.417482426604, 6473.935260647428, 6482.0, 6750.35871592198, 6806.251312355637, 6826.726930922708, 6829.385355317946, 6863.6568171591225, 6319.873602527924, 6359.713812878432, 6420.839479012875, 6459.321771214049, 6482.611043337415, 6546.072356586201, 6555.6066636002, 6585.769498067544, 6602.273749887605, 6621.205455345389, 6633.3035031321015, 6754.459643228432, 6754.763583274562, 6762.695678694569, 6766.0, 6377.649229292433, 6444.742210311535, 6461.418472337512, 6463.127477790438, 6514.641694706647, 5349.224362467498, 5519.972400138135, 5535.418781027934, 5542.667439953616, 5555.972220138873, 6322.407812796731, 6406.295307516077, 6498.252700939453, 6795.3204679531655, 6877.243503214542, 6461.903071454026, 6500.70746816385, 6527.379898909596, 6530.346965303432, 6568.47452203813, 6471.676416179078, 6473.417392434703, 6527.967360163168, 6539.901901471387, 6587.242467116152, 6372.55392122547, 6407.949456174166, 6454.096041667814, 6464.644444555594, 6493.740250389931, 6585.617020425572, 6637.668116594247, 6639.734410623521, 6649.60102393858, 6658.067870498231, 6242.875142497215, 6310.6213627182515, 6349.523785715997, 6413.2945376007665, 6414.711337989708], "value": 5070.114346026246, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [882.139913584255, 914.7301546043917, 933.8832645919256, 934.1825902335461, 939.4222553129825, 16106.0, 16680.916595417035, 16763.0, 16771.0, 16781.328746850126, 17279.74080388795, 17547.73678394825, 17749.29002839885, 17796.46610601684, 17888.552786180353, 958.8993155718654, 972.3728195314018, 974.532224532225, 976.0142256321132, 976.2336565795852, 906.8367693815111, 975.2052077556804, 977.5161295158871, 996.0338471682456, 999.9650012249573, 1029.8197815382316, 1048.6015314180602, 1050.1074087026043, 1051.4217180550704, 1051.7791263834565, 1025.4821315235795, 1043.233223580664, 1043.4782608695652, 1043.7599352148973, 1044.3785947361307, 755.1579988313047, 764.3388468974352, 764.9043869516311, 770.2836362183167, 770.2951799103869, 17484.737728934077, 17531.211095500734, 17775.644487110185, 17915.462536123938, 17931.0, 21953.560928781335, 21970.121195152176, 22289.55420891589, 22415.0, 22441.214557490573, 17834.84073535216, 17846.107694615217, 17979.550511237194, 18095.0, 18100.094995250183, 3776.018235258825, 3808.1431677872533, 3845.1348446599573, 3848.749831260987, 3855.036240939765, 135616.0, 136221.0, 137112.0, 137392.31303843416, 139434.0, 16104.75842862358, 16206.270717817726, 16324.428644997368, 16488.422905198502, 16511.587210319838, 31112.533312000338, 31678.366432671217, 31766.2058448536, 31813.52279715806, 31828.840855795574, 7956.880646790303, 8048.879266811003, 8126.0, 8167.509949403055, 8203.097659257477, 4132.152908653718, 4209.915801683949, 4214.009707718684, 4214.7471151731, 4229.97885010573, 5386.380566234855, 5472.534834539029, 5473.917891231635, 5527.0, 5530.861728456821, 985.3693636072919, 1021.5505177721778, 1024.2420608749471, 1025.7948410317817, 1028.7325295423243, 664.1764212376618, 693.6739732325799, 710.4245561095529, 712.3659942650941, 717.5694583250008, 11002.779944401067, 11533.826992595117, 11917.821232681517, 12124.818127728091, 12451.25292482454, 704.3942209699654, 708.3660124188822, 709.2800807180715, 711.416638356553, 716.3910675925525, 5376.91934620981, 5414.891702166014, 5417.106177480671, 5437.809676661298, 5541.251930989265, 115697.42151289358, 121680.39159804145, 122270.0, 123619.0, 125812.0, 104032.47983760033, 106416.0, 107900.46049769701, 108350.45824770826, 109067.45466272776, 98226.0, 98885.0, 99229.50385248172, 99288.5035574803, 99860.0, 9868.358556693793, 10149.64476243328, 10191.0, 10322.845157322496, 10345.431001295, 41169.58830411657, 42460.78769606132, 42624.0, 42627.7868610655, 42662.57337426586, 55091.17363239635, 55244.72377638086, 55361.44638553563, 55481.0, 55698.72150639221, 15802.841971580598, 15825.287862046005, 15858.444954426539, 15939.60150996188, 16031.599210019844, 14421.351039203471, 14454.566363009126, 14528.0, 14690.0, 14703.92648036753, 16204.918975405048, 16407.753883691516, 16449.095299758148, 16481.25834337434, 16500.504984850475, 13363.732725345633, 13613.591592252249, 13653.044286899822, 13689.794653080411, 13692.110012849133, 14984.026038307475, 15137.470188543348, 15301.846981530041, 15304.846951530342, 15306.77039844381, 10615.522301496605, 10823.134149268197, 10978.341299522055, 11069.5018724156, 11118.388488633203, 10786.784264314512, 10899.945500272448, 11020.779584408107, 11059.61291354831, 11243.775124497628], "value": 8720.038128874925, "unit": "score"}]}, {"extraOptions": ["e10s", "stylo_disabled"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1419.5999999999997, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [108.0, 108.0, 108.0, 106.0, 107.0, 110.0, 109.0, 106.0, 107.0, 106.0], "value": 107.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [120.0, 120.0, 116.0, 120.0, 150.0, 119.0, 115.0, 149.0, 120.0, 121.0], "value": 125.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 161.0, 161.0, 162.0, 161.0, 161.0, 166.0, 167.0, 167.0, 163.0], "value": 163.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 73.0, 73.0, 72.0, 73.0, 74.0, 74.0, 73.0, 77.0, 75.0], "value": 74.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 79.0, 79.0, 80.0, 78.0, 79.0, 80.0, 79.0, 81.0, 80.0], "value": 79.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 113.0, 114.0, 116.0, 113.0, 117.0, 113.0, 116.0, 114.0, 117.0], "value": 114.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 149.0, 149.0, 150.0, 148.0, 146.0, 148.0, 149.0, 148.0, 148.0], "value": 148.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 94.0, 94.0, 94.0, 94.0, 94.0, 94.0, 94.0, 95.0, 95.0], "value": 94.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 52.0, 52.0, 53.0, 52.0, 52.0, 51.0, 51.0, 52.0, 58.0], "value": 52.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [40.0, 37.0, 38.0, 37.0, 38.0, 38.0, 37.0, 37.0, 39.0, 37.0], "value": 37.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 73.0, 75.0, 74.0, 72.0, 74.0, 75.0, 74.0, 74.0, 75.0], "value": 74.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 113.0, 111.0, 111.0, 116.0, 113.0, 120.0, 109.0, 114.0, 112.0], "value": 113.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [173.0, 171.0, 167.0, 170.0, 169.0, 166.0, 167.0, 175.0, 170.0, 173.0], "value": 170.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 65.0, 65.0, 64.0, 63.0, 66.0, 66.0, 66.0, 65.0, 64.0], "value": 65.3, "unit": "score"}]}]} 16:18:12 INFO - Return code: 0 16:18:12 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 16:18:12 INFO - # TBPL SUCCESS # 16:18:12 INFO - Running post-action listener: _package_coverage_data 16:18:12 INFO - Running post-action listener: _resource_record_post_action 16:18:12 INFO - [mozharness: 2017-09-13 23:18:12.234764Z] Finished run-tests step (success) 16:18:12 INFO - Running post-run listener: _resource_record_post_run 16:18:12 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 0; Write bytes: 337158144; Read time: 0; Write time: 396120 16:18:12 INFO - TinderboxPrint: CPU usage
13.1% 16:18:12 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 16:18:12 INFO - TinderboxPrint: I/O write bytes / time
337,158,144 / 396,120 16:18:12 INFO - TinderboxPrint: CPU idle
8,243.1 (86.9%) 16:18:12 INFO - TinderboxPrint: CPU user
1,193.5 (12.6%) 16:18:12 INFO - TinderboxPrint: Swap in / out
0 / 0 16:18:12 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 9719808; Read time: 0; Write time: 2640 16:18:12 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 16:18:12 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 0; Write bytes: 326299648; Read time: 0; Write time: 393268 16:18:12 INFO - Running post-run listener: _upload_blobber_files 16:18:12 INFO - Blob upload gear active. 16:18:12 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:18:12 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:18:12 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-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 16:18:12 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-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 16:18:13 INFO - (blobuploader) - INFO - Open directory for files ... 16:18:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 16:18:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:18:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:18:14 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 16:18:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:18:14 INFO - (blobuploader) - INFO - Done attempting. 16:18:14 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log ... 16:18:14 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:18:14 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:18:15 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_errorsummary.log: uploaded 16:18:15 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:18:15 INFO - (blobuploader) - INFO - Done attempting. 16:18:15 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 16:18:15 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:18:15 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:18:22 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 16:18:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:18:22 INFO - (blobuploader) - INFO - Done attempting. 16:18:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log ... 16:18:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:18:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:18:23 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_raw.log: uploaded 16:18:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:18:23 INFO - (blobuploader) - INFO - Done attempting. 16:18:23 INFO - (blobuploader) - INFO - Iteration through files over. 16:18:23 INFO - Return code: 0 16:18:23 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:18:23 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:18:23 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4ac09f598910ab3582d52ef1a4726931d2a65156478e493e0d78c017676dc1184d3a271ba54afc4e420302a4d25d14e18bd1e68f651e543dfc2f8d11b68999d", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0382d00af41cd0d1fe0a396190bde76c74ca4bf89fd3c4322a2c84e054ad36bd07fb99f9adf3b961f4862fec92d8b0b808c4b4a33672d659c957bd1a6f4d8257", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/f5f3b9cd685694f4237a05d939db77186f4c51949683d432cb8314d06ca48c202d818f3ca2170829435dcf8112e950f1cf9e710a05103b17a2a36d27d05a43b8", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/50d1c5ae1c50fe2d6ee25967bf647060e16fa6ca52e889548e02fcd9a96a25b4fa0b9c3fd1511ff177271327f816d4e0ecfc81f757ef911744d76f48225fbf58"} 16:18:23 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:18:23 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:18:23 INFO - Contents: 16:18:23 INFO - blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4ac09f598910ab3582d52ef1a4726931d2a65156478e493e0d78c017676dc1184d3a271ba54afc4e420302a4d25d14e18bd1e68f651e543dfc2f8d11b68999d", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0382d00af41cd0d1fe0a396190bde76c74ca4bf89fd3c4322a2c84e054ad36bd07fb99f9adf3b961f4862fec92d8b0b808c4b4a33672d659c957bd1a6f4d8257", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/f5f3b9cd685694f4237a05d939db77186f4c51949683d432cb8314d06ca48c202d818f3ca2170829435dcf8112e950f1cf9e710a05103b17a2a36d27d05a43b8", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/50d1c5ae1c50fe2d6ee25967bf647060e16fa6ca52e889548e02fcd9a96a25b4fa0b9c3fd1511ff177271327f816d4e0ecfc81f757ef911744d76f48225fbf58"} 16:18:23 INFO - Running post-run listener: copy_logs_to_upload_dir 16:18:23 INFO - Copying logs to upload dir... 16:18:23 INFO - mkdir: /builds/slave/test/build/upload/logs 16:18:23 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1242.507608 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 42 secs) (at 2017-09-13 16:18:23.688021) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-13 16:18:23.692755) ========= 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=ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4ac09f598910ab3582d52ef1a4726931d2a65156478e493e0d78c017676dc1184d3a271ba54afc4e420302a4d25d14e18bd1e68f651e543dfc2f8d11b68999d", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0382d00af41cd0d1fe0a396190bde76c74ca4bf89fd3c4322a2c84e054ad36bd07fb99f9adf3b961f4862fec92d8b0b808c4b4a33672d659c957bd1a6f4d8257", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/f5f3b9cd685694f4237a05d939db77186f4c51949683d432cb8314d06ca48c202d818f3ca2170829435dcf8112e950f1cf9e710a05103b17a2a36d27d05a43b8", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/50d1c5ae1c50fe2d6ee25967bf647060e16fa6ca52e889548e02fcd9a96a25b4fa0b9c3fd1511ff177271327f816d4e0ecfc81f757ef911744d76f48225fbf58"} build_url:https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011352 build_url: 'https://queue.taskcluster.net/v1/task/A1V4MAzpSR2fT4tPLmTCBw/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e4ac09f598910ab3582d52ef1a4726931d2a65156478e493e0d78c017676dc1184d3a271ba54afc4e420302a4d25d14e18bd1e68f651e543dfc2f8d11b68999d", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0382d00af41cd0d1fe0a396190bde76c74ca4bf89fd3c4322a2c84e054ad36bd07fb99f9adf3b961f4862fec92d8b0b808c4b4a33672d659c957bd1a6f4d8257", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/f5f3b9cd685694f4237a05d939db77186f4c51949683d432cb8314d06ca48c202d818f3ca2170829435dcf8112e950f1cf9e710a05103b17a2a36d27d05a43b8", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/50d1c5ae1c50fe2d6ee25967bf647060e16fa6ca52e889548e02fcd9a96a25b4fa0b9c3fd1511ff177271327f816d4e0ecfc81f757ef911744d76f48225fbf58"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-13 16:18:23.724093) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 16:18:23.724463) ========= 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=ba164b0a7b0ec7655860e956000001c1-1505343457.402408-2112587102 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004573 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-13 16:18:23.807503) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-13 16:18:23.807876) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-13 16:18:23.808232) ========= ========= Total master_lag: 0.58 =========