builder: mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s slave: talos-linux64-ix-085 starttime: 1505814917.2 results: success (0) revision: 7c12af6fd620adc74e9dfb622d17966bdebdf2ac ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:17.203350) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:17.203789) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:17.206106) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:17.324376) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:17.324699) ========= 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=5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-19 02:55:17-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 45.9M=0s 2017-09-19 02:55:17 (45.9 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.121832 ========= master_lag: 0.06 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:17.502927) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:17.507270) ========= 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=5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023154 ========= master_lag: 0.07 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:17.599008) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 13 secs) (at 2017-09-19 02:55:17.599356) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 7c12af6fd620adc74e9dfb622d17966bdebdf2ac --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 7c12af6fd620adc74e9dfb622d17966bdebdf2ac --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=5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-19 02:55:17,858 truncating revision to first 12 chars 2017-09-19 02:55:17,858 Setting DEBUG logging. 2017-09-19 02:55:17,858 attempt 1/10 2017-09-19 02:55:17,858 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/7c12af6fd620?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-19 02:55:19,000 attempt 1/10 2017-09-19 02:55:19,514 current task status: no status available at this point. state: STARTED 2017-09-19 02:55:19,515 sleeping for 11.00s (attempt 1/10) 2017-09-19 02:55:30,526 attempt 2/10 2017-09-19 02:55:30,878 current task status: Task completed! Check 's3_urls' for upload locations. state: SUCCESS 2017-09-19 02:55:31,050 unpacking tar archive at: mozilla-central-7c12af6fd620/testing/mozharness/ program finished with exit code 0 elapsedTime=13.502800 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 13 secs) (at 2017-09-19 02:55:31.146368) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:31.146669) ========= script_repo_revision: 7c12af6fd620adc74e9dfb622d17966bdebdf2ac ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:31.147038) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:31.147298) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-19 02:55:31.161982) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2017-09-19 02:55:31.162293) ========= /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=5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 02:55:31 INFO - MultiFileLogger online at 20170919 02:55:31 in /builds/slave/test 02:55:31 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 02:55:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 02:55:31 INFO - {'append_to_log': False, 02:55:31 INFO - 'base_work_dir': '/builds/slave/test', 02:55:31 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 02:55:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 02:55:31 INFO - 'branch': 'Firefox-Non-PGO', 02:55:31 INFO - 'buildbot_json_path': 'buildprops.json', 02:55:31 INFO - 'code_coverage': False, 02:55:31 INFO - 'config_files': ('talos/linux_config.py',), 02:55:31 INFO - 'default_actions': ('clobber', 02:55:31 INFO - 'read-buildbot-config', 02:55:31 INFO - 'download-and-extract', 02:55:31 INFO - 'populate-webroot', 02:55:31 INFO - 'create-virtualenv', 02:55:31 INFO - 'install', 02:55:31 INFO - 'setup-mitmproxy', 02:55:31 INFO - 'run-tests'), 02:55:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 02:55:31 INFO - 'disable_ccov_upload': False, 02:55:31 INFO - 'disable_stylo': False, 02:55:31 INFO - 'download_minidump_stackwalk': True, 02:55:31 INFO - 'download_symbols': 'ondemand', 02:55:31 INFO - 'enable_stylo': False, 02:55:31 INFO - 'enable_webrender': False, 02:55:31 INFO - 'exes': {'tooltool.py': '/tools/tooltool.py'}, 02:55:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 02:55:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 02:55:31 INFO - 'gecko_profile': False, 02:55:31 INFO - 'gecko_profile_interval': 0, 02:55:31 INFO - 'installer_path': 'installer.exe', 02:55:31 INFO - 'log_level': 'info', 02:55:31 INFO - 'log_name': 'talos', 02:55:31 INFO - 'log_to_console': True, 02:55:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 02:55:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 02:55:31 INFO - 'opt_config_files': (), 02:55:31 INFO - 'pip_index': False, 02:55:31 INFO - 'suite': 'dromaeojs-stylo-disabled-e10s', 02:55:31 INFO - 'system_bits': '32', 02:55:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 02:55:31 INFO - 'title': 'talos-linux64-ix-085', 02:55:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 02:55:31 INFO - 'use_talos_json': True, 02:55:31 INFO - 'verify': 'False', 02:55:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 02:55:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 02:55:31 INFO - 'work_dir': 'build'} 02:55:31 INFO - [mozharness: 2017-09-19 09:55:31.541306Z] Running clobber step. 02:55:31 INFO - Running pre-action listener: _resource_record_pre_action 02:55:31 INFO - Running main action method: clobber 02:55:31 INFO - rmtree: /builds/slave/test/build 02:55:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 02:55:33 INFO - Running post-action listener: _resource_record_post_action 02:55:33 INFO - [mozharness: 2017-09-19 09:55:33.070467Z] Finished clobber step (success) 02:55:33 INFO - [mozharness: 2017-09-19 09:55:33.070565Z] Running read-buildbot-config step. 02:55:33 INFO - Running pre-action listener: _resource_record_pre_action 02:55:33 INFO - Running main action method: read_buildbot_config 02:55:33 INFO - Using buildbot properties: 02:55:33 INFO - { 02:55:33 INFO - "project": "", 02:55:33 INFO - "product": "firefox", 02:55:33 INFO - "who": "archaeopteryx@coole-files.de", 02:55:33 INFO - "installer_path": "public/build/target.tar.bz2", 02:55:33 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s", 02:55:33 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 02:55:33 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-stylo-disabled-e10s", 02:55:33 INFO - "stage_platform": "linux64", 02:55:33 INFO - "basedir": "/builds/slave/test", 02:55:33 INFO - "buildnumber": 41, 02:55:33 INFO - "platform": "ubuntu64_hw", 02:55:33 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 02:55:33 INFO - "slavebuilddir": "test", 02:55:33 INFO - "taskId": "JqFYolMyRRS9ksQgoV7tuw", 02:55:33 INFO - "branch": "mozilla-central", 02:55:33 INFO - "script_repo_revision": "production", 02:55:33 INFO - "revision": "7c12af6fd620adc74e9dfb622d17966bdebdf2ac", 02:55:33 INFO - "slavename": "talos-linux64-ix-085", 02:55:33 INFO - "repo_path": "mozilla-central" 02:55:33 INFO - } 02:55:33 INFO - Finding installer, test and symbols from parent task. 02:55:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/JqFYolMyRRS9ksQgoV7tuw'}, attempt #1 02:55:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/JqFYolMyRRS9ksQgoV7tuw'}, attempt #1 02:55:33 INFO - Task dependencies: E2iwetAjQBK55x0sv57OwA 02:55:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA'}, attempt #1 02:55:34 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.tar.bz2 02:55:34 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.test_packages.json 02:55:34 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.crashreporter-symbols.zip 02:55:34 INFO - Running post-action listener: _resource_record_post_action 02:55:34 INFO - [mozharness: 2017-09-19 09:55:34.409296Z] Finished read-buildbot-config step (success) 02:55:34 INFO - [mozharness: 2017-09-19 09:55:34.409557Z] Running download-and-extract step. 02:55:34 INFO - Running pre-action listener: _resource_record_pre_action 02:55:34 INFO - Running main action method: download_and_extract 02:55:34 INFO - mkdir: /builds/slave/test/build/tests 02:55:34 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')]} 02:55:34 INFO - trying https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.test_packages.json 02:55:34 INFO - Downloading https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 02:55:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 02:55:34 INFO - Downloaded 989 bytes. 02:55:34 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 02:55:34 INFO - Using the following test package requirements: 02:55:34 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 02:55:34 INFO - u'common': [u'target.common.tests.zip'], 02:55:34 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 02:55:34 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 02:55:34 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 02:55:34 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 02:55:34 INFO - u'mozbase': [u'target.common.tests.zip'], 02:55:34 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 02:55:34 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 02:55:34 INFO - u'web-platform': [u'target.common.tests.zip', 02:55:34 INFO - u'target.web-platform.tests.tar.gz'], 02:55:34 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 02:55:34 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 02:55:34 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.common.tests.zip 02:55:34 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.common.tests.zip'}, attempt #1 02:55:34 INFO - Fetch https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.common.tests.zip into memory 02:55:36 INFO - Content-Length response header: 54731598 02:55:36 INFO - Bytes received: 54731598 02:55:46 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.talos.tests.zip 02:55:46 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.talos.tests.zip'}, attempt #1 02:55:46 INFO - Fetch https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.talos.tests.zip into memory 02:55:47 INFO - Content-Length response header: 14508787 02:55:47 INFO - Bytes received: 14508787 02:55:47 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')]} 02:55:47 INFO - trying https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.tar.bz2 02:55:47 INFO - Downloading https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 02:55:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 02:55:49 INFO - Downloaded 61520244 bytes. 02:55:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.tar.bz2 02:55:49 INFO - mkdir: /builds/slave/test/properties 02:55:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 02:55:49 INFO - Writing to file /builds/slave/test/properties/build_url 02:55:49 INFO - Contents: 02:55:49 INFO - build_url:https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.tar.bz2 02:55:49 INFO - Running post-action listener: _resource_record_post_action 02:55:49 INFO - Running post-action listener: find_tests_for_verification 02:55:49 INFO - Running post-action listener: set_extra_try_arguments 02:55:49 INFO - [mozharness: 2017-09-19 09:55:49.826361Z] Finished download-and-extract step (success) 02:55:49 INFO - [mozharness: 2017-09-19 09:55:49.826503Z] Running populate-webroot step. 02:55:49 INFO - Running pre-action listener: _resource_record_pre_action 02:55:49 INFO - Running main action method: populate_webroot 02:55:49 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 02:55:49 INFO - 'chromez-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['tresize', 02:55:49 INFO - 'tcanvasmark']}, 02:55:49 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 02:55:49 INFO - 'dromaeojs-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['dromaeo_css', 02:55:49 INFO - 'kraken']}, 02:55:49 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 02:55:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:55:49 INFO - 'g1-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 02:55:49 INFO - 'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:55:49 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 02:55:49 INFO - 'tests': ['damp', 'tps']}, 02:55:49 INFO - 'g2-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 02:55:49 INFO - 'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['damp', 'tps']}, 02:55:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 02:55:49 INFO - 'g3-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['dromaeo_dom']}, 02:55:49 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 02:55:49 INFO - 'g4-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['basic_compositor_video', 02:55:49 INFO - 'glvideo']}, 02:55:49 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 02:55:49 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 02:55:49 INFO - 'g5-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 02:55:49 INFO - 'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['ts_paint_webext', 02:55:49 INFO - 'tp5o_webext']}, 02:55:49 INFO - 'other-e10s': {'tests': ['a11yr', 02:55:49 INFO - 'ts_paint', 02:55:49 INFO - 'tpaint', 02:55:49 INFO - 'sessionrestore', 02:55:49 INFO - 'sessionrestore_many_windows', 02:55:49 INFO - 'sessionrestore_no_auto_restore', 02:55:49 INFO - 'tabpaint']}, 02:55:49 INFO - 'other-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['a11yr', 02:55:49 INFO - 'ts_paint', 02:55:49 INFO - 'tpaint', 02:55:49 INFO - 'sessionrestore', 02:55:49 INFO - 'sessionrestore_many_windows', 02:55:49 INFO - 'sessionrestore_no_auto_restore', 02:55:49 INFO - 'tabpaint']}, 02:55:49 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 02:55:49 INFO - 'perf-reftest-singletons-e10s': {'tests': ['perf_reftest_singletons']}, 02:55:49 INFO - 'perf-reftest-singletons-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['perf_reftest_singletons']}, 02:55:49 INFO - 'perf-reftest-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['bloom_basic']}, 02:55:49 INFO - 'svgr-e10s': {'tests': ['tsvgx', 02:55:49 INFO - 'tsvgr_opacity', 02:55:49 INFO - 'tart', 02:55:49 INFO - 'tscrollx', 02:55:49 INFO - 'tsvg_static']}, 02:55:49 INFO - 'svgr-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['tsvgx', 02:55:49 INFO - 'tsvgr_opacity', 02:55:49 INFO - 'tart', 02:55:49 INFO - 'tscrollx', 02:55:49 INFO - 'tsvg_static']}, 02:55:49 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 02:55:49 INFO - 'tp5o-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 02:55:49 INFO - 'talos_options': ['--disable-stylo'], 02:55:49 INFO - 'tests': ['tp5o']}, 02:55:49 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 02:55:49 INFO - 'talos_options': ['--mitmproxy', 02:55:49 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 02:55:49 INFO - '--firstNonBlankPaint'], 02:55:49 INFO - 'tests': ['tp6_google', 02:55:49 INFO - 'tp6_youtube', 02:55:49 INFO - 'tp6_amazon', 02:55:49 INFO - 'tp6_facebook']}, 02:55:49 INFO - 'tp6-stylo-disabled-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 02:55:49 INFO - 'talos_options': ['--disable-stylo', 02:55:49 INFO - '--mitmproxy', 02:55:49 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 02:55:49 INFO - '--firstNonBlankPaint'], 02:55:49 INFO - 'tests': ['tp6_google', 02:55:49 INFO - 'tp6_youtube', 02:55:49 INFO - 'tp6_amazon', 02:55:49 INFO - 'tp6_facebook']}, 02:55:49 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 02:55:49 INFO - 'talos_options': ['--stylo-threads=1', 02:55:49 INFO - '--mitmproxy', 02:55:49 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 02:55:49 INFO - '--firstNonBlankPaint'], 02:55:49 INFO - 'tests': ['tp6_google', 02:55:49 INFO - 'tp6_youtube', 02:55:49 INFO - 'tp6_amazon', 02:55:49 INFO - 'tp6_facebook']}, 02:55:49 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 02:55:49 INFO - 'talos_options': ['--xperf_path', 02:55:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:55:49 INFO - 'tests': ['tp5n']}, 02:55:49 INFO - 'xperf-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 02:55:49 INFO - 'talos_options': ['--disable-stylo', 02:55:49 INFO - '--xperf_path', 02:55:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:55:49 INFO - 'tests': ['tp5n']}}} 02:55:49 INFO - Running post-action listener: _resource_record_post_action 02:55:49 INFO - [mozharness: 2017-09-19 09:55:49.842925Z] Finished populate-webroot step (success) 02:55:49 INFO - [mozharness: 2017-09-19 09:55:49.843033Z] Running create-virtualenv step. 02:55:49 INFO - Running pre-action listener: _resource_record_pre_action 02:55:49 INFO - Running main action method: create_virtualenv 02:55:49 INFO - Creating virtualenv /builds/slave/test/build/venv 02:55:49 INFO - Running command: ['virtualenv', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 02:55:49 INFO - Copy/paste: virtualenv --no-site-packages --distribute /builds/slave/test/build/venv 02:55:49 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 02:55:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 02:55:49 INFO - New python executable in /builds/slave/test/build/venv/bin/python 02:55:50 INFO - Installing distribute.............................................................................................................................................................................................done. 02:55:50 INFO - Installing pip...............done. 02:55:50 INFO - Return code: 0 02:55:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 02:55:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 02:55:50 INFO - Reading from file tmpfile_stdout 02:55:50 INFO - Output received: 02:55:50 INFO - pip 1.1 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.1-py2.7.egg (python 2.7) 02:55:50 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 02:55:50 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')]} 02:55:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:55:50 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')]} 02:55:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:55:50 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 0x12541f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x141da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15c0a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, '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': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', '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 02:55:50 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 02:55:50 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 02:55:50 INFO - Using env: {'DISPLAY': ':0', 02:55:50 INFO - 'HOME': '/home/cltbld', 02:55:50 INFO - 'LANG': 'en_US.UTF-8', 02:55:50 INFO - 'LANGUAGE': 'en_US:en', 02:55:50 INFO - 'LOGNAME': 'cltbld', 02:55:50 INFO - 'MAIL': '/var/mail/cltbld', 02:55:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:55:50 INFO - 'MOZ_NO_REMOTE': '1', 02:55:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:55:50 INFO - 'NO_EM_RESTART': '1', 02:55:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:55:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:55:50 INFO - 'PWD': '/builds/slave/test', 02:55:50 INFO - 'SHELL': '/bin/bash', 02:55:50 INFO - 'SHLVL': '1', 02:55:50 INFO - 'TERM': 'linux', 02:55:50 INFO - 'TMOUT': '86400', 02:55:50 INFO - 'USER': 'cltbld', 02:55:50 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:55:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:55:50 INFO - '_': '/tools/buildbot/bin/python'} 02:55:52 INFO - Ignoring indexes: http://pypi.python.org/simple/ 02:55:52 INFO - Downloading/unpacking pip>=1.5 02:55:52 INFO - Running setup.py egg_info for package pip 02:55:52 INFO - warning: no files found matching 'pip/cacert.pem' 02:55:52 INFO - warning: no files found matching '*.html' under directory 'docs' 02:55:52 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 02:55:52 INFO - no previously-included directories found matching 'docs/_build/_sources' 02:55:52 INFO - Installing collected packages: pip 02:55:52 INFO - Found existing installation: pip 1.1 02:55:52 INFO - Uninstalling pip: 02:55:52 INFO - Successfully uninstalled pip 02:55:52 INFO - Running setup.py install for pip 02:55:52 INFO - warning: no files found matching 'pip/cacert.pem' 02:55:52 INFO - warning: no files found matching '*.html' under directory 'docs' 02:55:52 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 02:55:52 INFO - no previously-included directories found matching 'docs/_build/_sources' 02:55:52 INFO - Installing pip script to /builds/slave/test/build/venv/bin 02:55:52 INFO - Installing pip2.7 script to /builds/slave/test/build/venv/bin 02:55:52 INFO - Installing pip2 script to /builds/slave/test/build/venv/bin 02:55:52 INFO - Successfully installed pip 02:55:52 INFO - Cleaning up... 02:55:52 INFO - Return code: 0 02:55:52 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 02:55:52 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')]} 02:55:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:55:52 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')]} 02:55:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:55:52 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 0x12541f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x141da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15c0a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, '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': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', '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 02:55:52 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 02:55:52 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 02:55:52 INFO - Using env: {'DISPLAY': ':0', 02:55:52 INFO - 'HOME': '/home/cltbld', 02:55:52 INFO - 'LANG': 'en_US.UTF-8', 02:55:52 INFO - 'LANGUAGE': 'en_US:en', 02:55:52 INFO - 'LOGNAME': 'cltbld', 02:55:52 INFO - 'MAIL': '/var/mail/cltbld', 02:55:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:55:52 INFO - 'MOZ_NO_REMOTE': '1', 02:55:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:55:52 INFO - 'NO_EM_RESTART': '1', 02:55:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:55:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:55:52 INFO - 'PWD': '/builds/slave/test', 02:55:52 INFO - 'SHELL': '/bin/bash', 02:55:52 INFO - 'SHLVL': '1', 02:55:52 INFO - 'TERM': 'linux', 02:55:52 INFO - 'TMOUT': '86400', 02:55:52 INFO - 'USER': 'cltbld', 02:55:52 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:55:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:55:52 INFO - '_': '/tools/buildbot/bin/python'} 02:55:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:55:52 INFO - Downloading/unpacking psutil>=3.1.1 02:55:52 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 02:55:52 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 02:55:52 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 02:55:52 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 02:55:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 02:55:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:55:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:55:53 INFO - Installing collected packages: psutil 02:55:53 INFO - Running setup.py install for psutil 02:55:53 INFO - building 'psutil._psutil_linux' extension 02:55:53 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 02:55:53 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 02:55:53 INFO - building 'psutil._psutil_posix' extension 02:55:53 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 02:55:53 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 02:55:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:55:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:55:54 INFO - Successfully installed psutil 02:55:54 INFO - Cleaning up... 02:55:54 INFO - Return code: 0 02:55:54 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 02:55:54 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')]} 02:55:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:55:54 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')]} 02:55:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:55:54 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 0x12541f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x141da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15c0a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, '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': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', '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 02:55:54 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 02:55:54 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 02:55:54 INFO - Using env: {'DISPLAY': ':0', 02:55:54 INFO - 'HOME': '/home/cltbld', 02:55:54 INFO - 'LANG': 'en_US.UTF-8', 02:55:54 INFO - 'LANGUAGE': 'en_US:en', 02:55:54 INFO - 'LOGNAME': 'cltbld', 02:55:54 INFO - 'MAIL': '/var/mail/cltbld', 02:55:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:55:54 INFO - 'MOZ_NO_REMOTE': '1', 02:55:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:55:54 INFO - 'NO_EM_RESTART': '1', 02:55:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:55:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:55:54 INFO - 'PWD': '/builds/slave/test', 02:55:54 INFO - 'SHELL': '/bin/bash', 02:55:54 INFO - 'SHLVL': '1', 02:55:54 INFO - 'TERM': 'linux', 02:55:54 INFO - 'TMOUT': '86400', 02:55:54 INFO - 'USER': 'cltbld', 02:55:54 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:55:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:55:54 INFO - '_': '/tools/buildbot/bin/python'} 02:55:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:55:54 INFO - Downloading/unpacking mozsystemmonitor==0.3 02:55:54 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 02:55:54 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 02:55:54 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 02:55:54 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 02:55:55 INFO - Downloading mozsystemmonitor-0.3.tar.gz 02:55:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 02:55:55 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 02:55:55 INFO - Installing collected packages: mozsystemmonitor 02:55:55 INFO - Running setup.py install for mozsystemmonitor 02:55:55 INFO - Successfully installed mozsystemmonitor 02:55:55 INFO - Cleaning up... 02:55:57 INFO - Return code: 0 02:55:57 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 02:55: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')]} 02:55:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:55: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')]} 02:55:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:55:57 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 0x12541f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x141da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15c0a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, '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': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', '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 02:55:57 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 02:55:57 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 02:55:57 INFO - Using env: {'DISPLAY': ':0', 02:55:57 INFO - 'HOME': '/home/cltbld', 02:55:57 INFO - 'LANG': 'en_US.UTF-8', 02:55:57 INFO - 'LANGUAGE': 'en_US:en', 02:55:57 INFO - 'LOGNAME': 'cltbld', 02:55:57 INFO - 'MAIL': '/var/mail/cltbld', 02:55:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:55:57 INFO - 'MOZ_NO_REMOTE': '1', 02:55:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:55:57 INFO - 'NO_EM_RESTART': '1', 02:55:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:55:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:55:57 INFO - 'PWD': '/builds/slave/test', 02:55:57 INFO - 'SHELL': '/bin/bash', 02:55:57 INFO - 'SHLVL': '1', 02:55:57 INFO - 'TERM': 'linux', 02:55:57 INFO - 'TMOUT': '86400', 02:55:57 INFO - 'USER': 'cltbld', 02:55:57 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:55:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:55:57 INFO - '_': '/tools/buildbot/bin/python'} 02:55:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:55:57 INFO - Downloading/unpacking jsonschema==2.5.1 02:55:57 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 02:55:57 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 02:55:57 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 02:55:57 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 02:55:58 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 02:55:58 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 02:55:58 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 02:55:58 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 02:55:58 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 02:55:58 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 02:55:58 INFO - Downloading functools32-3.2.3-2.tar.gz 02:55:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 02:55:58 INFO - warning: no files found matching '*.txt' 02:55:58 INFO - no previously-included directories found matching 'build' 02:55:58 INFO - no previously-included directories found matching 'dist' 02:55:58 INFO - no previously-included directories found matching '.git*' 02:55:58 INFO - Installing collected packages: jsonschema, functools32 02:55:59 INFO - Running setup.py install for functools32 02:55:59 INFO - warning: no files found matching '*.txt' 02:55:59 INFO - no previously-included directories found matching 'build' 02:55:59 INFO - no previously-included directories found matching 'dist' 02:55:59 INFO - no previously-included directories found matching '.git*' 02:55:59 INFO - Successfully installed jsonschema functools32 02:55:59 INFO - Cleaning up... 02:55:59 INFO - Return code: 0 02:55:59 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 02:55:59 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')]} 02:55:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:55:59 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')]} 02:55:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:55:59 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 0x12541f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x141da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15c0a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, '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': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', '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 02:55:59 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 02:55:59 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 02:55:59 INFO - Using env: {'DISPLAY': ':0', 02:55:59 INFO - 'HOME': '/home/cltbld', 02:55:59 INFO - 'LANG': 'en_US.UTF-8', 02:55:59 INFO - 'LANGUAGE': 'en_US:en', 02:55:59 INFO - 'LOGNAME': 'cltbld', 02:55:59 INFO - 'MAIL': '/var/mail/cltbld', 02:55:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:55:59 INFO - 'MOZ_NO_REMOTE': '1', 02:55:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:55:59 INFO - 'NO_EM_RESTART': '1', 02:55:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:55:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:55:59 INFO - 'PWD': '/builds/slave/test', 02:55:59 INFO - 'SHELL': '/bin/bash', 02:55:59 INFO - 'SHLVL': '1', 02:55:59 INFO - 'TERM': 'linux', 02:55:59 INFO - 'TMOUT': '86400', 02:55:59 INFO - 'USER': 'cltbld', 02:55:59 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:55:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:55:59 INFO - '_': '/tools/buildbot/bin/python'} 02:55:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:56:00 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 02:56:00 INFO - Cleaning up... 02:56:00 INFO - Return code: 0 02:56:00 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 02:56: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')]} 02:56:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:56: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')]} 02:56:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:56: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', '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 0x12541f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x141da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15c0a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, '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': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', '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 02:56: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', 'blobuploader==1.2.4'] in /builds/slave/test/build 02:56: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 blobuploader==1.2.4 02:56:00 INFO - Using env: {'DISPLAY': ':0', 02:56:00 INFO - 'HOME': '/home/cltbld', 02:56:00 INFO - 'LANG': 'en_US.UTF-8', 02:56:00 INFO - 'LANGUAGE': 'en_US:en', 02:56:00 INFO - 'LOGNAME': 'cltbld', 02:56:00 INFO - 'MAIL': '/var/mail/cltbld', 02:56:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:56:00 INFO - 'MOZ_NO_REMOTE': '1', 02:56:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:56:00 INFO - 'NO_EM_RESTART': '1', 02:56:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:56:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:56:00 INFO - 'PWD': '/builds/slave/test', 02:56:00 INFO - 'SHELL': '/bin/bash', 02:56:00 INFO - 'SHLVL': '1', 02:56:00 INFO - 'TERM': 'linux', 02:56:00 INFO - 'TMOUT': '86400', 02:56:00 INFO - 'USER': 'cltbld', 02:56:00 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:56:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:56:00 INFO - '_': '/tools/buildbot/bin/python'} 02:56:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:56:00 INFO - Downloading/unpacking blobuploader==1.2.4 02:56:00 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 02:56:00 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 02:56:00 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 02:56:00 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 02:56:01 INFO - Downloading blobuploader-1.2.4.tar.gz 02:56:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 02:56:02 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 02:56:02 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 02:56:02 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 02:56:02 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 02:56:02 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 02:56:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 02:56:02 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 02:56:02 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 02:56:02 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 02:56:02 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 02:56:02 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 02:56:02 INFO - Downloading docopt-0.6.1.tar.gz 02:56:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 02:56:02 INFO - Installing collected packages: blobuploader, requests, docopt 02:56:02 INFO - Running setup.py install for blobuploader 02:56:02 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 02:56:02 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 02:56:02 INFO - Running setup.py install for requests 02:56:03 INFO - Running setup.py install for docopt 02:56:03 INFO - Successfully installed blobuploader requests docopt 02:56:03 INFO - Cleaning up... 02:56:03 INFO - Return code: 0 02:56:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:56: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')]} 02:56:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:56: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')]} 02:56:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:56:03 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 0x12541f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x141da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15c0a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, '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': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', '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 02:56:03 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 02:56:03 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 02:56:03 INFO - Using env: {'DISPLAY': ':0', 02:56:03 INFO - 'HOME': '/home/cltbld', 02:56:03 INFO - 'LANG': 'en_US.UTF-8', 02:56:03 INFO - 'LANGUAGE': 'en_US:en', 02:56:03 INFO - 'LOGNAME': 'cltbld', 02:56:03 INFO - 'MAIL': '/var/mail/cltbld', 02:56:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:56:03 INFO - 'MOZ_NO_REMOTE': '1', 02:56:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:56:03 INFO - 'NO_EM_RESTART': '1', 02:56:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:56:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:56:03 INFO - 'PWD': '/builds/slave/test', 02:56:03 INFO - 'SHELL': '/bin/bash', 02:56:03 INFO - 'SHLVL': '1', 02:56:03 INFO - 'TERM': 'linux', 02:56:03 INFO - 'TMOUT': '86400', 02:56:03 INFO - 'USER': 'cltbld', 02:56:03 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:56:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:56:03 INFO - '_': '/tools/buildbot/bin/python'} 02:56:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:56:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:56:03 INFO - Running setup.py (path:/tmp/pip-0hN9Ow-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:56:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:56:03 INFO - Running setup.py (path:/tmp/pip-UT6MDC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:56:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:56:03 INFO - Running setup.py (path:/tmp/pip-EDu7Y_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:56:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:56:03 INFO - Running setup.py (path:/tmp/pip-VwelLe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:56:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:56:03 INFO - Running setup.py (path:/tmp/pip-x83_1n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:56:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:56:03 INFO - Running setup.py (path:/tmp/pip-fDmadP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:56:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:56:03 INFO - Running setup.py (path:/tmp/pip-s6HY_S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:56:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:56:03 INFO - Running setup.py (path:/tmp/pip-uQPxx7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:56:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:56:03 INFO - Running setup.py (path:/tmp/pip-hjRCw_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:56:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:56:04 INFO - Running setup.py (path:/tmp/pip-95PyDo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:56:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:56:04 INFO - Running setup.py (path:/tmp/pip-Iuce9i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:56:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:56:04 INFO - Running setup.py (path:/tmp/pip-RurELi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:56:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:56:04 INFO - Running setup.py (path:/tmp/pip-H8mwy6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:56:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:56:04 INFO - Running setup.py (path:/tmp/pip-ojio0O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:56:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:56:04 INFO - Running setup.py (path:/tmp/pip-4beuhl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:56:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:56:04 INFO - Running setup.py (path:/tmp/pip-pHkTyG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:56:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:56:04 INFO - Running setup.py (path:/tmp/pip-B6GuTP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:56:04 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 02:56:04 INFO - Running setup.py install for manifestparser 02:56:04 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 02:56:04 INFO - Running setup.py install for mozcrash 02:56:04 INFO - Running setup.py install for mozdebug 02:56:04 INFO - Running setup.py install for mozdevice 02:56:04 INFO - Installing dm script to /builds/slave/test/build/venv/bin 02:56:04 INFO - Running setup.py install for mozfile 02:56:05 INFO - Running setup.py install for mozhttpd 02:56:05 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Running setup.py install for mozinfo 02:56:05 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Running setup.py install for mozInstall 02:56:05 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Running setup.py install for mozleak 02:56:05 INFO - Running setup.py install for mozlog 02:56:05 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Running setup.py install for moznetwork 02:56:05 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Running setup.py install for mozprocess 02:56:05 INFO - Running setup.py install for mozprofile 02:56:05 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 02:56:05 INFO - Running setup.py install for mozrunner 02:56:06 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 02:56:06 INFO - Running setup.py install for mozscreenshot 02:56:06 INFO - Running setup.py install for moztest 02:56:06 INFO - Running setup.py install for mozversion 02:56:06 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 02:56:06 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 02:56:06 INFO - Cleaning up... 02:56:06 INFO - Return code: 0 02:56:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:56:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:56:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:56:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 02:56:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:56:06 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 0x12541f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x141da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15c0a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, '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': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', '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 02:56:06 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 02:56:06 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 02:56:06 INFO - Using env: {'DISPLAY': ':0', 02:56:06 INFO - 'HOME': '/home/cltbld', 02:56:06 INFO - 'LANG': 'en_US.UTF-8', 02:56:06 INFO - 'LANGUAGE': 'en_US:en', 02:56:06 INFO - 'LOGNAME': 'cltbld', 02:56:06 INFO - 'MAIL': '/var/mail/cltbld', 02:56:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:56:06 INFO - 'MOZ_NO_REMOTE': '1', 02:56:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:56:06 INFO - 'NO_EM_RESTART': '1', 02:56:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:56:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:56:06 INFO - 'PWD': '/builds/slave/test', 02:56:06 INFO - 'SHELL': '/bin/bash', 02:56:06 INFO - 'SHLVL': '1', 02:56:06 INFO - 'TERM': 'linux', 02:56:06 INFO - 'TMOUT': '86400', 02:56:06 INFO - 'USER': 'cltbld', 02:56:06 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:56:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:56:06 INFO - '_': '/tools/buildbot/bin/python'} 02:56:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:56:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:56:06 INFO - Running setup.py (path:/tmp/pip-xtWCEe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:56:06 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)) 02:56:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:56:06 INFO - Running setup.py (path:/tmp/pip-L_m5J3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:56:06 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)) 02:56:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:56:06 INFO - Running setup.py (path:/tmp/pip-VXNedK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:56:06 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)) 02:56:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:56:06 INFO - Running setup.py (path:/tmp/pip-Ds0jKj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:56:06 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)) 02:56:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:56:06 INFO - Running setup.py (path:/tmp/pip-QXiXei-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:56:06 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)) 02:56:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:56:06 INFO - Running setup.py (path:/tmp/pip-zEhdSd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:56:06 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)) 02:56:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:56:06 INFO - Running setup.py (path:/tmp/pip-Js_7hu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:56:07 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)) 02:56:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:56:07 INFO - Running setup.py (path:/tmp/pip-9OlFnJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:56:07 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)) 02:56:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:56:07 INFO - Running setup.py (path:/tmp/pip-VFYrzs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:56:07 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)) 02:56:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:56:07 INFO - Running setup.py (path:/tmp/pip-tDQsEU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:56:07 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)) 02:56:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:56:07 INFO - Running setup.py (path:/tmp/pip-eAf4qV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:56:07 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)) 02:56:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:56:07 INFO - Running setup.py (path:/tmp/pip-xfPRQh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:56:07 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)) 02:56:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:56:07 INFO - Running setup.py (path:/tmp/pip-09Y8P8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:56:07 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)) 02:56:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:56:07 INFO - Running setup.py (path:/tmp/pip-fccP9e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:56:07 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)) 02:56:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:56:07 INFO - Running setup.py (path:/tmp/pip-eukC3k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:56:07 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)) 02:56:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:56:07 INFO - Running setup.py (path:/tmp/pip-pUmkNP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:56:07 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)) 02:56:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:56:07 INFO - Running setup.py (path:/tmp/pip-yLsyws-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:56:07 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)) 02:56:07 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)) 02:56:07 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)) 02:56:07 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)) 02:56:07 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)) 02:56:07 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)) 02:56:07 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)) 02:56:07 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 02:56: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 02:56: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 02:56: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 02:56: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 02:56:08 INFO - Downloading blessings-1.6.tar.gz 02:56:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 02:56:08 INFO - Installing collected packages: blessings 02:56:08 INFO - Running setup.py install for blessings 02:56:09 INFO - Successfully installed blessings 02:56:09 INFO - Cleaning up... 02:56:09 INFO - Return code: 0 02:56:09 INFO - Done creating virtualenv /builds/slave/test/build/venv. 02:56:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:56:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:56:09 INFO - Reading from file tmpfile_stdout 02:56:09 INFO - Current package versions: 02:56:09 INFO - argparse == 1.2.1 02:56:09 INFO - blessings == 1.6 02:56:09 INFO - blobuploader == 1.2.4 02:56:09 INFO - docopt == 0.6.1 02:56:09 INFO - functools32 == 3.2.3-2 02:56:09 INFO - jsonschema == 2.5.1 02:56:09 INFO - manifestparser == 1.1 02:56:09 INFO - mozInstall == 1.13 02:56:09 INFO - mozcrash == 1.0 02:56:09 INFO - mozdebug == 0.1 02:56:09 INFO - mozdevice == 0.51 02:56:09 INFO - mozfile == 1.2 02:56:09 INFO - mozhttpd == 0.7 02:56:09 INFO - mozinfo == 0.10 02:56:09 INFO - mozleak == 0.1 02:56:09 INFO - mozlog == 3.5 02:56:09 INFO - moznetwork == 0.27 02:56:09 INFO - mozprocess == 0.25 02:56:09 INFO - mozprofile == 0.28 02:56:09 INFO - mozrunner == 6.13 02:56:09 INFO - mozscreenshot == 0.1 02:56:09 INFO - mozsystemmonitor == 0.3 02:56:09 INFO - moztest == 0.8 02:56:09 INFO - mozversion == 1.4 02:56:09 INFO - psutil == 3.1.1 02:56:09 INFO - requests == 1.2.3 02:56:09 INFO - wsgiref == 0.1.2 02:56:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:56: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')]} 02:56:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:56: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')]} 02:56:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:56:09 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 0x12541f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x141da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15c0a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, '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': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', '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 02:56:09 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 02:56:09 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 02:56:09 INFO - Using env: {'DISPLAY': ':0', 02:56:09 INFO - 'HOME': '/home/cltbld', 02:56:09 INFO - 'LANG': 'en_US.UTF-8', 02:56:09 INFO - 'LANGUAGE': 'en_US:en', 02:56:09 INFO - 'LOGNAME': 'cltbld', 02:56:09 INFO - 'MAIL': '/var/mail/cltbld', 02:56:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:56:09 INFO - 'MOZ_NO_REMOTE': '1', 02:56:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:56:09 INFO - 'NO_EM_RESTART': '1', 02:56:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:56:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:56:09 INFO - 'PWD': '/builds/slave/test', 02:56:09 INFO - 'SHELL': '/bin/bash', 02:56:09 INFO - 'SHLVL': '1', 02:56:09 INFO - 'TERM': 'linux', 02:56:09 INFO - 'TMOUT': '86400', 02:56:09 INFO - 'USER': 'cltbld', 02:56:09 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:56:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:56:09 INFO - '_': '/tools/buildbot/bin/python'} 02:56:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:56:09 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)) 02:56:09 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)) 02:56:09 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)) 02:56:09 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)) 02:56:09 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)) 02:56:09 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)) 02:56:09 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)) 02:56:09 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)) 02:56:09 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)) 02:56:09 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 02:56:09 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 02:56:09 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 02:56:09 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 02:56:09 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 02:56:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 02:56:10 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)) 02:56:10 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)) 02:56:10 INFO - Installing collected packages: simplejson 02:56:10 INFO - Running setup.py install for simplejson 02:56:10 INFO - building 'simplejson._speedups' extension 02:56:10 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 02:56:11 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 02:56:11 INFO - Successfully installed simplejson 02:56:11 INFO - Cleaning up... 02:56:11 INFO - Return code: 0 02:56:11 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 02:56:11 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')]} 02:56:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:56:11 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')]} 02:56:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:56:11 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 0x12541f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x141da80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15c0a60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, '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': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', '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 02:56:11 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 02:56:11 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 02:56:11 INFO - Using env: {'DISPLAY': ':0', 02:56:11 INFO - 'HOME': '/home/cltbld', 02:56:11 INFO - 'LANG': 'en_US.UTF-8', 02:56:11 INFO - 'LANGUAGE': 'en_US:en', 02:56:11 INFO - 'LOGNAME': 'cltbld', 02:56:11 INFO - 'MAIL': '/var/mail/cltbld', 02:56:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:56:11 INFO - 'MOZ_NO_REMOTE': '1', 02:56:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:56:11 INFO - 'NO_EM_RESTART': '1', 02:56:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:56:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:56:11 INFO - 'PWD': '/builds/slave/test', 02:56:11 INFO - 'SHELL': '/bin/bash', 02:56:11 INFO - 'SHLVL': '1', 02:56:11 INFO - 'TERM': 'linux', 02:56:11 INFO - 'TMOUT': '86400', 02:56:11 INFO - 'USER': 'cltbld', 02:56:11 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:56:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:56:11 INFO - '_': '/tools/buildbot/bin/python'} 02:56:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:56:12 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 02:56:12 INFO - Cleaning up... 02:56:12 INFO - Return code: 0 02:56:12 INFO - Running post-action listener: _resource_record_post_action 02:56:12 INFO - Running post-action listener: _start_resource_monitoring 02:56:12 INFO - Starting resource monitoring. 02:56:12 INFO - [mozharness: 2017-09-19 09:56:12.040409Z] Finished create-virtualenv step (success) 02:56:12 INFO - [mozharness: 2017-09-19 09:56:12.040924Z] Running install step. 02:56:12 INFO - Running pre-action listener: _resource_record_pre_action 02:56:12 INFO - Running main action method: install 02:56:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:56:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:56:12 INFO - Reading from file tmpfile_stdout 02:56:12 INFO - Detecting whether we're running mozinstall >=1.0... 02:56:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 02:56:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 02:56:12 INFO - Reading from file tmpfile_stdout 02:56:12 INFO - Output received: 02:56:12 INFO - Usage: mozinstall [options] installer 02:56:12 INFO - Options: 02:56:12 INFO - -h, --help show this help message and exit 02:56:12 INFO - -d DEST, --destination=DEST 02:56:12 INFO - Directory to install application into. [default: 02:56:12 INFO - "/builds/slave/test"] 02:56:12 INFO - --app=APP Application being installed. [default: firefox] 02:56:12 INFO - mkdir: /builds/slave/test/build/application 02:56:12 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'] 02:56:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 02:56:30 INFO - Reading from file tmpfile_stdout 02:56:30 INFO - Output received: 02:56:30 INFO - /builds/slave/test/build/application/firefox/firefox 02:56:30 INFO - Running post-action listener: _resource_record_post_action 02:56:30 INFO - [mozharness: 2017-09-19 09:56:30.169023Z] Finished install step (success) 02:56:30 INFO - [mozharness: 2017-09-19 09:56:30.169275Z] Running setup-mitmproxy step. 02:56:30 INFO - Running pre-action listener: _resource_record_pre_action 02:56:30 INFO - Running main action method: setup_mitmproxy 02:56:30 INFO - Skipping: mitmproxy is not required 02:56:30 INFO - Running post-action listener: _resource_record_post_action 02:56:30 INFO - [mozharness: 2017-09-19 09:56:30.170477Z] Finished setup-mitmproxy step (success) 02:56:30 INFO - [mozharness: 2017-09-19 09:56:30.170698Z] Running run-tests step. 02:56:30 INFO - Running pre-action listener: _resource_record_pre_action 02:56:30 INFO - Running pre-action listener: _set_gcov_prefix 02:56:30 INFO - Running main action method: run_tests 02:56:30 WARNING - Try message not found. 02:56:30 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 02:56:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 02:56:30 INFO - Python 2.7.3 02:56:30 INFO - Return code: 0 02:56:30 INFO - grabbing minidump binary from tooltool 02:56:30 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')]} 02:56:30 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 0x15c4090>, '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 0x15c4d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x15bef90>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 02:56:30 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 02:56:30 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 02:56:30 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 02:56:30 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 02:56:30 INFO - Return code: 0 02:56:30 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 02:56:30 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 02:56:30 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 02:56:30 INFO - ENV: RUST_BACKTRACE is now full 02:56:30 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 02:56:30 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 02:56:30 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/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-085', '--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 02:56:30 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/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-085 --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 02:56:30 INFO - Using env: {'DISPLAY': ':0', 02:56:30 INFO - 'HOME': '/home/cltbld', 02:56:30 INFO - 'LANG': 'en_US.UTF-8', 02:56:30 INFO - 'LANGUAGE': 'en_US:en', 02:56:30 INFO - 'LOGNAME': 'cltbld', 02:56:30 INFO - 'MAIL': '/var/mail/cltbld', 02:56:30 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:56:30 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 02:56:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:56:30 INFO - 'MOZ_NO_REMOTE': '1', 02:56:30 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:56:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:56:30 INFO - 'NO_EM_RESTART': '1', 02:56:30 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:56:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:56:30 INFO - 'PWD': '/builds/slave/test', 02:56:30 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:56:30 INFO - 'RUST_BACKTRACE': 'full', 02:56:30 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 02:56:30 INFO - 'SHELL': '/bin/bash', 02:56:30 INFO - 'SHLVL': '1', 02:56:30 INFO - 'TERM': 'linux', 02:56:30 INFO - 'TMOUT': '86400', 02:56:30 INFO - 'USER': 'cltbld', 02:56:30 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:56:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:56:30 INFO - '_': '/tools/buildbot/bin/python'} 02:56:30 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/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-085', '--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 02:56:30 INFO - mozversion application_buildid: 20170919090857 02:56:30 INFO - mozversion application_changeset: 7c12af6fd620adc74e9dfb622d17966bdebdf2ac 02:56:30 INFO - mozversion application_display_name: Nightly 02:56:30 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 02:56:30 INFO - mozversion application_name: Firefox 02:56:30 INFO - mozversion application_remotingname: firefox 02:56:30 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 02:56:30 INFO - mozversion application_vendor: Mozilla 02:56:30 INFO - mozversion application_version: 57.0a1 02:56:30 INFO - mozversion platform_buildid: 20170919090857 02:56:30 INFO - mozversion platform_changeset: 7c12af6fd620adc74e9dfb622d17966bdebdf2ac 02:56:30 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 02:56:30 INFO - mozversion platform_version: 57.0a1 02:56:30 INFO - using testdate: 1505814990 02:56:30 INFO - actual date: 1505814990 02:56:30 INFO - starting webserver on 'localhost:41569' 02:56:30 INFO - SUITE-START | Running 2 tests 02:56:30 INFO - TEST-START | dromaeo_css 02:56:30 INFO - Initialising browser for dromaeo_css test... 02:56:30 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:41569/getInfo.html -profile /tmp/tmptemrYR/profile 02:56:30 INFO - TEST-INFO | started process 5109 (/builds/slave/test/build/application/firefox/firefox http://localhost:41569/getInfo.html) 02:56:36 INFO - TEST-INFO | 5109: exit 0 02:56:36 INFO - Browser initialized. 02:56:36 INFO - Running cycle 1/1 for dromaeo_css test... 02:56:36 INFO - Using env: {'DISPLAY': ':0', 02:56:36 INFO - 'HOME': '/home/cltbld', 02:56:36 INFO - 'JSGC_DISABLE_POISONING': '1', 02:56:36 INFO - 'LANG': 'en_US.UTF-8', 02:56:36 INFO - 'LANGUAGE': 'en_US:en', 02:56:36 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 02:56:36 INFO - 'LOGNAME': 'cltbld', 02:56:36 INFO - 'MAIL': '/var/mail/cltbld', 02:56:36 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:56:36 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 02:56:36 INFO - 'MOZ_CRASHREPORTER': '1', 02:56:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:56:36 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 02:56:36 INFO - 'MOZ_NO_REMOTE': '1', 02:56:36 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:56:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:56:36 INFO - 'NO_EM_RESTART': '1', 02:56:36 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:56:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:56:36 INFO - 'PWD': '/builds/slave/test', 02:56:36 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:56:36 INFO - 'RUST_BACKTRACE': 'full', 02:56:36 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 02:56:36 INFO - 'SHELL': '/bin/bash', 02:56:36 INFO - 'SHLVL': '1', 02:56:36 INFO - 'STYLO_FORCE_DISABLED': '1', 02:56:36 INFO - 'TERM': 'linux', 02:56:36 INFO - 'TMOUT': '86400', 02:56:36 INFO - 'USER': 'cltbld', 02:56:36 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 02:56:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:56:36 INFO - '_': '/tools/buildbot/bin/python'} 02:56:36 INFO - TEST-INFO | started process 5344 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmptemrYR/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 02:56:37 INFO - PID 5344 | 02:56:37 INFO - PID 5344 | (/builds/slave/test/build/application/firefox/firefox:5393): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 02:56:37 INFO - PID 5344 | 02:56:48 INFO - PID 5344 | RSS: Main: 154509312 02:56:48 INFO - PID 5344 | 02:59:45 INFO - PID 5344 | Cycle 1(1): loaded http://localhost:41569/tests/dromaeo/cssquery-dojo.html (next: http://localhost:41569/tests/dromaeo/cssquery-ext.html) 02:59:46 INFO - PID 5344 | RSS: Main: 155148288 02:59:46 INFO - PID 5344 | 03:02:48 INFO - PID 5344 | Cycle 1(1): loaded http://localhost:41569/tests/dromaeo/cssquery-ext.html (next: http://localhost:41569/tests/dromaeo/cssquery-jquery.html) 03:02:49 INFO - PID 5344 | RSS: Main: 154861568 03:02:49 INFO - PID 5344 | 03:05:50 INFO - PID 5344 | Cycle 1(1): loaded http://localhost:41569/tests/dromaeo/cssquery-jquery.html (next: http://localhost:41569/tests/dromaeo/cssquery-mootools.html) 03:05:51 INFO - PID 5344 | RSS: Main: 156934144 03:05:51 INFO - PID 5344 | 03:08:53 INFO - PID 5344 | Cycle 1(1): loaded http://localhost:41569/tests/dromaeo/cssquery-mootools.html (next: http://localhost:41569/tests/dromaeo/cssquery-prototype.html) 03:08:53 INFO - PID 5344 | RSS: Main: 156725248 03:08:53 INFO - PID 5344 | 03:11:56 INFO - PID 5344 | Cycle 1(1): loaded http://localhost:41569/tests/dromaeo/cssquery-prototype.html (next: http://localhost:41569/tests/dromaeo/cssquery-yui.html) 03:11:57 INFO - PID 5344 | RSS: Main: 156872704 03:11:57 INFO - PID 5344 | 03:14:58 INFO - PID 5344 | Cycle 1(1): loaded http://localhost:41569/tests/dromaeo/cssquery-yui.html (next: http://localhost:41569/tests/dromaeo/cssquery-dojo.html) 03:14:59 INFO - PID 5344 | RSS: Main: 159133696 03:14:59 INFO - PID 5344 | 03:14:59 INFO - PID 5344 | __start_tp_report 03:14:59 INFO - PID 5344 | _x_x_mozilla_page_load 03:14:59 INFO - PID 5344 | _x_x_mozilla_page_load_details 03:14:59 INFO - PID 5344 | |i|pagename|runs| 03:14:59 INFO - PID 5344 | |0;dojo.html;3126.0621813455964;3147.228928912417;3149.54331621915;3159.2259896325404;3160.905172844814;6154.5999510031925;6215.19202503675;6248.4688801451875;6285.214348206474;6344.333844946278;6253.906191407133;6261.937380626192;6282.120503129554;6295.874082518347;6298.496120310376;5754.251947246873;5758.942410575893;5775.249217601706;5778.884422311551;5913.319968203668;5846.707664616773;5888.5289176865745;5933.762649494037;5940.346561878211;5951.226340575719;5790.082334219606;5806.651600903938;5857.824265272027;5905;5950.107483877409;5810.360860305363;5862.97068514659;5903.527717782567;5917.763289468416;5947.345791962881;5706.9714651426475;5739.081746920514;5788.623739456922;5815.534757219454;5823.883522329572;6274.403931626488;6292.811215663537;6295.213098362705;6343.080253363237;6352.841178970517;6743.426808721265;6758.695858686371;6826.726930922757;6829.556078854858;6874.828129296758;6551.05009773585;6803.047573339736;6845.589264644087;6912.205096413926;6941.826454338631;6243.406876346739;6313.810585682437;6420.422162005442;6428.678566071678;6444.903326450107;6977.09297791294;6978.825529361705;7072.186698529632;7087.50387472872;7120.038794762744;6450.322716114834;6669.499787515956;6706.798796036127;6707.765228216989;6768.526203165829;6663.733450661919;6679.265280819106;6684.364985326386;6684.699188536528;6686.197656281277;6646.634435106115;6654.800355989328;6672.666366681647;6680.832979175462;6706.7652632158615;6813.965930170417;6821.283765204681;6867.484938629523;6896.551724137915;6906.412954898789;5206.505381988705;5284.154535274338;5293.629445938747;5328.866778330573;5397.379301380392;4668.789904454307;4698.694584851974;4705.153072446924;4707.670463067621;4753.667243292936;5761.279840019997;5785.218995435646;5832.066869300891;5844.766209351578;5849.61977471463;6610.405063544208;6697.933020669731;6727.091842601284;6742.123523941857;6749.358810912955;5697.544196464356;5728.198052272685;5795.971020144872;5800.1299805029585;5801;5825.359210486843;5853.443922827325;5889.617174883619;5890.793822216202;5912.9113063304085;6538.346165383424;6553.639549824806;6619.966900165468;6630.336966303331;6638.900416493757;6790.966045169841;6800.217974932946;6816.113905192194;6872;6901.206361268519;6367.522435817425;6459.128017717548;6460.8707825842275;6466.06242094903;6529.804105876831;6601.53789234749;6621;6623.437007854386;6633.9668301658185;6641.369069938348;6776.356246156607;6783.796486105425;6789.355011273921;6789.947558128498;6793.762218322335;6571.605703657796;6655.767048153291;6676.566023208476;6679.6994135265;6688.230853451721;6583.967080164569;6589.868202635825;6654.767083152066;6662.900056499253;6674.532782705164;6348.809535713936;6447.806565803034;6502.837429064311;6507.219133703986;6594.670266486753;6522.739090436329;6531.640759758259;6570;6675.566088204251;6735.023421603938;6193.040078787795;6284.874302513833;6349.841253968688;6454.741810327722;6466.612003279818 03:14:59 INFO - PID 5344 | |1;ext.html;857.352698712472;887.4276091920711;913.0276255787588;915.9084091590846;916.2715641065353;39645.60354396455;41883.37174942374;42117.36823947643;42129.36805947913;42211.36682949758;38190.23619527615;38507;38630;38654.22691546167;38673.61326386735;7086.787396378117;7211.89182162268;7270.05489286392;7275.417966562689;7283.9271607284045;7162.498625096246;7248.855022899539;7263.346298833104;7263.382612477946;7267.055282813227;7207.135143782753;7238.674259658302;7241.23966983467;7248.202697703248;7354.374878135338;7975.601219939009;8017;8022.558759268238;8036.116027236999;8051.677932882678;7903.249191326815;8006.719764808262;8006.759797206093;8019.799505012363;8030.558319292437;38450.61549384498;38818.80590597057;39566;40057.39913901294;40099.19801603952;3369.073504786179;3411.3688967541084;3413.368526822521;3418.2479854431986;3418.8119653419053;32168.356632867446;32185.1953701157;32210.194745131324;32282.354352913044;32346.02961911123;5160.92258616121;5168.250603662485;5215.24378965048;5218.6868787872845;5225.503577160163;186047;187867;187875;188231;188273;47905.76047119742;48336.274955874986;48582.27126593104;48611.5138848607;48674;50242.246366304535;50302.24546631803;50338.24492632614;50452.24321635178;50484;15729;16138.515844524683;16168.67662646764;16169.272382742805;16190.919045404698;13036;13154.868451315555;13166.539171128965;13180.275084870233;13206.27365494907;14404.495842645458;14468.493602723855;14489.927550362181;14543.043981019926;14608.488702895347;5800.477956983807;5897.76408943646;5935.495482883917;5940.198073260141;6015.187949626832;1002.4286156890648;1013.2805707947292;1027.712240572641;1027.9743006424899;1035.7669524356959;22838.086476541084;23091.538169236857;23143;23202;23269.650955235684;1099.5107177306022;1117.1007339091946;1126.7690123524658;1128.700894263021;1130.4799792095564;12003.374482720814;12117.333546655018;12216.02122440006;12312.883191336876;12331.568395106127;232242;233284;233745;233947;234069;45132.3230151548;45426.545734542895;50953.745231273606;51548.48451515512;52121.47878521242;1441.2361448432348;1447.326992948263;1448.1166488442043;1463.6267751723242;1470.5367809140087;26620;27210.863945680147;27239.182824515297;27540.862295688392;27797.305067373476;36212;36276.09309767277;36350.63649363472;36381.81809090938;36561.45157822688;188142;188921;189415;190312;190600;32992.83503582467;34046.148846279044;34066.65933340734;34148.65851341554;34221.65778342185;42071.36892946547;42197.15605687808;42525.5747442534;42585.574144258164;42612;31226.375472490876;31279.218019549695;31350.68649313569;31768.523472148398;32037.35925281528;31124.533132002583;31470.80281028525;31632.525512116878;31804.522932155574;31983;35089.47365789464;35283.82358088193;35386.646133538336;35508.82245588755;35517.82241088778;30781.23046923845;30812.22969425782;31075.844620776752;31182.532262015633;31220.219494512818;23245.3026409208;23353.532929341658;23422.76577234206;23603.763962360157;23824.523509529365 03:14:59 INFO - PID 5344 | |2;jquery.html;574;576.8154190658988;585.3005658238404;585.6661702829389;590.5128269177928;22076.558468830615;22976.195833145845;22990.88504557477;23029;23029.309120726404;24149.275521734333;25049.373765655866;25301;25325.873370633122;25730.228093157188;6386.808395748123;6468.062130991004;6501.284858665543;6520.576162549442;6536.575122617039;6353.809385718436;6404.391582799627;6520.9673951630175;6521.250056243545;6669.599824010551;6637.701303441357;6639.103720997652;6640.302768209341;6646.136002319692;6648.335166483337;6386.329435409308;6652.06871038055;6655.201375834882;6659.400653941144;6660.367265109807;6101.237345331833;6144.723487443031;6145.846353841145;6147.077938309245;6152.969235153841;27891.86054069737;28335;28490.715092849012;28502.429951401064;28509.572356414672;2095.8532902696816;2113.0491278924546;2117.894105294729;2120.7879212078824;2125.989370053155;18519.2592296308;18910.716339254923;19219.90390048055;19474.902625486924;19569.9021504893;2477.442575420534;2481.1192026830577;2522.2811498722776;2524.432002799374;2532.4048848520583;126460;132343;135726;141020;142395.28802356025;14501.8237097069;14850.183239921907;14880.883933705016;14992.925035374754;15031.624209394853;22440.66339004916;22519.88740056322;22565.323040308816;22629.886850565643;22697.88651056767;9839.163671087894;9977.501124943723;10113;10193.592256309812;10246.846297305547;9102.726918192464;9152.130547597968;9206.585703643352;9242.12199841014;9260.259179265642;8847.20375166238;8891.244244239182;9106.225970792424;9110.544472776468;9146.63413463454;2690.5426077566467;2699.284689557269;2702.5270577648835;2715.6198132261497;2770.3074231442138;951.296040929707;971.708487453761;976.5800705696619;982.3663736889808;983.1692220074169;19032.238710451704;19145.617087658167;19593.706094408597;19604.803951960585;19695.704564431544;1026.5329275179774;1037.1080870451406;1041.6354276003337;1045.153425725165;1048.7116043088213;10468.319559228778;10632.202584806171;10687.465626718633;10743.247972641997;10778.622748203776;467212;480300;480366;482659;499647;107087;107821.4608926966;108678.45660771645;112394;113972.43013784879;1143.7924805126186;1156.849609550753;1178.8585369755683;1180.805167147411;1188.2989036468525;16893.408730694366;16930.153492325087;17023.297670232878;17458.039807810692;17630.559236019202;54375.72812135914;55402.72298638481;55688.44311556833;55747;56521.71739141278;70273.29726702668;70708.29291707017;71470;71530.64234678794;72339;13808.240546770025;14151;14160.291985400894;14164.220967846868;14170.291485425894;18875.244990200237;18876.811231887506;19032.904835475732;19044.904775476032;19631.018449077204;17419.3903213392;17723.20245588926;17915.283388664306;17920.655950804;17943.730844037087;15459.381624735335;15807.525774226791;16177;16412.83587164113;16447.424340148038;17150.914245428692;17746.37887673925;17781.644367112844;18182.636347273245;18254.81745182531;13835.169889806644;13850.376733046836;13890.097143685629;13950.860491394957;14071.296435177996;17384.652306953536;17639.647207056045;17770.644587108443;17795.73306400379;17875.19561619704 03:14:59 INFO - PID 5344 | |3;mootools.html;1313.251446675395;1421.4456362018814;1424.0956992309893;1431.5132854829355;1436.0880840666173;14809.925950370247;15427.074375537448;15441.922790386061;15465.149416782073;15468.535943921672;15040.473583424582;15194.54416367508;15198.620034499143;15213.695726085472;15240;2694.5015172193207;2720.7551320381162;2752.8073034887566;2777.4445110977886;2778.402643431662;2685.4226341336607;2738.87675054623;2749.931251718703;2751.9036833710825;2753.325435268352;2646.0077470948395;2665.4669066186743;2684.6375739275145;2765.5713364428548;2791.7208279172023;2766.5711814668657;2779.8610069496644;2799.9020034298806;2803.7056109108657;2806.480801051802;2554.8083893708044;2616.5813469844925;2662.853543055131;2663.3607934095676;2687.0998215597797;15253.161076140808;15439.922800385926;15444.382224710998;15455.690886182214;15462.690746185013;7452.441066919949;7652.7704168875025;7678.155402905676;7717.922820771832;7728.149903510609;4910.288008238821;5086.4659210783075;5137.434882162959;5165.199394093921;5186.92219616706;1954.8924809135492;1995.1720036184965;2009.4574464894397;2046.3758553641132;2069.2136987944637;26847;27117.728822711717;27126.864365678244;27140.864295678395;27153.728462715317;6555.639439830855;6758.662066896733;6919.965400172967;6926.722931082801;6933.410660093848;17268;17358;17363.565910852078;17366.826331736775;17369.826301737074;7912.683492660344;8019.679212831421;8099.716509922125;8100.0684921234815;8103.797405064921;7288.12542494904;7310.378617817439;7341.816454588571;7351.4853960223345;7358.00666909971;5178.378594568676;5290.68255904647;5303.7348132593215;5332.600054995891;5419.376771671229;1495.162708883029;1500.4020717935364;1515.2575238133456;1518.422999260274;1526.809148856393;844.6283635200492;846.0650980666398;863.6243234193146;870.2124577257592;882.298572634757;7003.964980175067;7023.262557431498;7918.129005809356;8094.797630059295;8172;688.1398252184769;695.3359541637724;704.9788506344818;708.1926603671818;729.4492658043143;4312.7627980461375;4357.063231405263;4850.75746212688;4874.439439464436;4986.102501549756;21284.680729789066;22270.443238919157;22278.99744511501;22292.331230063122;22293.219737309115;20600.27899023527;22049.889750551145;22051.779482205293;22093.889530552246;22143.557128857334;10767.623133190458;10825.188110891715;10831.620893268699;10836.62071827498;10893.83659245112;8088.87866682012;8185.30424913889;8285.544295063588;8299.004119505698;8315.334773218248;18403.90798046001;18439.170237339084;18552.072396379855;18830.435086947415;19039.238430462625;19188;19618.313359032367;19618.41144765602;19850.10674519621;20374.083166257256;10777.62278320255;10879.292845964987;10930;10930.125589952944;10933.289336193122;13919.79120313176;14157.36291866848;14176.574702758933;14290.214038227998;14363.21002344881;11104.445377647298;11463.484143213409;11644.301341919512;11655.067594592243;11862.110341724578;11050.226484146355;11206.551737930391;11309.151813613847;11448.94275528617;11544.422778861192;9041.095890410907;9128.178463938277;9142.542872856464;9192.356535042483;9211.124943130391;6948.652567371712;7041.5422997505;7072.611006394492;7127.358537731629;7173.390261827803;7386.815329616803;7403.51877127985;7412.777616671508;7436.479446438913;7499.175090740124 03:14:59 INFO - PID 5344 | |4;prototype.html;498.58187789222256;506.8884845334026;529.3515443581612;531.3278702441412;534.0813800263545;6245.9063114053215;6332;6338.556301058922;6370.617762934227;6382.170317858672;6233.223531293582;6295.685215739218;6325.6837158142025;6347.333529979355;6347.36526347365;5240.161574148127;5241.42344342122;5246.973765131169;5282.471752824726;5283.286756287909;4899.730514821684;5057.811414317633;5107.591392688594;5162.303089082963;5275.815346462875;5011.273365362021;5014.924776128361;5016.949830501685;5029.924551131736;5052.747362631872;4998.40019197695;5026.949730502684;5038.168702164138;5039.546440820307;5059.924101138486;4367.71609845359;4454.532274111237;4461.5092339842595;4481.955180448186;4494.8202071917085;6050.3647117052515;6056.454919057262;6080.695965201767;6137.140800287963;6210.534209934228;5650.915236271459;5668.404817494145;5693.658380497183;5694.629849059798;5711.314642242957;6462.836689395906;6518.77184298552;6519.4132528072705;6524.11814970092;6568.67156642166;4633.189191891405;4863.489333619955;4870.342503761982;4870.65905386623;4911.582515486188;6678.599284042973;6706.128203333584;6708.798736037927;6822.727090916357;6961.825954351131;4977.502249775066;4994.8262158392745;5004.199328107486;5019.47295533971;5066.088104141216;5070.340855688737;5085.618578606619;5094.541491265803;5109.182530795055;5127.333446651986;5692.52375216782;5709.82870513877;5723.284589426322;5743.368229494752;5782.219400380979;6580.453593405546;6591.901121483182;6629.701663425158;6644;6683.832904177434;1757.6836169489616;1762.9911850440665;1784.5360206346184;1788.3830078622855;1789.7852257729155;1171.4084387384316;1211.787937111002;1229.2562999385243;1236.9938150309372;1242.2422322383338;5597.1174844954885;5608.719564021782;5611.719414029282;5629.662220266797;5654.180143879197;6520.5435619507125;6583.144191255202;6646.302138275508;6719.899201511981;6749.156355455568;5614.157876318503;5653.173413293353;5666.025336698266;5710.628809127394;5713.371529131792;3561.910952226215;3567.9643203568153;3588.7308451866215;3597.8740744074357;3609.819509024538;6429.8714025720155;6460.612363258126;6474.838129046811;6488.383603557654;6525;6485.189351331083;6799.1161149051295;6833.726650933907;6836.350546698056;6873.312668733187;6444.903326450013;6449.645269510222;6473.352664733489;6499.1876015498065;6512.153420055362;6702.396784289437;6702.430293425114;6742.393184613408;6754.527183097136;6763.425108865801;6598.406143447113;6643.30245324234;6734;6749.73001079971;6757.7562769869755;6357.682115894094;6407.743690252524;6417.93582064192;6460.612363258219;6533.509986751108;4932.087563800708;4966.528179822911;4983.601311894967;5007.048660754445;5010.148274793367;6410.647414392253;6623.271440141484;6658.1344425224415;6729.259781424137;6731.932680673131;6133.6319820810895;6380.170577824853;6443.323451037573;6452.903206452001;6477.4494167996245;6377;6403.278606592273;6430.324815894263;6457.741690332334;6474.1583594134345;6294.968525157345;6308.71610777507;6387.744490220339;6393.2328120625825;6412.487001039813;6544.738210471528;6579.736810527525;6627.403533681992;6654.201495820533;6670.76652317186;6267.937320626917;6394.616323020634;6394.808155755335;6397.456216221487;6399.232092148972 03:14:59 INFO - PID 5344 | |5;yui.html;913.575187537795;932.5803388475188;936.2042264075533;936.3539157980995;938.4932136646212;19428.320008799677;20356.287529936457;20367.796322036756;20374.79625203751;20464.590708185846;18303.267869285213;18756.718649220238;18790.718139227924;18830.81169188308;18838.62322753544;941.4680705401444;954.6229239450413;955.9952200238989;956.5934477846922;959.8848138223389;979.4172467381932;981.4651015196699;982.1946004276496;982.2829334585757;982.3909176310698;985.261054209343;1003.5985605757683;1005.6982905128468;1038.1331588123926;1039.552992213348;999.0808456220295;1000.2997901468965;1000.8999100090006;1001.0490034467249;1001.3791449301443;715.9248278930742;749.6289336778275;749.9100107987022;750.1261030898996;750.1335956969655;20144.49638759028;20561.69157462639;20579.8971005144;20585.89707051455;20694.172233110658;21566.1373545058;21687.566248675095;22190.556188876293;22446.438839028993;22486.325410237718;17038.659226815395;17114.05872677002;17160.57098572533;17346.65306693859;17477.56306092345;3768.8304026318883;3779.1874746929543;3784.0918179636687;3784.280986612535;3786.2048969716393;106213.46893265484;142084;142470.28764856214;143949;146909.2654536731;16480.917595411946;17028.48914532566;17145.399911003304;17157.399491018004;17166.742498862528;29661;30108.698913011027;30464.238394040327;30499.847500762353;30509.847450762605;8987.820243595223;9105.453672779655;9111.04334044929;9235.215006724504;9265.44407335562;4063.776492292893;4154.1068670236045;4156.584341565819;4157.521884983265;4157.854475093357;5467.371252305956;5551.250581171571;5581;5604.075327570987;5606.887862242814;906.5648488725449;1045.6078970386104;1052.4159091704025;1059.5285098131412;1059.5814653211937;684.8219462939572;698.4482259015423;705.4039336760429;711.6833009310807;718.3821913154683;11190.608328708457;11220.934011268917;11447.771044579062;11521.827172592419;11648.88351116495;672.1497305908031;673.1316601584;683.5147045597582;687.5737043033351;692.3215249055953;5559.166125081189;5588.608797384225;5602.663840169603;5636.267285252891;5669.886602267931;127434.36282818527;129200.3539982313;131534;136434;136645.31677341548;114054;116042;116270;117839;118235.40882295533;96754;100062;100437.49343759849;101729;102157;10375.118114960313;10415.895841041493;10566.056530942598;10674.092702120406;10730.087942524973;43886.90282742957;43939;44982.77508612436;45679.08641827211;45923.540764593265;58419.70790146022;58473.12290315734;59265.40734592771;59564;59690.70154649373;15707.528774136794;15777.921110394374;15779.132147731985;15851.445199417965;15884.841151588336;17615.119244038004;17713.822861771216;17763.911180444014;17906.820931791037;17952.371666991592;14991.100533967996;15083.019603725723;15179.392824286904;15188.848111518744;15258.160801155598;15363.308651110503;15429.691406172038;15522.223888805289;15606.297716602554;15611.687766244839;14431.78352324737;14504.274786260856;14547.927260363631;14705.191214483306;14708.485203017843;11319.943400283275;11499.885001149882;11622;11887.821682674594;11989.76020479603;11655.358955257543;11924.224925379822;11999.340036297739;12177.330246836154;12267.263964162179 03:14:59 INFO - PID 5344 | __end_tp_report 03:14:59 INFO - PID 5344 | __start_cc_report 03:14:59 INFO - PID 5344 | _x_x_mozilla_cycle_collect,304 03:14:59 INFO - PID 5344 | __end_cc_report 03:14:59 INFO - PID 5344 | __startTimestamp1505816099216__endTimestamp 03:14:59 INFO - PID 5344 | 03:14:59 INFO - PID 5344 | ------- Summary: start ------- 03:14:59 INFO - PID 5344 | Number of tests: 6 03:14:59 INFO - PID 5344 | 03:14:59 INFO - PID 5344 | [#0] dojo.html Cycles:165 Average:6221.90 Median:6454.74 stddev:744.93 (11.5%) stddev-sans-first:706.52 03:14:59 INFO - PID 5344 | Values: 3126.1 3147.2 3149.5 3159.2 3160.9 6154.6 6215.2 6248.5 6285.2 6344.3 6253.9 6261.9 6282.1 6295.9 6298.5 5754.3 5758.9 5775.2 5778.9 5913.3 5846.7 5888.5 5933.8 5940.3 5951.2 5790.1 5806.7 5857.8 5905.0 5950.1 5810.4 5863.0 5903.5 5917.8 5947.3 5707.0 5739.1 5788.6 5815.5 5823.9 6274.4 6292.8 6295.2 6343.1 6352.8 6743.4 6758.7 6826.7 6829.6 6874.8 6551.1 6803.0 6845.6 6912.2 6941.8 6243.4 6313.8 6420.4 6428.7 6444.9 6977.1 6978.8 7072.2 7087.5 7120.0 6450.3 6669.5 6706.8 6707.8 6768.5 6663.7 6679.3 6684.4 6684.7 6686.2 6646.6 6654.8 6672.7 6680.8 6706.8 6814.0 6821.3 6867.5 6896.6 6906.4 5206.5 5284.2 5293.6 5328.9 5397.4 4668.8 4698.7 4705.2 4707.7 4753.7 5761.3 5785.2 5832.1 5844.8 5849.6 6610.4 6697.9 6727.1 6742.1 6749.4 5697.5 5728.2 5796.0 5800.1 5801.0 5825.4 5853.4 5889.6 5890.8 5912.9 6538.3 6553.6 6620.0 6630.3 6638.9 6791.0 6800.2 6816.1 6872.0 6901.2 6367.5 6459.1 6460.9 6466.1 6529.8 6601.5 6621.0 6623.4 6634.0 6641.4 6776.4 6783.8 6789.4 6789.9 6793.8 6571.6 6655.8 6676.6 6679.7 6688.2 6584.0 6589.9 6654.8 6662.9 6674.5 6348.8 6447.8 6502.8 6507.2 6594.7 6522.7 6531.6 6570.0 6675.6 6735.0 6193.0 6284.9 6349.8 6454.7 6466.6 03:14:59 INFO - PID 5344 | 03:14:59 INFO - PID 5344 | [#1] ext.html Cycles:180 Average:37191.69 Median:18781.01 stddev:52954.22 (282.0%) stddev-sans-first:53032.49 03:14:59 INFO - PID 5344 | Values: 857.4 887.4 913.0 915.9 916.3 39645.6 41883.4 42117.4 42129.4 42211.4 38190.2 38507.0 38630.0 38654.2 38673.6 7086.8 7211.9 7270.1 7275.4 7283.9 7162.5 7248.9 7263.3 7263.4 7267.1 7207.1 7238.7 7241.2 7248.2 7354.4 7975.6 8017.0 8022.6 8036.1 8051.7 7903.2 8006.7 8006.8 8019.8 8030.6 38450.6 38818.8 39566.0 40057.4 40099.2 3369.1 3411.4 3413.4 3418.2 3418.8 32168.4 32185.2 32210.2 32282.4 32346.0 5160.9 5168.3 5215.2 5218.7 5225.5 186047.0 187867.0 187875.0 188231.0 188273.0 47905.8 48336.3 48582.3 48611.5 48674.0 50242.2 50302.2 50338.2 50452.2 50484.0 15729.0 16138.5 16168.7 16169.3 16190.9 13036.0 13154.9 13166.5 13180.3 13206.3 14404.5 14468.5 14489.9 14543.0 14608.5 5800.5 5897.8 5935.5 5940.2 6015.2 1002.4 1013.3 1027.7 1028.0 1035.8 22838.1 23091.5 23143.0 23202.0 23269.7 1099.5 1117.1 1126.8 1128.7 1130.5 12003.4 12117.3 12216.0 12312.9 12331.6 232242.0 233284.0 233745.0 233947.0 234069.0 45132.3 45426.5 50953.7 51548.5 52121.5 1441.2 1447.3 1448.1 1463.6 1470.5 26620.0 27210.9 27239.2 27540.9 27797.3 36212.0 36276.1 36350.6 36381.8 36561.5 188142.0 188921.0 189415.0 190312.0 190600.0 32992.8 34046.1 34066.7 34148.7 34221.7 42071.4 42197.2 42525.6 42585.6 42612.0 31226.4 31279.2 31350.7 31768.5 32037.4 31124.5 31470.8 31632.5 31804.5 31983.0 35089.5 35283.8 35386.6 35508.8 35517.8 30781.2 30812.2 31075.8 31182.5 31220.2 23245.3 23353.5 23422.8 23603.8 23824.5 03:14:59 INFO - PID 5344 | 03:14:59 INFO - PID 5344 | [#2] jquery.html Cycles:180 Average:33965.12 Median:22542.61 stddev:81179.11 (360.1%) stddev-sans-first:81368.13 03:14:59 INFO - PID 5344 | Values: 574.0 576.8 585.3 585.7 590.5 22076.6 22976.2 22990.9 23029.0 23029.3 24149.3 25049.4 25301.0 25325.9 25730.2 6386.8 6468.1 6501.3 6520.6 6536.6 6353.8 6404.4 6521.0 6521.3 6669.6 6637.7 6639.1 6640.3 6646.1 6648.3 6386.3 6652.1 6655.2 6659.4 6660.4 6101.2 6144.7 6145.8 6147.1 6153.0 27891.9 28335.0 28490.7 28502.4 28509.6 2095.9 2113.0 2117.9 2120.8 2126.0 18519.3 18910.7 19219.9 19474.9 19569.9 2477.4 2481.1 2522.3 2524.4 2532.4 126460.0 132343.0 135726.0 141020.0 142395.3 14501.8 14850.2 14880.9 14992.9 15031.6 22440.7 22519.9 22565.3 22629.9 22697.9 9839.2 9977.5 10113.0 10193.6 10246.8 9102.7 9152.1 9206.6 9242.1 9260.3 8847.2 8891.2 9106.2 9110.5 9146.6 2690.5 2699.3 2702.5 2715.6 2770.3 951.3 971.7 976.6 982.4 983.2 19032.2 19145.6 19593.7 19604.8 19695.7 1026.5 1037.1 1041.6 1045.2 1048.7 10468.3 10632.2 10687.5 10743.2 10778.6 467212.0 480300.0 480366.0 482659.0 499647.0 107087.0 107821.5 108678.5 112394.0 113972.4 1143.8 1156.8 1178.9 1180.8 1188.3 16893.4 16930.2 17023.3 17458.0 17630.6 54375.7 55402.7 55688.4 55747.0 56521.7 70273.3 70708.3 71470.0 71530.6 72339.0 13808.2 14151.0 14160.3 14164.2 14170.3 18875.2 18876.8 19032.9 19044.9 19631.0 17419.4 17723.2 17915.3 17920.7 17943.7 15459.4 15807.5 16177.0 16412.8 16447.4 17150.9 17746.4 17781.6 18182.6 18254.8 13835.2 13850.4 13890.1 13950.9 14071.3 17384.7 17639.6 17770.6 17795.7 17875.2 03:14:59 INFO - PID 5344 | 03:14:59 INFO - PID 5344 | [#3] mootools.html Cycles:180 Average:9330.76 Median:14906.12 stddev:6815.16 (45.7%) stddev-sans-first:6807.66 03:14:59 INFO - PID 5344 | Values: 1313.3 1421.4 1424.1 1431.5 1436.1 14809.9 15427.1 15441.9 15465.1 15468.5 15040.5 15194.5 15198.6 15213.7 15240.0 2694.5 2720.8 2752.8 2777.4 2778.4 2685.4 2738.9 2749.9 2751.9 2753.3 2646.0 2665.5 2684.6 2765.6 2791.7 2766.6 2779.9 2799.9 2803.7 2806.5 2554.8 2616.6 2662.9 2663.4 2687.1 15253.2 15439.9 15444.4 15455.7 15462.7 7452.4 7652.8 7678.2 7717.9 7728.1 4910.3 5086.5 5137.4 5165.2 5186.9 1954.9 1995.2 2009.5 2046.4 2069.2 26847.0 27117.7 27126.9 27140.9 27153.7 6555.6 6758.7 6920.0 6926.7 6933.4 17268.0 17358.0 17363.6 17366.8 17369.8 7912.7 8019.7 8099.7 8100.1 8103.8 7288.1 7310.4 7341.8 7351.5 7358.0 5178.4 5290.7 5303.7 5332.6 5419.4 1495.2 1500.4 1515.3 1518.4 1526.8 844.6 846.1 863.6 870.2 882.3 7004.0 7023.3 7918.1 8094.8 8172.0 688.1 695.3 705.0 708.2 729.4 4312.8 4357.1 4850.8 4874.4 4986.1 21284.7 22270.4 22279.0 22292.3 22293.2 20600.3 22049.9 22051.8 22093.9 22143.6 10767.6 10825.2 10831.6 10836.6 10893.8 8088.9 8185.3 8285.5 8299.0 8315.3 18403.9 18439.2 18552.1 18830.4 19039.2 19188.0 19618.3 19618.4 19850.1 20374.1 10777.6 10879.3 10930.0 10930.1 10933.3 13919.8 14157.4 14176.6 14290.2 14363.2 11104.4 11463.5 11644.3 11655.1 11862.1 11050.2 11206.6 11309.2 11448.9 11544.4 9041.1 9128.2 9142.5 9192.4 9211.1 6948.7 7041.5 7072.6 7127.4 7173.4 7386.8 7403.5 7412.8 7436.5 7499.2 03:14:59 INFO - PID 5344 | 03:14:59 INFO - PID 5344 | [#4] prototype.html Cycles:180 Average:5507.63 Median:6221.88 stddev:1529.48 (24.6%) stddev-sans-first:1486.84 03:14:59 INFO - PID 5344 | Values: 498.6 506.9 529.4 531.3 534.1 6245.9 6332.0 6338.6 6370.6 6382.2 6233.2 6295.7 6325.7 6347.3 6347.4 5240.2 5241.4 5247.0 5282.5 5283.3 4899.7 5057.8 5107.6 5162.3 5275.8 5011.3 5014.9 5016.9 5029.9 5052.7 4998.4 5026.9 5038.2 5039.5 5059.9 4367.7 4454.5 4461.5 4482.0 4494.8 6050.4 6056.5 6080.7 6137.1 6210.5 5650.9 5668.4 5693.7 5694.6 5711.3 6462.8 6518.8 6519.4 6524.1 6568.7 4633.2 4863.5 4870.3 4870.7 4911.6 6678.6 6706.1 6708.8 6822.7 6961.8 4977.5 4994.8 5004.2 5019.5 5066.1 5070.3 5085.6 5094.5 5109.2 5127.3 5692.5 5709.8 5723.3 5743.4 5782.2 6580.5 6591.9 6629.7 6644.0 6683.8 1757.7 1763.0 1784.5 1788.4 1789.8 1171.4 1211.8 1229.3 1237.0 1242.2 5597.1 5608.7 5611.7 5629.7 5654.2 6520.5 6583.1 6646.3 6719.9 6749.2 5614.2 5653.2 5666.0 5710.6 5713.4 3561.9 3568.0 3588.7 3597.9 3609.8 6429.9 6460.6 6474.8 6488.4 6525.0 6485.2 6799.1 6833.7 6836.4 6873.3 6444.9 6449.6 6473.4 6499.2 6512.2 6702.4 6702.4 6742.4 6754.5 6763.4 6598.4 6643.3 6734.0 6749.7 6757.8 6357.7 6407.7 6417.9 6460.6 6533.5 4932.1 4966.5 4983.6 5007.0 5010.1 6410.6 6623.3 6658.1 6729.3 6731.9 6133.6 6380.2 6443.3 6452.9 6477.4 6377.0 6403.3 6430.3 6457.7 6474.2 6295.0 6308.7 6387.7 6393.2 6412.5 6544.7 6579.7 6627.4 6654.2 6670.8 6267.9 6394.6 6394.8 6397.5 6399.2 03:14:59 INFO - PID 5344 | 03:14:59 INFO - PID 5344 | [#5] yui.html Cycles:180 Average:24886.95 Median:19133.47 stddev:36719.63 (191.9%) stddev-sans-first:36778.52 03:14:59 INFO - PID 5344 | Values: 913.6 932.6 936.2 936.4 938.5 19428.3 20356.3 20367.8 20374.8 20464.6 18303.3 18756.7 18790.7 18830.8 18838.6 941.5 954.6 956.0 956.6 959.9 979.4 981.5 982.2 982.3 982.4 985.3 1003.6 1005.7 1038.1 1039.6 999.1 1000.3 1000.9 1001.0 1001.4 715.9 749.6 749.9 750.1 750.1 20144.5 20561.7 20579.9 20585.9 20694.2 21566.1 21687.6 22190.6 22446.4 22486.3 17038.7 17114.1 17160.6 17346.7 17477.6 3768.8 3779.2 3784.1 3784.3 3786.2 106213.5 142084.0 142470.3 143949.0 146909.3 16480.9 17028.5 17145.4 17157.4 17166.7 29661.0 30108.7 30464.2 30499.8 30509.8 8987.8 9105.5 9111.0 9235.2 9265.4 4063.8 4154.1 4156.6 4157.5 4157.9 5467.4 5551.3 5581.0 5604.1 5606.9 906.6 1045.6 1052.4 1059.5 1059.6 684.8 698.4 705.4 711.7 718.4 11190.6 11220.9 11447.8 11521.8 11648.9 672.1 673.1 683.5 687.6 692.3 5559.2 5588.6 5602.7 5636.3 5669.9 127434.4 129200.4 131534.0 136434.0 136645.3 114054.0 116042.0 116270.0 117839.0 118235.4 96754.0 100062.0 100437.5 101729.0 102157.0 10375.1 10415.9 10566.1 10674.1 10730.1 43886.9 43939.0 44982.8 45679.1 45923.5 58419.7 58473.1 59265.4 59564.0 59690.7 15707.5 15777.9 15779.1 15851.4 15884.8 17615.1 17713.8 17763.9 17906.8 17952.4 14991.1 15083.0 15179.4 15188.8 15258.2 15363.3 15429.7 15522.2 15606.3 15611.7 14431.8 14504.3 14547.9 14705.2 14708.5 11319.9 11499.9 11622.0 11887.8 11989.8 11655.4 11924.2 11999.3 12177.3 12267.3 03:14:59 INFO - PID 5344 | -------- Summary: end -------- 03:14:59 INFO - PID 5344 | 03:14:59 INFO - TEST-INFO | 5344: exit 0 03:14:59 INFO - TEST-OK | dromaeo_css | took 1109341ms 03:14:59 INFO - TEST-START | kraken 03:14:59 INFO - Initialising browser for kraken test... 03:14:59 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:41569/getInfo.html -profile /tmp/tmpGWUkS4/profile 03:14:59 INFO - TEST-INFO | started process 5704 (/builds/slave/test/build/application/firefox/firefox http://localhost:41569/getInfo.html) 03:15:05 INFO - TEST-INFO | 5704: exit 0 03:15:05 INFO - Browser initialized. 03:15:05 INFO - Running cycle 1/1 for kraken test... 03:15:05 INFO - Using env: {'DISPLAY': ':0', 03:15:05 INFO - 'HOME': '/home/cltbld', 03:15:05 INFO - 'JSGC_DISABLE_POISONING': '1', 03:15:05 INFO - 'LANG': 'en_US.UTF-8', 03:15:05 INFO - 'LANGUAGE': 'en_US:en', 03:15:05 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 03:15:05 INFO - 'LOGNAME': 'cltbld', 03:15:05 INFO - 'MAIL': '/var/mail/cltbld', 03:15:05 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:15:05 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:15:05 INFO - 'MOZ_CRASHREPORTER': '1', 03:15:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:15:05 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 03:15:05 INFO - 'MOZ_NO_REMOTE': '1', 03:15:05 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:15:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:15:05 INFO - 'NO_EM_RESTART': '1', 03:15:05 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:15:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:15:05 INFO - 'PWD': '/builds/slave/test', 03:15:05 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:15:05 INFO - 'RUST_BACKTRACE': 'full', 03:15:05 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 03:15:05 INFO - 'SHELL': '/bin/bash', 03:15:05 INFO - 'SHLVL': '1', 03:15:05 INFO - 'STYLO_FORCE_DISABLED': '1', 03:15:05 INFO - 'TERM': 'linux', 03:15:05 INFO - 'TMOUT': '86400', 03:15:05 INFO - 'USER': 'cltbld', 03:15:05 INFO - 'XDG_SESSION_COOKIE': '5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771', 03:15:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:15:05 INFO - '_': '/tools/buildbot/bin/python'} 03:15:05 INFO - TEST-INFO | started process 5940 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGWUkS4/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 03:15:06 INFO - PID 5940 | 03:15:06 INFO - PID 5940 | (/builds/slave/test/build/application/firefox/firefox:5989): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 03:15:06 INFO - PID 5940 | 03:15:17 INFO - PID 5940 | RSS: Main: 153645056 03:15:17 INFO - PID 5940 | 03:15:19 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:41569/tests/kraken/driver.html?testName=audio-beat-detection) 03:15:20 INFO - PID 5940 | RSS: Main: 160550912 03:15:20 INFO - PID 5940 | 03:15:23 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:41569/tests/kraken/driver.html?testName=audio-dft) 03:15:23 INFO - PID 5940 | RSS: Main: 160362496 03:15:23 INFO - PID 5940 | 03:15:26 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:41569/tests/kraken/driver.html?testName=audio-fft) 03:15:27 INFO - PID 5940 | RSS: Main: 156033024 03:15:27 INFO - PID 5940 | 03:15:29 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:41569/tests/kraken/driver.html?testName=audio-oscillator) 03:15:30 INFO - PID 5940 | RSS: Main: 156770304 03:15:30 INFO - PID 5940 | 03:15:32 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:41569/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:15:32 INFO - PID 5940 | RSS: Main: 156725248 03:15:32 INFO - PID 5940 | 03:15:35 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:41569/tests/kraken/driver.html?testName=imaging-darkroom) 03:15:36 INFO - PID 5940 | RSS: Main: 159248384 03:15:36 INFO - PID 5940 | 03:15:40 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:41569/tests/kraken/driver.html?testName=imaging-desaturate) 03:15:40 INFO - PID 5940 | RSS: Main: 159498240 03:15:40 INFO - PID 5940 | 03:15:43 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:41569/tests/kraken/driver.html?testName=json-parse-financial) 03:15:44 INFO - PID 5940 | RSS: Main: 159494144 03:15:44 INFO - PID 5940 | 03:15:46 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:41569/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:15:46 INFO - PID 5940 | RSS: Main: 159629312 03:15:46 INFO - PID 5940 | 03:15:48 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:41569/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:15:48 INFO - PID 5940 | RSS: Main: 159457280 03:15:48 INFO - PID 5940 | 03:15:50 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:41569/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:15:51 INFO - PID 5940 | RSS: Main: 156344320 03:15:51 INFO - PID 5940 | 03:15:54 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:41569/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:15:54 INFO - PID 5940 | RSS: Main: 156606464 03:15:54 INFO - PID 5940 | 03:15:57 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:41569/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:15:58 INFO - PID 5940 | RSS: Main: 157208576 03:15:58 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | Cycle 1(1): loaded http://localhost:41569/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:41569/tests/kraken/driver.html?testName=ai-astar) 03:16:00 INFO - PID 5940 | RSS: Main: 158453760 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | __start_tp_report 03:16:00 INFO - PID 5940 | _x_x_mozilla_page_load 03:16:00 INFO - PID 5940 | _x_x_mozilla_page_load_details 03:16:00 INFO - PID 5940 | |i|pagename|runs| 03:16:00 INFO - PID 5940 | |0;ai-astar;106;105;106;109;110;106;108;107;105;106 03:16:00 INFO - PID 5940 | |1;audio-beat-detection;117;122;118;118;115;116;117;119;120;117 03:16:00 INFO - PID 5940 | |2;audio-dft;163;163;164;163;163;162;160;164;175;164 03:16:00 INFO - PID 5940 | |3;audio-fft;74;74;75;74;79;73;74;80;74;74 03:16:00 INFO - PID 5940 | |4;audio-oscillator;81;78;83;79;78;78;80;79;80;79 03:16:00 INFO - PID 5940 | |5;imaging-gaussian-blur;114;114;114;114;113;113;114;114;114;115 03:16:00 INFO - PID 5940 | |6;imaging-darkroom;152;149;147;149;148;149;147;149;148;150 03:16:00 INFO - PID 5940 | |7;imaging-desaturate;94;95;93;94;94;95;94;94;93;94 03:16:00 INFO - PID 5940 | |8;json-parse-financial;57;56;56;57;58;55;53;54;53;54 03:16:00 INFO - PID 5940 | |9;json-stringify-tinderbox;38;38;37;37;37;37;37;37;37;38 03:16:00 INFO - PID 5940 | |10;stanford-crypto-aes;82;74;74;73;76;73;75;77;74;75 03:16:00 INFO - PID 5940 | |11;stanford-crypto-ccm;114;111;115;110;113;111;119;111;124;115 03:16:00 INFO - PID 5940 | |12;stanford-crypto-pbkdf2;188;178;189;173;177;170;173;176;186;176 03:16:00 INFO - PID 5940 | |13;stanford-crypto-sha256-iterative;65;65;65;65;65;65;63;66;70;69 03:16:00 INFO - PID 5940 | __end_tp_report 03:16:00 INFO - PID 5940 | __start_cc_report 03:16:00 INFO - PID 5940 | _x_x_mozilla_cycle_collect,743 03:16:00 INFO - PID 5940 | __end_cc_report 03:16:00 INFO - PID 5940 | __startTimestamp1505816160430__endTimestamp 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | ------- Summary: start ------- 03:16:00 INFO - PID 5940 | Number of tests: 14 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#0] ai-astar Cycles:10 Average:106.80 Median:106.50 stddev:1.69 (1.6%) stddev-sans-first:1.76 03:16:00 INFO - PID 5940 | Values: 106.0 105.0 106.0 109.0 110.0 106.0 108.0 107.0 105.0 106.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#1] audio-beat-detection Cycles:10 Average:117.90 Median:118.00 stddev:2.02 (1.7%) stddev-sans-first:2.12 03:16:00 INFO - PID 5940 | Values: 117.0 122.0 118.0 118.0 115.0 116.0 117.0 119.0 120.0 117.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#2] audio-dft Cycles:10 Average:164.10 Median:163.50 stddev:4.01 (2.5%) stddev-sans-first:4.24 03:16:00 INFO - PID 5940 | Values: 163.0 163.0 164.0 163.0 163.0 162.0 160.0 164.0 175.0 164.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#3] audio-fft Cycles:10 Average:75.10 Median:74.00 stddev:2.38 (3.2%) stddev-sans-first:2.49 03:16:00 INFO - PID 5940 | Values: 74.0 74.0 75.0 74.0 79.0 73.0 74.0 80.0 74.0 74.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#4] audio-oscillator Cycles:10 Average:79.50 Median:79.50 stddev:1.58 (2.0%) stddev-sans-first:1.58 03:16:00 INFO - PID 5940 | Values: 81.0 78.0 83.0 79.0 78.0 78.0 80.0 79.0 80.0 79.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#5] imaging-gaussian-blur Cycles:10 Average:113.90 Median:114.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 03:16:00 INFO - PID 5940 | Values: 114.0 114.0 114.0 114.0 113.0 113.0 114.0 114.0 114.0 115.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#6] imaging-darkroom Cycles:10 Average:148.80 Median:149.00 stddev:1.48 (1.0%) stddev-sans-first:1.01 03:16:00 INFO - PID 5940 | Values: 152.0 149.0 147.0 149.0 148.0 149.0 147.0 149.0 148.0 150.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#7] imaging-desaturate Cycles:10 Average:94.00 Median:94.00 stddev:0.67 (0.7%) stddev-sans-first:0.71 03:16:00 INFO - PID 5940 | Values: 94.0 95.0 93.0 94.0 94.0 95.0 94.0 94.0 93.0 94.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#8] json-parse-financial Cycles:10 Average:55.30 Median:56.00 stddev:1.77 (3.2%) stddev-sans-first:1.76 03:16:00 INFO - PID 5940 | Values: 57.0 56.0 56.0 57.0 58.0 55.0 53.0 54.0 53.0 54.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#9] json-stringify-tinderbox Cycles:10 Average:37.30 Median:37.00 stddev:0.48 (1.3%) stddev-sans-first:0.44 03:16:00 INFO - PID 5940 | Values: 38.0 38.0 37.0 37.0 37.0 37.0 37.0 37.0 37.0 38.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#10] stanford-crypto-aes Cycles:10 Average:75.30 Median:75.00 stddev:2.67 (3.6%) stddev-sans-first:1.33 03:16:00 INFO - PID 5940 | Values: 82.0 74.0 74.0 73.0 76.0 73.0 75.0 77.0 74.0 75.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#11] stanford-crypto-ccm Cycles:10 Average:114.30 Median:114.50 stddev:4.35 (3.8%) stddev-sans-first:4.61 03:16:00 INFO - PID 5940 | Values: 114.0 111.0 115.0 110.0 113.0 111.0 119.0 111.0 124.0 115.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:178.60 Median:177.50 stddev:6.70 (3.8%) stddev-sans-first:6.19 03:16:00 INFO - PID 5940 | Values: 188.0 178.0 189.0 173.0 177.0 170.0 173.0 176.0 186.0 176.0 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.80 Median:65.00 stddev:2.10 (3.2%) stddev-sans-first:2.20 03:16:00 INFO - PID 5940 | Values: 65.0 65.0 65.0 65.0 65.0 65.0 63.0 66.0 70.0 69.0 03:16:00 INFO - PID 5940 | -------- Summary: end -------- 03:16:00 INFO - PID 5940 | 03:16:00 INFO - PID 5940 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 03:16:01 INFO - TEST-INFO | 5940: exit 0 03:16:01 INFO - TEST-OK | kraken | took 61193ms 03:16:01 INFO - SUITE-END | took 1170s 03:16:01 INFO - Completed test suite (00:19:30) 03:16:01 INFO - javascript benchmark 03:16:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s", "stylo_disabled"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8474.709860365407, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3126.0621813455964, 3147.228928912417, 3149.54331621915, 3159.2259896325404, 3160.905172844814, 6154.5999510031925, 6215.19202503675, 6248.4688801451875, 6285.214348206474, 6344.333844946278, 6253.906191407133, 6261.937380626192, 6282.120503129554, 6295.874082518347, 6298.496120310376, 5754.251947246873, 5758.942410575893, 5775.249217601706, 5778.884422311551, 5913.319968203668, 5846.707664616773, 5888.5289176865745, 5933.762649494037, 5940.346561878211, 5951.226340575719, 5790.082334219606, 5806.651600903938, 5857.824265272027, 5905.0, 5950.107483877409, 5810.360860305363, 5862.97068514659, 5903.527717782567, 5917.763289468416, 5947.345791962881, 5706.9714651426475, 5739.081746920514, 5788.623739456922, 5815.534757219454, 5823.883522329572, 6274.403931626488, 6292.811215663537, 6295.213098362705, 6343.080253363237, 6352.841178970517, 6743.426808721265, 6758.695858686371, 6826.726930922757, 6829.556078854858, 6874.828129296758, 6551.05009773585, 6803.047573339736, 6845.589264644087, 6912.205096413926, 6941.826454338631, 6243.406876346739, 6313.810585682437, 6420.422162005442, 6428.678566071678, 6444.903326450107, 6977.09297791294, 6978.825529361705, 7072.186698529632, 7087.50387472872, 7120.038794762744, 6450.322716114834, 6669.499787515956, 6706.798796036127, 6707.765228216989, 6768.526203165829, 6663.733450661919, 6679.265280819106, 6684.364985326386, 6684.699188536528, 6686.197656281277, 6646.634435106115, 6654.800355989328, 6672.666366681647, 6680.832979175462, 6706.7652632158615, 6813.965930170417, 6821.283765204681, 6867.484938629523, 6896.551724137915, 6906.412954898789, 5206.505381988705, 5284.154535274338, 5293.629445938747, 5328.866778330573, 5397.379301380392, 4668.789904454307, 4698.694584851974, 4705.153072446924, 4707.670463067621, 4753.667243292936, 5761.279840019997, 5785.218995435646, 5832.066869300891, 5844.766209351578, 5849.61977471463, 6610.405063544208, 6697.933020669731, 6727.091842601284, 6742.123523941857, 6749.358810912955, 5697.544196464356, 5728.198052272685, 5795.971020144872, 5800.1299805029585, 5801.0, 5825.359210486843, 5853.443922827325, 5889.617174883619, 5890.793822216202, 5912.9113063304085, 6538.346165383424, 6553.639549824806, 6619.966900165468, 6630.336966303331, 6638.900416493757, 6790.966045169841, 6800.217974932946, 6816.113905192194, 6872.0, 6901.206361268519, 6367.522435817425, 6459.128017717548, 6460.8707825842275, 6466.06242094903, 6529.804105876831, 6601.53789234749, 6621.0, 6623.437007854386, 6633.9668301658185, 6641.369069938348, 6776.356246156607, 6783.796486105425, 6789.355011273921, 6789.947558128498, 6793.762218322335, 6571.605703657796, 6655.767048153291, 6676.566023208476, 6679.6994135265, 6688.230853451721, 6583.967080164569, 6589.868202635825, 6654.767083152066, 6662.900056499253, 6674.532782705164, 6348.809535713936, 6447.806565803034, 6502.837429064311, 6507.219133703986, 6594.670266486753, 6522.739090436329, 6531.640759758259, 6570.0, 6675.566088204251, 6735.023421603938, 6193.040078787795, 6284.874302513833, 6349.841253968688, 6454.741810327722, 6466.612003279818], "value": 6164.930848816898, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [857.352698712472, 887.4276091920711, 913.0276255787588, 915.9084091590846, 916.2715641065353, 39645.60354396455, 41883.37174942374, 42117.36823947643, 42129.36805947913, 42211.36682949758, 38190.23619527615, 38507.0, 38630.0, 38654.22691546167, 38673.61326386735, 7086.787396378117, 7211.89182162268, 7270.05489286392, 7275.417966562689, 7283.9271607284045, 7162.498625096246, 7248.855022899539, 7263.346298833104, 7263.382612477946, 7267.055282813227, 7207.135143782753, 7238.674259658302, 7241.23966983467, 7248.202697703248, 7354.374878135338, 7975.601219939009, 8017.0, 8022.558759268238, 8036.116027236999, 8051.677932882678, 7903.249191326815, 8006.719764808262, 8006.759797206093, 8019.799505012363, 8030.558319292437, 38450.61549384498, 38818.80590597057, 39566.0, 40057.39913901294, 40099.19801603952, 3369.073504786179, 3411.3688967541084, 3413.368526822521, 3418.2479854431986, 3418.8119653419053, 32168.356632867446, 32185.1953701157, 32210.194745131324, 32282.354352913044, 32346.02961911123, 5160.92258616121, 5168.250603662485, 5215.24378965048, 5218.6868787872845, 5225.503577160163, 186047.0, 187867.0, 187875.0, 188231.0, 188273.0, 47905.76047119742, 48336.274955874986, 48582.27126593104, 48611.5138848607, 48674.0, 50242.246366304535, 50302.24546631803, 50338.24492632614, 50452.24321635178, 50484.0, 15729.0, 16138.515844524683, 16168.67662646764, 16169.272382742805, 16190.919045404698, 13036.0, 13154.868451315555, 13166.539171128965, 13180.275084870233, 13206.27365494907, 14404.495842645458, 14468.493602723855, 14489.927550362181, 14543.043981019926, 14608.488702895347, 5800.477956983807, 5897.76408943646, 5935.495482883917, 5940.198073260141, 6015.187949626832, 1002.4286156890648, 1013.2805707947292, 1027.712240572641, 1027.9743006424899, 1035.7669524356959, 22838.086476541084, 23091.538169236857, 23143.0, 23202.0, 23269.650955235684, 1099.5107177306022, 1117.1007339091946, 1126.7690123524658, 1128.700894263021, 1130.4799792095564, 12003.374482720814, 12117.333546655018, 12216.02122440006, 12312.883191336876, 12331.568395106127, 232242.0, 233284.0, 233745.0, 233947.0, 234069.0, 45132.3230151548, 45426.545734542895, 50953.745231273606, 51548.48451515512, 52121.47878521242, 1441.2361448432348, 1447.326992948263, 1448.1166488442043, 1463.6267751723242, 1470.5367809140087, 26620.0, 27210.863945680147, 27239.182824515297, 27540.862295688392, 27797.305067373476, 36212.0, 36276.09309767277, 36350.63649363472, 36381.81809090938, 36561.45157822688, 188142.0, 188921.0, 189415.0, 190312.0, 190600.0, 32992.83503582467, 34046.148846279044, 34066.65933340734, 34148.65851341554, 34221.65778342185, 42071.36892946547, 42197.15605687808, 42525.5747442534, 42585.574144258164, 42612.0, 31226.375472490876, 31279.218019549695, 31350.68649313569, 31768.523472148398, 32037.35925281528, 31124.533132002583, 31470.80281028525, 31632.525512116878, 31804.522932155574, 31983.0, 35089.47365789464, 35283.82358088193, 35386.646133538336, 35508.82245588755, 35517.82241088778, 30781.23046923845, 30812.22969425782, 31075.844620776752, 31182.532262015633, 31220.219494512818, 23245.3026409208, 23353.532929341658, 23422.76577234206, 23603.763962360157, 23824.523509529365], "value": 17100.470912927074, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [574.0, 576.8154190658988, 585.3005658238404, 585.6661702829389, 590.5128269177928, 22076.558468830615, 22976.195833145845, 22990.88504557477, 23029.0, 23029.309120726404, 24149.275521734333, 25049.373765655866, 25301.0, 25325.873370633122, 25730.228093157188, 6386.808395748123, 6468.062130991004, 6501.284858665543, 6520.576162549442, 6536.575122617039, 6353.809385718436, 6404.391582799627, 6520.9673951630175, 6521.250056243545, 6669.599824010551, 6637.701303441357, 6639.103720997652, 6640.302768209341, 6646.136002319692, 6648.335166483337, 6386.329435409308, 6652.06871038055, 6655.201375834882, 6659.400653941144, 6660.367265109807, 6101.237345331833, 6144.723487443031, 6145.846353841145, 6147.077938309245, 6152.969235153841, 27891.86054069737, 28335.0, 28490.715092849012, 28502.429951401064, 28509.572356414672, 2095.8532902696816, 2113.0491278924546, 2117.894105294729, 2120.7879212078824, 2125.989370053155, 18519.2592296308, 18910.716339254923, 19219.90390048055, 19474.902625486924, 19569.9021504893, 2477.442575420534, 2481.1192026830577, 2522.2811498722776, 2524.432002799374, 2532.4048848520583, 126460.0, 132343.0, 135726.0, 141020.0, 142395.28802356025, 14501.8237097069, 14850.183239921907, 14880.883933705016, 14992.925035374754, 15031.624209394853, 22440.66339004916, 22519.88740056322, 22565.323040308816, 22629.886850565643, 22697.88651056767, 9839.163671087894, 9977.501124943723, 10113.0, 10193.592256309812, 10246.846297305547, 9102.726918192464, 9152.130547597968, 9206.585703643352, 9242.12199841014, 9260.259179265642, 8847.20375166238, 8891.244244239182, 9106.225970792424, 9110.544472776468, 9146.63413463454, 2690.5426077566467, 2699.284689557269, 2702.5270577648835, 2715.6198132261497, 2770.3074231442138, 951.296040929707, 971.708487453761, 976.5800705696619, 982.3663736889808, 983.1692220074169, 19032.238710451704, 19145.617087658167, 19593.706094408597, 19604.803951960585, 19695.704564431544, 1026.5329275179774, 1037.1080870451406, 1041.6354276003337, 1045.153425725165, 1048.7116043088213, 10468.319559228778, 10632.202584806171, 10687.465626718633, 10743.247972641997, 10778.622748203776, 467212.0, 480300.0, 480366.0, 482659.0, 499647.0, 107087.0, 107821.4608926966, 108678.45660771645, 112394.0, 113972.43013784879, 1143.7924805126186, 1156.849609550753, 1178.8585369755683, 1180.805167147411, 1188.2989036468525, 16893.408730694366, 16930.153492325087, 17023.297670232878, 17458.039807810692, 17630.559236019202, 54375.72812135914, 55402.72298638481, 55688.44311556833, 55747.0, 56521.71739141278, 70273.29726702668, 70708.29291707017, 71470.0, 71530.64234678794, 72339.0, 13808.240546770025, 14151.0, 14160.291985400894, 14164.220967846868, 14170.291485425894, 18875.244990200237, 18876.811231887506, 19032.904835475732, 19044.904775476032, 19631.018449077204, 17419.3903213392, 17723.20245588926, 17915.283388664306, 17920.655950804, 17943.730844037087, 15459.381624735335, 15807.525774226791, 16177.0, 16412.83587164113, 16447.424340148038, 17150.914245428692, 17746.37887673925, 17781.644367112844, 18182.636347273245, 18254.81745182531, 13835.169889806644, 13850.376733046836, 13890.097143685629, 13950.860491394957, 14071.296435177996, 17384.652306953536, 17639.647207056045, 17770.644587108443, 17795.73306400379, 17875.19561619704], "value": 11753.792430020334, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1313.251446675395, 1421.4456362018814, 1424.0956992309893, 1431.5132854829355, 1436.0880840666173, 14809.925950370247, 15427.074375537448, 15441.922790386061, 15465.149416782073, 15468.535943921672, 15040.473583424582, 15194.54416367508, 15198.620034499143, 15213.695726085472, 15240.0, 2694.5015172193207, 2720.7551320381162, 2752.8073034887566, 2777.4445110977886, 2778.402643431662, 2685.4226341336607, 2738.87675054623, 2749.931251718703, 2751.9036833710825, 2753.325435268352, 2646.0077470948395, 2665.4669066186743, 2684.6375739275145, 2765.5713364428548, 2791.7208279172023, 2766.5711814668657, 2779.8610069496644, 2799.9020034298806, 2803.7056109108657, 2806.480801051802, 2554.8083893708044, 2616.5813469844925, 2662.853543055131, 2663.3607934095676, 2687.0998215597797, 15253.161076140808, 15439.922800385926, 15444.382224710998, 15455.690886182214, 15462.690746185013, 7452.441066919949, 7652.7704168875025, 7678.155402905676, 7717.922820771832, 7728.149903510609, 4910.288008238821, 5086.4659210783075, 5137.434882162959, 5165.199394093921, 5186.92219616706, 1954.8924809135492, 1995.1720036184965, 2009.4574464894397, 2046.3758553641132, 2069.2136987944637, 26847.0, 27117.728822711717, 27126.864365678244, 27140.864295678395, 27153.728462715317, 6555.639439830855, 6758.662066896733, 6919.965400172967, 6926.722931082801, 6933.410660093848, 17268.0, 17358.0, 17363.565910852078, 17366.826331736775, 17369.826301737074, 7912.683492660344, 8019.679212831421, 8099.716509922125, 8100.0684921234815, 8103.797405064921, 7288.12542494904, 7310.378617817439, 7341.816454588571, 7351.4853960223345, 7358.00666909971, 5178.378594568676, 5290.68255904647, 5303.7348132593215, 5332.600054995891, 5419.376771671229, 1495.162708883029, 1500.4020717935364, 1515.2575238133456, 1518.422999260274, 1526.809148856393, 844.6283635200492, 846.0650980666398, 863.6243234193146, 870.2124577257592, 882.298572634757, 7003.964980175067, 7023.262557431498, 7918.129005809356, 8094.797630059295, 8172.0, 688.1398252184769, 695.3359541637724, 704.9788506344818, 708.1926603671818, 729.4492658043143, 4312.7627980461375, 4357.063231405263, 4850.75746212688, 4874.439439464436, 4986.102501549756, 21284.680729789066, 22270.443238919157, 22278.99744511501, 22292.331230063122, 22293.219737309115, 20600.27899023527, 22049.889750551145, 22051.779482205293, 22093.889530552246, 22143.557128857334, 10767.623133190458, 10825.188110891715, 10831.620893268699, 10836.62071827498, 10893.83659245112, 8088.87866682012, 8185.30424913889, 8285.544295063588, 8299.004119505698, 8315.334773218248, 18403.90798046001, 18439.170237339084, 18552.072396379855, 18830.435086947415, 19039.238430462625, 19188.0, 19618.313359032367, 19618.41144765602, 19850.10674519621, 20374.083166257256, 10777.62278320255, 10879.292845964987, 10930.0, 10930.125589952944, 10933.289336193122, 13919.79120313176, 14157.36291866848, 14176.574702758933, 14290.214038227998, 14363.21002344881, 11104.445377647298, 11463.484143213409, 11644.301341919512, 11655.067594592243, 11862.110341724578, 11050.226484146355, 11206.551737930391, 11309.151813613847, 11448.94275528617, 11544.422778861192, 9041.095890410907, 9128.178463938277, 9142.542872856464, 9192.356535042483, 9211.124943130391, 6948.652567371712, 7041.5422997505, 7072.611006394492, 7127.358537731629, 7173.390261827803, 7386.815329616803, 7403.51877127985, 7412.777616671508, 7436.479446438913, 7499.175090740124], "value": 6588.327987308081, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [498.58187789222256, 506.8884845334026, 529.3515443581612, 531.3278702441412, 534.0813800263545, 6245.9063114053215, 6332.0, 6338.556301058922, 6370.617762934227, 6382.170317858672, 6233.223531293582, 6295.685215739218, 6325.6837158142025, 6347.333529979355, 6347.36526347365, 5240.161574148127, 5241.42344342122, 5246.973765131169, 5282.471752824726, 5283.286756287909, 4899.730514821684, 5057.811414317633, 5107.591392688594, 5162.303089082963, 5275.815346462875, 5011.273365362021, 5014.924776128361, 5016.949830501685, 5029.924551131736, 5052.747362631872, 4998.40019197695, 5026.949730502684, 5038.168702164138, 5039.546440820307, 5059.924101138486, 4367.71609845359, 4454.532274111237, 4461.5092339842595, 4481.955180448186, 4494.8202071917085, 6050.3647117052515, 6056.454919057262, 6080.695965201767, 6137.140800287963, 6210.534209934228, 5650.915236271459, 5668.404817494145, 5693.658380497183, 5694.629849059798, 5711.314642242957, 6462.836689395906, 6518.77184298552, 6519.4132528072705, 6524.11814970092, 6568.67156642166, 4633.189191891405, 4863.489333619955, 4870.342503761982, 4870.65905386623, 4911.582515486188, 6678.599284042973, 6706.128203333584, 6708.798736037927, 6822.727090916357, 6961.825954351131, 4977.502249775066, 4994.8262158392745, 5004.199328107486, 5019.47295533971, 5066.088104141216, 5070.340855688737, 5085.618578606619, 5094.541491265803, 5109.182530795055, 5127.333446651986, 5692.52375216782, 5709.82870513877, 5723.284589426322, 5743.368229494752, 5782.219400380979, 6580.453593405546, 6591.901121483182, 6629.701663425158, 6644.0, 6683.832904177434, 1757.6836169489616, 1762.9911850440665, 1784.5360206346184, 1788.3830078622855, 1789.7852257729155, 1171.4084387384316, 1211.787937111002, 1229.2562999385243, 1236.9938150309372, 1242.2422322383338, 5597.1174844954885, 5608.719564021782, 5611.719414029282, 5629.662220266797, 5654.180143879197, 6520.5435619507125, 6583.144191255202, 6646.302138275508, 6719.899201511981, 6749.156355455568, 5614.157876318503, 5653.173413293353, 5666.025336698266, 5710.628809127394, 5713.371529131792, 3561.910952226215, 3567.9643203568153, 3588.7308451866215, 3597.8740744074357, 3609.819509024538, 6429.8714025720155, 6460.612363258126, 6474.838129046811, 6488.383603557654, 6525.0, 6485.189351331083, 6799.1161149051295, 6833.726650933907, 6836.350546698056, 6873.312668733187, 6444.903326450013, 6449.645269510222, 6473.352664733489, 6499.1876015498065, 6512.153420055362, 6702.396784289437, 6702.430293425114, 6742.393184613408, 6754.527183097136, 6763.425108865801, 6598.406143447113, 6643.30245324234, 6734.0, 6749.73001079971, 6757.7562769869755, 6357.682115894094, 6407.743690252524, 6417.93582064192, 6460.612363258219, 6533.509986751108, 4932.087563800708, 4966.528179822911, 4983.601311894967, 5007.048660754445, 5010.148274793367, 6410.647414392253, 6623.271440141484, 6658.1344425224415, 6729.259781424137, 6731.932680673131, 6133.6319820810895, 6380.170577824853, 6443.323451037573, 6452.903206452001, 6477.4494167996245, 6377.0, 6403.278606592273, 6430.324815894263, 6457.741690332334, 6474.1583594134345, 6294.968525157345, 6308.71610777507, 6387.744490220339, 6393.2328120625825, 6412.487001039813, 6544.738210471528, 6579.736810527525, 6627.403533681992, 6654.201495820533, 6670.76652317186, 6267.937320626917, 6394.616323020634, 6394.808155755335, 6397.456216221487, 6399.232092148972], "value": 5058.869524626721, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [913.575187537795, 932.5803388475188, 936.2042264075533, 936.3539157980995, 938.4932136646212, 19428.320008799677, 20356.287529936457, 20367.796322036756, 20374.79625203751, 20464.590708185846, 18303.267869285213, 18756.718649220238, 18790.718139227924, 18830.81169188308, 18838.62322753544, 941.4680705401444, 954.6229239450413, 955.9952200238989, 956.5934477846922, 959.8848138223389, 979.4172467381932, 981.4651015196699, 982.1946004276496, 982.2829334585757, 982.3909176310698, 985.261054209343, 1003.5985605757683, 1005.6982905128468, 1038.1331588123926, 1039.552992213348, 999.0808456220295, 1000.2997901468965, 1000.8999100090006, 1001.0490034467249, 1001.3791449301443, 715.9248278930742, 749.6289336778275, 749.9100107987022, 750.1261030898996, 750.1335956969655, 20144.49638759028, 20561.69157462639, 20579.8971005144, 20585.89707051455, 20694.172233110658, 21566.1373545058, 21687.566248675095, 22190.556188876293, 22446.438839028993, 22486.325410237718, 17038.659226815395, 17114.05872677002, 17160.57098572533, 17346.65306693859, 17477.56306092345, 3768.8304026318883, 3779.1874746929543, 3784.0918179636687, 3784.280986612535, 3786.2048969716393, 106213.46893265484, 142084.0, 142470.28764856214, 143949.0, 146909.2654536731, 16480.917595411946, 17028.48914532566, 17145.399911003304, 17157.399491018004, 17166.742498862528, 29661.0, 30108.698913011027, 30464.238394040327, 30499.847500762353, 30509.847450762605, 8987.820243595223, 9105.453672779655, 9111.04334044929, 9235.215006724504, 9265.44407335562, 4063.776492292893, 4154.1068670236045, 4156.584341565819, 4157.521884983265, 4157.854475093357, 5467.371252305956, 5551.250581171571, 5581.0, 5604.075327570987, 5606.887862242814, 906.5648488725449, 1045.6078970386104, 1052.4159091704025, 1059.5285098131412, 1059.5814653211937, 684.8219462939572, 698.4482259015423, 705.4039336760429, 711.6833009310807, 718.3821913154683, 11190.608328708457, 11220.934011268917, 11447.771044579062, 11521.827172592419, 11648.88351116495, 672.1497305908031, 673.1316601584, 683.5147045597582, 687.5737043033351, 692.3215249055953, 5559.166125081189, 5588.608797384225, 5602.663840169603, 5636.267285252891, 5669.886602267931, 127434.36282818527, 129200.3539982313, 131534.0, 136434.0, 136645.31677341548, 114054.0, 116042.0, 116270.0, 117839.0, 118235.40882295533, 96754.0, 100062.0, 100437.49343759849, 101729.0, 102157.0, 10375.118114960313, 10415.895841041493, 10566.056530942598, 10674.092702120406, 10730.087942524973, 43886.90282742957, 43939.0, 44982.77508612436, 45679.08641827211, 45923.540764593265, 58419.70790146022, 58473.12290315734, 59265.40734592771, 59564.0, 59690.70154649373, 15707.528774136794, 15777.921110394374, 15779.132147731985, 15851.445199417965, 15884.841151588336, 17615.119244038004, 17713.822861771216, 17763.911180444014, 17906.820931791037, 17952.371666991592, 14991.100533967996, 15083.019603725723, 15179.392824286904, 15188.848111518744, 15258.160801155598, 15363.308651110503, 15429.691406172038, 15522.223888805289, 15606.297716602554, 15611.687766244839, 14431.78352324737, 14504.274786260856, 14547.927260363631, 14705.191214483306, 14708.485203017843, 11319.943400283275, 11499.885001149882, 11622.0, 11887.821682674594, 11989.76020479603, 11655.358955257543, 11924.224925379822, 11999.340036297739, 12177.330246836154, 12267.263964162179], "value": 8969.754373363092, "unit": "score"}]}, {"extraOptions": ["e10s", "stylo_disabled"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1426.6999999999996, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 105.0, 106.0, 109.0, 110.0, 106.0, 108.0, 107.0, 105.0, 106.0], "value": 106.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 122.0, 118.0, 118.0, 115.0, 116.0, 117.0, 119.0, 120.0, 117.0], "value": 117.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 164.0, 163.0, 163.0, 162.0, 160.0, 164.0, 175.0, 164.0], "value": 164.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 74.0, 75.0, 74.0, 79.0, 73.0, 74.0, 80.0, 74.0, 74.0], "value": 75.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 78.0, 83.0, 79.0, 78.0, 78.0, 80.0, 79.0, 80.0, 79.0], "value": 79.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 114.0, 114.0, 113.0, 113.0, 114.0, 114.0, 114.0, 115.0], "value": 113.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 149.0, 147.0, 149.0, 148.0, 149.0, 147.0, 149.0, 148.0, 150.0], "value": 148.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 93.0, 94.0, 94.0, 95.0, 94.0, 94.0, 93.0, 94.0], "value": 94.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 56.0, 56.0, 57.0, 58.0, 55.0, 53.0, 54.0, 53.0, 54.0], "value": 55.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [38.0, 38.0, 37.0, 37.0, 37.0, 37.0, 37.0, 37.0, 37.0, 38.0], "value": 37.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 74.0, 74.0, 73.0, 76.0, 73.0, 75.0, 77.0, 74.0, 75.0], "value": 75.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 111.0, 115.0, 110.0, 113.0, 111.0, 119.0, 111.0, 124.0, 115.0], "value": 114.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [188.0, 178.0, 189.0, 173.0, 177.0, 170.0, 173.0, 176.0, 186.0, 176.0], "value": 178.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 65.0, 65.0, 65.0, 65.0, 65.0, 63.0, 66.0, 70.0, 69.0], "value": 65.8, "unit": "score"}]}]} 03:16:01 INFO - Return code: 0 03:16:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 03:16:01 INFO - # TBPL SUCCESS # 03:16:01 INFO - Running post-action listener: _package_coverage_data 03:16:01 INFO - Running post-action listener: _resource_record_post_action 03:16:01 INFO - [mozharness: 2017-09-19 10:16:01.218229Z] Finished run-tests step (success) 03:16:01 INFO - Running post-run listener: _resource_record_post_run 03:16:01 INFO - Total resource usage - Wall time: 1189s; CPU: 13.0%; Read bytes: 4096; Write bytes: 338771968; Read time: 12; Write time: 329312 03:16:01 INFO - TinderboxPrint: CPU usage
13.1% 03:16:01 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 03:16:01 INFO - TinderboxPrint: I/O write bytes / time
338,771,968 / 329,312 03:16:01 INFO - TinderboxPrint: CPU idle
8,236.9 (86.9%) 03:16:01 INFO - TinderboxPrint: CPU user
1,192.0 (12.6%) 03:16:01 INFO - TinderboxPrint: Swap in / out
0 / 0 03:16:01 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 12955648; Read time: 0; Write time: 1604 03:16:01 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 03:16:01 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 0; Write bytes: 324763648; Read time: 0; Write time: 327608 03:16:01 INFO - Running post-run listener: _upload_blobber_files 03:16:01 INFO - Blob upload gear active. 03:16:01 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:16:01 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 03:16:01 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'] 03:16:01 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 03:16:02 INFO - (blobuploader) - INFO - Open directory for files ... 03:16:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 03:16:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:16:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:16:03 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 03:16:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:16:03 INFO - (blobuploader) - INFO - Done attempting. 03:16:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log ... 03:16:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:16:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:16:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_raw.log: uploaded 03:16:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:16:04 INFO - (blobuploader) - INFO - Done attempting. 03:16:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 03:16:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:16:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:16:11 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 03:16:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:16:11 INFO - (blobuploader) - INFO - Done attempting. 03:16:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log ... 03:16:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:16:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:16:12 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_errorsummary.log: uploaded 03:16:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:16:12 INFO - (blobuploader) - INFO - Done attempting. 03:16:12 INFO - (blobuploader) - INFO - Iteration through files over. 03:16:12 INFO - Return code: 0 03:16:12 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:16:12 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:16:12 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/dd1b3a9d092a46fd20cdcb5d14af9c2fcdf5c2920bbf3e5979ff68277a1ce575afbd70eb5d72f0023c82fd432dacab46a5d50ba966fdd23bc653d3eda8a2951e", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c43aae1f115c0973d0a65c48618115aa7b6476faed367287e2c57fd776437b79e8e2f5d77442caccc50abe981271a0285ff47dbd80354a647e36c387e1f8a4e0", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ed23ec791da65cfb9d398f5779b3efa653944bdc61aaf6ca6fc45647582c9b3a1d522de40fb33c0870226462ae061fc891595c62c6641e1722a84e56990b4b51", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ab266b131628b593eb5a72200eba28f242d0e0c00e5b4c5d23b3a193da046970e1b60646dffefbfe5992230f3c5abed7fa60d77e75db9716cd3462f5f3e33938"} 03:16:12 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:16:12 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:16:12 INFO - Contents: 03:16:12 INFO - blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/dd1b3a9d092a46fd20cdcb5d14af9c2fcdf5c2920bbf3e5979ff68277a1ce575afbd70eb5d72f0023c82fd432dacab46a5d50ba966fdd23bc653d3eda8a2951e", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c43aae1f115c0973d0a65c48618115aa7b6476faed367287e2c57fd776437b79e8e2f5d77442caccc50abe981271a0285ff47dbd80354a647e36c387e1f8a4e0", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ed23ec791da65cfb9d398f5779b3efa653944bdc61aaf6ca6fc45647582c9b3a1d522de40fb33c0870226462ae061fc891595c62c6641e1722a84e56990b4b51", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ab266b131628b593eb5a72200eba28f242d0e0c00e5b4c5d23b3a193da046970e1b60646dffefbfe5992230f3c5abed7fa60d77e75db9716cd3462f5f3e33938"} 03:16:12 INFO - Running post-run listener: copy_logs_to_upload_dir 03:16:12 INFO - Copying logs to upload dir... 03:16:12 INFO - mkdir: /builds/slave/test/build/upload/logs 03:16:12 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.170427 ========= master_lag: -0.11 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2017-09-19 03:16:12.218237) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-19 03:16:12.225049) ========= 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=5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771 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/dd1b3a9d092a46fd20cdcb5d14af9c2fcdf5c2920bbf3e5979ff68277a1ce575afbd70eb5d72f0023c82fd432dacab46a5d50ba966fdd23bc653d3eda8a2951e", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c43aae1f115c0973d0a65c48618115aa7b6476faed367287e2c57fd776437b79e8e2f5d77442caccc50abe981271a0285ff47dbd80354a647e36c387e1f8a4e0", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ed23ec791da65cfb9d398f5779b3efa653944bdc61aaf6ca6fc45647582c9b3a1d522de40fb33c0870226462ae061fc891595c62c6641e1722a84e56990b4b51", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ab266b131628b593eb5a72200eba28f242d0e0c00e5b4c5d23b3a193da046970e1b60646dffefbfe5992230f3c5abed7fa60d77e75db9716cd3462f5f3e33938"} build_url:https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011303 build_url: 'https://queue.taskcluster.net/v1/task/E2iwetAjQBK55x0sv57OwA/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/dd1b3a9d092a46fd20cdcb5d14af9c2fcdf5c2920bbf3e5979ff68277a1ce575afbd70eb5d72f0023c82fd432dacab46a5d50ba966fdd23bc653d3eda8a2951e", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c43aae1f115c0973d0a65c48618115aa7b6476faed367287e2c57fd776437b79e8e2f5d77442caccc50abe981271a0285ff47dbd80354a647e36c387e1f8a4e0", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ed23ec791da65cfb9d398f5779b3efa653944bdc61aaf6ca6fc45647582c9b3a1d522de40fb33c0870226462ae061fc891595c62c6641e1722a84e56990b4b51", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/ab266b131628b593eb5a72200eba28f242d0e0c00e5b4c5d23b3a193da046970e1b60646dffefbfe5992230f3c5abed7fa60d77e75db9716cd3462f5f3e33938"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-19 03:16:12.256349) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-19 03:16:12.256723) ========= 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=5c37b704b588aaa989324530000001d0-1505799678.184492-1150226771 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004493 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-19 03:16:12.339041) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-19 03:16:12.339444) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-19 03:16:12.339886) ========= ========= Total master_lag: 0.15 =========