builder: mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s slave: talos-linux64-ix-005 starttime: 1505502450.65 results: success (0) revision: 7aceaf8bcb9f582db0f93488b48ef7019e348dba ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:30.654341) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:30.654801) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:30.655737) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:30.746451) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:30.746861) ========= 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=7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-09-15 12:07:30-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.2M=0s 2017-09-15 12:07:30 (46.2 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.109064 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:30.874554) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:30.874993) ========= 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=7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019991 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:30.925756) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:30.926166) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 7aceaf8bcb9f582db0f93488b48ef7019e348dba --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 7aceaf8bcb9f582db0f93488b48ef7019e348dba --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=7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-09-15 12:07:30,975 truncating revision to first 12 chars 2017-09-15 12:07:30,975 Setting DEBUG logging. 2017-09-15 12:07:30,975 attempt 1/10 2017-09-15 12:07:30,975 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/7aceaf8bcb9f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-09-15 12:07:31,337 unpacking tar archive at: mozilla-central-7aceaf8bcb9f/testing/mozharness/ program finished with exit code 0 elapsedTime=0.657503 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:31.599934) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:31.600232) ========= script_repo_revision: 7aceaf8bcb9f582db0f93488b48ef7019e348dba ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:31.600590) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:31.600921) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-09-15 12:07:31.614878) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2017-09-15 12:07:31.615335) ========= /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=7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:07:31 INFO - MultiFileLogger online at 20170915 12:07:31 in /builds/slave/test 12:07: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 12:07:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:07:31 INFO - {'append_to_log': False, 12:07:31 INFO - 'base_work_dir': '/builds/slave/test', 12:07:31 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 12:07:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:07:31 INFO - 'branch': 'Firefox-Non-PGO', 12:07:31 INFO - 'buildbot_json_path': 'buildprops.json', 12:07:31 INFO - 'code_coverage': False, 12:07:31 INFO - 'config_files': ('talos/linux_config.py',), 12:07:31 INFO - 'default_actions': ('clobber', 12:07:31 INFO - 'read-buildbot-config', 12:07:31 INFO - 'download-and-extract', 12:07:31 INFO - 'populate-webroot', 12:07:31 INFO - 'create-virtualenv', 12:07:31 INFO - 'install', 12:07:31 INFO - 'setup-mitmproxy', 12:07:31 INFO - 'run-tests'), 12:07:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:07:31 INFO - 'disable_ccov_upload': False, 12:07:31 INFO - 'disable_stylo': False, 12:07:31 INFO - 'download_minidump_stackwalk': True, 12:07:31 INFO - 'download_symbols': 'ondemand', 12:07:31 INFO - 'enable_stylo': False, 12:07:31 INFO - 'enable_webrender': False, 12:07:31 INFO - 'exes': {'tooltool.py': '/tools/tooltool.py'}, 12:07:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:07:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:07:31 INFO - 'gecko_profile': False, 12:07:31 INFO - 'gecko_profile_interval': 0, 12:07:31 INFO - 'installer_path': 'installer.exe', 12:07:31 INFO - 'log_level': 'info', 12:07:31 INFO - 'log_name': 'talos', 12:07:31 INFO - 'log_to_console': True, 12:07:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:07:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:07:31 INFO - 'opt_config_files': (), 12:07:31 INFO - 'pip_index': False, 12:07:31 INFO - 'suite': 'dromaeojs-stylo-disabled-e10s', 12:07:31 INFO - 'system_bits': '32', 12:07:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:07:31 INFO - 'title': 'talos-linux64-ix-005', 12:07:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:07:31 INFO - 'use_talos_json': True, 12:07:31 INFO - 'verify': 'False', 12:07:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:07:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:07:31 INFO - 'work_dir': 'build'} 12:07:31 INFO - [mozharness: 2017-09-15 19:07:31.805711Z] Running clobber step. 12:07:31 INFO - Running pre-action listener: _resource_record_pre_action 12:07:31 INFO - Running main action method: clobber 12:07:31 INFO - rmtree: /builds/slave/test/build 12:07:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:07:33 INFO - Running post-action listener: _resource_record_post_action 12:07:33 INFO - [mozharness: 2017-09-15 19:07:33.320885Z] Finished clobber step (success) 12:07:33 INFO - [mozharness: 2017-09-15 19:07:33.320983Z] Running read-buildbot-config step. 12:07:33 INFO - Running pre-action listener: _resource_record_pre_action 12:07:33 INFO - Running main action method: read_buildbot_config 12:07:33 INFO - Using buildbot properties: 12:07:33 INFO - { 12:07:33 INFO - "project": "", 12:07:33 INFO - "product": "firefox", 12:07:33 INFO - "who": "ryanvm@gmail.com", 12:07:33 INFO - "installer_path": "public/build/target.tar.bz2", 12:07:33 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-stylo-disabled-e10s", 12:07:33 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 12:07:33 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-stylo-disabled-e10s", 12:07:33 INFO - "stage_platform": "linux64", 12:07:33 INFO - "basedir": "/builds/slave/test", 12:07:33 INFO - "buildnumber": 24, 12:07:33 INFO - "platform": "ubuntu64_hw", 12:07:33 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 12:07:33 INFO - "slavebuilddir": "test", 12:07:33 INFO - "taskId": "WYnN9Z8kRFusdjXMK0IrZw", 12:07:33 INFO - "branch": "mozilla-central", 12:07:33 INFO - "script_repo_revision": "production", 12:07:33 INFO - "revision": "7aceaf8bcb9f582db0f93488b48ef7019e348dba", 12:07:33 INFO - "slavename": "talos-linux64-ix-005", 12:07:33 INFO - "repo_path": "mozilla-central" 12:07:33 INFO - } 12:07:33 INFO - Finding installer, test and symbols from parent task. 12:07:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WYnN9Z8kRFusdjXMK0IrZw'}, attempt #1 12:07:33 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WYnN9Z8kRFusdjXMK0IrZw'}, attempt #1 12:07:34 INFO - Task dependencies: SAlNeWrsQmaSXz_lbxgWHA 12:07:34 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA'}, attempt #1 12:07:34 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.tar.bz2 12:07:34 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.test_packages.json 12:07:34 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.crashreporter-symbols.zip 12:07:34 INFO - Running post-action listener: _resource_record_post_action 12:07:34 INFO - [mozharness: 2017-09-15 19:07:34.906701Z] Finished read-buildbot-config step (success) 12:07:34 INFO - [mozharness: 2017-09-15 19:07:34.906919Z] Running download-and-extract step. 12:07:34 INFO - Running pre-action listener: _resource_record_pre_action 12:07:34 INFO - Running main action method: download_and_extract 12:07:34 INFO - mkdir: /builds/slave/test/build/tests 12:07: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')]} 12:07:34 INFO - trying https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.test_packages.json 12:07:34 INFO - Downloading https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 12:07:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 12:07:36 INFO - Downloaded 989 bytes. 12:07:36 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 12:07:36 INFO - Using the following test package requirements: 12:07:36 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 12:07:36 INFO - u'common': [u'target.common.tests.zip'], 12:07:36 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 12:07:36 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 12:07:36 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 12:07:36 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 12:07:36 INFO - u'mozbase': [u'target.common.tests.zip'], 12:07:36 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 12:07:36 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 12:07:36 INFO - u'web-platform': [u'target.common.tests.zip', 12:07:36 INFO - u'target.web-platform.tests.tar.gz'], 12:07:36 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 12:07:36 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite categories: ['common', 'talos'] 12:07:36 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.common.tests.zip 12:07:36 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.common.tests.zip'}, attempt #1 12:07:36 INFO - Fetch https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.common.tests.zip into memory 12:07:38 INFO - Content-Length response header: 54734895 12:07:38 INFO - Bytes received: 54734895 12:07:49 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.talos.tests.zip 12:07:49 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.talos.tests.zip'}, attempt #1 12:07:49 INFO - Fetch https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.talos.tests.zip into memory 12:07:50 INFO - Content-Length response header: 14508749 12:07:50 INFO - Bytes received: 14508749 12:07: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')]} 12:07:50 INFO - trying https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.tar.bz2 12:07:50 INFO - Downloading https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 12:07:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 12:07:51 INFO - Downloaded 61597254 bytes. 12:07:51 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.tar.bz2 12:07:51 INFO - mkdir: /builds/slave/test/properties 12:07:51 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:07:51 INFO - Writing to file /builds/slave/test/properties/build_url 12:07:51 INFO - Contents: 12:07:51 INFO - build_url:https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.tar.bz2 12:07:51 INFO - Running post-action listener: _resource_record_post_action 12:07:51 INFO - Running post-action listener: find_tests_for_verification 12:07:51 INFO - Running post-action listener: set_extra_try_arguments 12:07:51 INFO - [mozharness: 2017-09-15 19:07:51.985700Z] Finished download-and-extract step (success) 12:07:51 INFO - [mozharness: 2017-09-15 19:07:51.985932Z] Running populate-webroot step. 12:07:51 INFO - Running pre-action listener: _resource_record_pre_action 12:07:51 INFO - Running main action method: populate_webroot 12:07:52 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:07:52 INFO - 'chromez-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['tresize', 12:07:52 INFO - 'tcanvasmark']}, 12:07:52 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:07:52 INFO - 'dromaeojs-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['dromaeo_css', 12:07:52 INFO - 'kraken']}, 12:07:52 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 12:07:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:07:52 INFO - 'g1-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 12:07:52 INFO - 'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:07:52 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 12:07:52 INFO - 'tests': ['damp', 'tps']}, 12:07:52 INFO - 'g2-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 12:07:52 INFO - 'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['damp', 'tps']}, 12:07:52 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:07:52 INFO - 'g3-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['dromaeo_dom']}, 12:07:52 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 12:07:52 INFO - 'g4-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['basic_compositor_video', 12:07:52 INFO - 'glvideo']}, 12:07:52 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 12:07:52 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 12:07:52 INFO - 'g5-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 12:07:52 INFO - 'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['ts_paint_webext', 12:07:52 INFO - 'tp5o_webext']}, 12:07:52 INFO - 'other-e10s': {'tests': ['a11yr', 12:07:52 INFO - 'ts_paint', 12:07:52 INFO - 'tpaint', 12:07:52 INFO - 'sessionrestore', 12:07:52 INFO - 'sessionrestore_many_windows', 12:07:52 INFO - 'sessionrestore_no_auto_restore', 12:07:52 INFO - 'tabpaint']}, 12:07:52 INFO - 'other-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['a11yr', 12:07:52 INFO - 'ts_paint', 12:07:52 INFO - 'tpaint', 12:07:52 INFO - 'sessionrestore', 12:07:52 INFO - 'sessionrestore_many_windows', 12:07:52 INFO - 'sessionrestore_no_auto_restore', 12:07:52 INFO - 'tabpaint']}, 12:07:52 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 12:07:52 INFO - 'perf-reftest-singletons-e10s': {'tests': ['perf_reftest_singletons']}, 12:07:52 INFO - 'perf-reftest-singletons-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['perf_reftest_singletons']}, 12:07:52 INFO - 'perf-reftest-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['bloom_basic']}, 12:07:52 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:07:52 INFO - 'tsvgr_opacity', 12:07:52 INFO - 'tart', 12:07:52 INFO - 'tscrollx', 12:07:52 INFO - 'tsvg_static']}, 12:07:52 INFO - 'svgr-stylo-disabled-e10s': {'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['tsvgx', 12:07:52 INFO - 'tsvgr_opacity', 12:07:52 INFO - 'tart', 12:07:52 INFO - 'tscrollx', 12:07:52 INFO - 'tsvg_static']}, 12:07:52 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 12:07:52 INFO - 'tp5o-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 12:07:52 INFO - 'talos_options': ['--disable-stylo'], 12:07:52 INFO - 'tests': ['tp5o']}, 12:07:52 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 12:07:52 INFO - 'talos_options': ['--mitmproxy', 12:07:52 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 12:07:52 INFO - '--firstNonBlankPaint'], 12:07:52 INFO - 'tests': ['tp6_google', 12:07:52 INFO - 'tp6_youtube', 12:07:52 INFO - 'tp6_amazon', 12:07:52 INFO - 'tp6_facebook']}, 12:07:52 INFO - 'tp6-stylo-disabled-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 12:07:52 INFO - 'talos_options': ['--disable-stylo', 12:07:52 INFO - '--mitmproxy', 12:07:52 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 12:07:52 INFO - '--firstNonBlankPaint'], 12:07:52 INFO - 'tests': ['tp6_google', 12:07:52 INFO - 'tp6_youtube', 12:07:52 INFO - 'tp6_amazon', 12:07:52 INFO - 'tp6_facebook']}, 12:07:52 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 12:07:52 INFO - 'talos_options': ['--stylo-threads=1', 12:07:52 INFO - '--mitmproxy', 12:07:52 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 12:07:52 INFO - '--firstNonBlankPaint'], 12:07:52 INFO - 'tests': ['tp6_google', 12:07:52 INFO - 'tp6_youtube', 12:07:52 INFO - 'tp6_amazon', 12:07:52 INFO - 'tp6_facebook']}, 12:07:52 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 12:07:52 INFO - 'talos_options': ['--xperf_path', 12:07:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:07:52 INFO - 'tests': ['tp5n']}, 12:07:52 INFO - 'xperf-stylo-disabled-e10s': {'pagesets_name': 'tp5n.zip', 12:07:52 INFO - 'talos_options': ['--disable-stylo', 12:07:52 INFO - '--xperf_path', 12:07:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:07:52 INFO - 'tests': ['tp5n']}}} 12:07:52 INFO - Running post-action listener: _resource_record_post_action 12:07:52 INFO - [mozharness: 2017-09-15 19:07:52.009560Z] Finished populate-webroot step (success) 12:07:52 INFO - [mozharness: 2017-09-15 19:07:52.009651Z] Running create-virtualenv step. 12:07:52 INFO - Running pre-action listener: _resource_record_pre_action 12:07:52 INFO - Running main action method: create_virtualenv 12:07:52 INFO - Creating virtualenv /builds/slave/test/build/venv 12:07:52 INFO - Running command: ['virtualenv', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 12:07:52 INFO - Copy/paste: virtualenv --no-site-packages --distribute /builds/slave/test/build/venv 12:07:52 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 12:07:52 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:07:52 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:07:52 INFO - Installing distribute.............................................................................................................................................................................................done. 12:07:52 INFO - Installing pip...............done. 12:07:52 INFO - Return code: 0 12:07:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 12:07:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 12:07:52 INFO - Reading from file tmpfile_stdout 12:07:52 INFO - Output received: 12:07:52 INFO - pip 1.1 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.1-py2.7.egg (python 2.7) 12:07:52 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:07:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:07:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:07:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 12:07:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:07:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfd01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1199a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x133ca60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, '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': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', '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 12:07:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 12:07:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 12:07:53 INFO - Using env: {'DISPLAY': ':0', 12:07:53 INFO - 'HOME': '/home/cltbld', 12:07:53 INFO - 'LANG': 'en_US.UTF-8', 12:07:53 INFO - 'LANGUAGE': 'en_US:en', 12:07:53 INFO - 'LOGNAME': 'cltbld', 12:07:53 INFO - 'MAIL': '/var/mail/cltbld', 12:07:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:07:53 INFO - 'MOZ_NO_REMOTE': '1', 12:07:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:07:53 INFO - 'NO_EM_RESTART': '1', 12:07:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:07:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:07:53 INFO - 'PWD': '/builds/slave/test', 12:07:53 INFO - 'SHELL': '/bin/bash', 12:07:53 INFO - 'SHLVL': '1', 12:07:53 INFO - 'TERM': 'linux', 12:07:53 INFO - 'TMOUT': '86400', 12:07:53 INFO - 'USER': 'cltbld', 12:07:53 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:07:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:07:53 INFO - '_': '/tools/buildbot/bin/python'} 12:07:54 INFO - Ignoring indexes: http://pypi.python.org/simple/ 12:07:54 INFO - Downloading/unpacking pip>=1.5 12:07:54 INFO - Running setup.py egg_info for package pip 12:07:54 INFO - warning: no files found matching 'pip/cacert.pem' 12:07:54 INFO - warning: no files found matching '*.html' under directory 'docs' 12:07:54 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 12:07:54 INFO - no previously-included directories found matching 'docs/_build/_sources' 12:07:54 INFO - Installing collected packages: pip 12:07:54 INFO - Found existing installation: pip 1.1 12:07:54 INFO - Uninstalling pip: 12:07:54 INFO - Successfully uninstalled pip 12:07:54 INFO - Running setup.py install for pip 12:07:54 INFO - warning: no files found matching 'pip/cacert.pem' 12:07:54 INFO - warning: no files found matching '*.html' under directory 'docs' 12:07:54 INFO - warning: no previously-included files matching '*.rst' found under directory 'docs/_build' 12:07:54 INFO - no previously-included directories found matching 'docs/_build/_sources' 12:07:54 INFO - Installing pip script to /builds/slave/test/build/venv/bin 12:07:54 INFO - Installing pip2.7 script to /builds/slave/test/build/venv/bin 12:07:54 INFO - Installing pip2 script to /builds/slave/test/build/venv/bin 12:07:54 INFO - Successfully installed pip 12:07:54 INFO - Cleaning up... 12:07:54 INFO - Return code: 0 12:07:54 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 12:07: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')]} 12:07:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:07: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')]} 12:07:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:07: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', '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 0xfd01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1199a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x133ca60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, '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': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', '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 12:07: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', 'psutil>=3.1.1'] in /builds/slave/test/build 12:07: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 psutil>=3.1.1 12:07:54 INFO - Using env: {'DISPLAY': ':0', 12:07:54 INFO - 'HOME': '/home/cltbld', 12:07:54 INFO - 'LANG': 'en_US.UTF-8', 12:07:54 INFO - 'LANGUAGE': 'en_US:en', 12:07:54 INFO - 'LOGNAME': 'cltbld', 12:07:54 INFO - 'MAIL': '/var/mail/cltbld', 12:07:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:07:54 INFO - 'MOZ_NO_REMOTE': '1', 12:07:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:07:54 INFO - 'NO_EM_RESTART': '1', 12:07:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:07:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:07:54 INFO - 'PWD': '/builds/slave/test', 12:07:54 INFO - 'SHELL': '/bin/bash', 12:07:54 INFO - 'SHLVL': '1', 12:07:54 INFO - 'TERM': 'linux', 12:07:54 INFO - 'TMOUT': '86400', 12:07:54 INFO - 'USER': 'cltbld', 12:07:54 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:07:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:07:54 INFO - '_': '/tools/buildbot/bin/python'} 12:07:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:07:54 INFO - Downloading/unpacking psutil>=3.1.1 12:07: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 12:07: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 12:07: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 12:07: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 12:07:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:07:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:07:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:07:55 INFO - Installing collected packages: psutil 12:07:55 INFO - Running setup.py install for psutil 12:07:55 INFO - building 'psutil._psutil_linux' extension 12:07:55 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 12:07:55 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 12:07:55 INFO - building 'psutil._psutil_posix' extension 12:07:55 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 12:07:56 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 12:07:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:07:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:07:56 INFO - Successfully installed psutil 12:07:56 INFO - Cleaning up... 12:07:56 INFO - Return code: 0 12:07:56 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 12:07:56 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')]} 12:07:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:07:56 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')]} 12:07:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:07:56 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 0xfd01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1199a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x133ca60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, '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': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', '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 12:07:56 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 12:07:56 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 12:07:56 INFO - Using env: {'DISPLAY': ':0', 12:07:56 INFO - 'HOME': '/home/cltbld', 12:07:56 INFO - 'LANG': 'en_US.UTF-8', 12:07:56 INFO - 'LANGUAGE': 'en_US:en', 12:07:56 INFO - 'LOGNAME': 'cltbld', 12:07:56 INFO - 'MAIL': '/var/mail/cltbld', 12:07:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:07:56 INFO - 'MOZ_NO_REMOTE': '1', 12:07:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:07:56 INFO - 'NO_EM_RESTART': '1', 12:07:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:07:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:07:56 INFO - 'PWD': '/builds/slave/test', 12:07:56 INFO - 'SHELL': '/bin/bash', 12:07:56 INFO - 'SHLVL': '1', 12:07:56 INFO - 'TERM': 'linux', 12:07:56 INFO - 'TMOUT': '86400', 12:07:56 INFO - 'USER': 'cltbld', 12:07:56 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:07:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:07:56 INFO - '_': '/tools/buildbot/bin/python'} 12:07:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:07:56 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:07:56 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 12:07:56 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 12:07:56 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 12:07:56 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 12:07:57 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:07:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:07:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 12:07:57 INFO - Installing collected packages: mozsystemmonitor 12:07:57 INFO - Running setup.py install for mozsystemmonitor 12:07:57 INFO - Successfully installed mozsystemmonitor 12:07:57 INFO - Cleaning up... 12:07:58 INFO - Return code: 0 12:07:58 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 12:07:58 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')]} 12:07:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:07:58 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')]} 12:07:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:07:58 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 0xfd01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1199a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x133ca60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, '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': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', '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 12:07:58 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 12:07:58 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 12:07:58 INFO - Using env: {'DISPLAY': ':0', 12:07:58 INFO - 'HOME': '/home/cltbld', 12:07:58 INFO - 'LANG': 'en_US.UTF-8', 12:07:58 INFO - 'LANGUAGE': 'en_US:en', 12:07:58 INFO - 'LOGNAME': 'cltbld', 12:07:58 INFO - 'MAIL': '/var/mail/cltbld', 12:07:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:07:58 INFO - 'MOZ_NO_REMOTE': '1', 12:07:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:07:58 INFO - 'NO_EM_RESTART': '1', 12:07:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:07:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:07:58 INFO - 'PWD': '/builds/slave/test', 12:07:58 INFO - 'SHELL': '/bin/bash', 12:07:58 INFO - 'SHLVL': '1', 12:07:58 INFO - 'TERM': 'linux', 12:07:58 INFO - 'TMOUT': '86400', 12:07:58 INFO - 'USER': 'cltbld', 12:07:58 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:07:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:07:58 INFO - '_': '/tools/buildbot/bin/python'} 12:07:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:07:58 INFO - Downloading/unpacking jsonschema==2.5.1 12:07: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 12:07: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 12:07: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 12:07: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 12:07:59 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:07:59 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:07:59 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 12:07:59 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 12:07:59 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 12:07:59 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 12:07:59 INFO - Downloading functools32-3.2.3-2.tar.gz 12:07:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:07:59 INFO - warning: no files found matching '*.txt' 12:07:59 INFO - no previously-included directories found matching 'build' 12:07:59 INFO - no previously-included directories found matching 'dist' 12:07:59 INFO - no previously-included directories found matching '.git*' 12:07:59 INFO - Installing collected packages: jsonschema, functools32 12:08:00 INFO - Running setup.py install for functools32 12:08:00 INFO - warning: no files found matching '*.txt' 12:08:00 INFO - no previously-included directories found matching 'build' 12:08:00 INFO - no previously-included directories found matching 'dist' 12:08:00 INFO - no previously-included directories found matching '.git*' 12:08:00 INFO - Successfully installed jsonschema functools32 12:08:00 INFO - Cleaning up... 12:08:00 INFO - Return code: 0 12:08:00 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 12:08: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')]} 12:08:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08: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')]} 12:08:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08: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', '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 0xfd01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1199a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x133ca60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, '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': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', '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 12:08: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', 'functools32==3.2.3-2'] in /builds/slave/test/build 12:08: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 functools32==3.2.3-2 12:08:00 INFO - Using env: {'DISPLAY': ':0', 12:08:00 INFO - 'HOME': '/home/cltbld', 12:08:00 INFO - 'LANG': 'en_US.UTF-8', 12:08:00 INFO - 'LANGUAGE': 'en_US:en', 12:08:00 INFO - 'LOGNAME': 'cltbld', 12:08:00 INFO - 'MAIL': '/var/mail/cltbld', 12:08:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:00 INFO - 'MOZ_NO_REMOTE': '1', 12:08:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:08:00 INFO - 'NO_EM_RESTART': '1', 12:08:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:08:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:08:00 INFO - 'PWD': '/builds/slave/test', 12:08:00 INFO - 'SHELL': '/bin/bash', 12:08:00 INFO - 'SHLVL': '1', 12:08:00 INFO - 'TERM': 'linux', 12:08:00 INFO - 'TMOUT': '86400', 12:08:00 INFO - 'USER': 'cltbld', 12:08:00 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:08:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:08:00 INFO - '_': '/tools/buildbot/bin/python'} 12:08:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:00 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 12:08:00 INFO - Cleaning up... 12:08:00 INFO - Return code: 0 12:08:00 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:08: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')]} 12:08:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08: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')]} 12:08:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08: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 0xfd01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1199a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x133ca60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, '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': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', '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 12:08: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 12:08: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 12:08:00 INFO - Using env: {'DISPLAY': ':0', 12:08:00 INFO - 'HOME': '/home/cltbld', 12:08:00 INFO - 'LANG': 'en_US.UTF-8', 12:08:00 INFO - 'LANGUAGE': 'en_US:en', 12:08:00 INFO - 'LOGNAME': 'cltbld', 12:08:00 INFO - 'MAIL': '/var/mail/cltbld', 12:08:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:00 INFO - 'MOZ_NO_REMOTE': '1', 12:08:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:08:00 INFO - 'NO_EM_RESTART': '1', 12:08:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:08:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:08:00 INFO - 'PWD': '/builds/slave/test', 12:08:00 INFO - 'SHELL': '/bin/bash', 12:08:00 INFO - 'SHLVL': '1', 12:08:00 INFO - 'TERM': 'linux', 12:08:00 INFO - 'TMOUT': '86400', 12:08:00 INFO - 'USER': 'cltbld', 12:08:00 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:08:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:08:00 INFO - '_': '/tools/buildbot/bin/python'} 12:08:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:00 INFO - Downloading/unpacking blobuploader==1.2.4 12:08: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 12:08: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 12:08: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 12:08: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 12:08:01 INFO - Downloading blobuploader-1.2.4.tar.gz 12:08:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:08:01 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:08:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:08:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:08:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:08:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:08:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:08:02 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:08: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 12:08: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 12:08: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 12:08: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 12:08:02 INFO - Downloading docopt-0.6.1.tar.gz 12:08:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:08:02 INFO - Installing collected packages: blobuploader, requests, docopt 12:08:02 INFO - Running setup.py install for blobuploader 12:08:02 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:08:02 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:08:02 INFO - Running setup.py install for requests 12:08:02 INFO - Running setup.py install for docopt 12:08:02 INFO - Successfully installed blobuploader requests docopt 12:08:02 INFO - Cleaning up... 12:08:02 INFO - Return code: 0 12:08:02 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:08:02 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')]} 12:08:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08:02 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')]} 12:08:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08:02 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 0xfd01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1199a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x133ca60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, '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': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', '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 12:08:02 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 12:08:02 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 12:08:02 INFO - Using env: {'DISPLAY': ':0', 12:08:02 INFO - 'HOME': '/home/cltbld', 12:08:02 INFO - 'LANG': 'en_US.UTF-8', 12:08:02 INFO - 'LANGUAGE': 'en_US:en', 12:08:02 INFO - 'LOGNAME': 'cltbld', 12:08:02 INFO - 'MAIL': '/var/mail/cltbld', 12:08:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:02 INFO - 'MOZ_NO_REMOTE': '1', 12:08:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:08:02 INFO - 'NO_EM_RESTART': '1', 12:08:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:08:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:08:03 INFO - 'PWD': '/builds/slave/test', 12:08:03 INFO - 'SHELL': '/bin/bash', 12:08:03 INFO - 'SHLVL': '1', 12:08:03 INFO - 'TERM': 'linux', 12:08:03 INFO - 'TMOUT': '86400', 12:08:03 INFO - 'USER': 'cltbld', 12:08:03 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:08:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:08:03 INFO - '_': '/tools/buildbot/bin/python'} 12:08:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:08:03 INFO - Running setup.py (path:/tmp/pip-PXJtic-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:08:03 INFO - Running setup.py (path:/tmp/pip-5kyqUs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:08:03 INFO - Running setup.py (path:/tmp/pip-mtOUZV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:08:03 INFO - Running setup.py (path:/tmp/pip-j9p1G8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:08:03 INFO - Running setup.py (path:/tmp/pip-GH2woW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:08:03 INFO - Running setup.py (path:/tmp/pip-KK_KcU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:08:03 INFO - Running setup.py (path:/tmp/pip-eajzfv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:08:03 INFO - Running setup.py (path:/tmp/pip-FHrieG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:08:03 INFO - Running setup.py (path:/tmp/pip-O9DA9y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:08:03 INFO - Running setup.py (path:/tmp/pip-l9OD8y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:08:03 INFO - Running setup.py (path:/tmp/pip-UWhco4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:08:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:08:03 INFO - Running setup.py (path:/tmp/pip-RiJmHl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:08:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:08:04 INFO - Running setup.py (path:/tmp/pip-C1Ct8i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:08:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:08:04 INFO - Running setup.py (path:/tmp/pip-VZ7jmy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:08:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:08:04 INFO - Running setup.py (path:/tmp/pip-2uiSKz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:08:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:08:04 INFO - Running setup.py (path:/tmp/pip-xRIxcE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:08:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:08:04 INFO - Running setup.py (path:/tmp/pip-My9IHu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:08:04 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:08:04 INFO - Running setup.py install for manifestparser 12:08:04 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:08:04 INFO - Running setup.py install for mozcrash 12:08:04 INFO - Running setup.py install for mozdebug 12:08:04 INFO - Running setup.py install for mozdevice 12:08:04 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:08:04 INFO - Running setup.py install for mozfile 12:08:04 INFO - Running setup.py install for mozhttpd 12:08:05 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Running setup.py install for mozinfo 12:08:05 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Running setup.py install for mozInstall 12:08:05 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Running setup.py install for mozleak 12:08:05 INFO - Running setup.py install for mozlog 12:08:05 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Running setup.py install for moznetwork 12:08:05 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Running setup.py install for mozprocess 12:08:05 INFO - Running setup.py install for mozprofile 12:08:05 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Running setup.py install for mozrunner 12:08:05 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:08:05 INFO - Running setup.py install for mozscreenshot 12:08:05 INFO - Running setup.py install for moztest 12:08:06 INFO - Running setup.py install for mozversion 12:08:06 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:08:06 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:08:06 INFO - Cleaning up... 12:08:06 INFO - Return code: 0 12:08:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:08: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')]} 12:08:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08: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')]} 12:08:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08: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 0xfd01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1199a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x133ca60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, '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': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', '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 12:08: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 12:08: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 12:08:06 INFO - Using env: {'DISPLAY': ':0', 12:08:06 INFO - 'HOME': '/home/cltbld', 12:08:06 INFO - 'LANG': 'en_US.UTF-8', 12:08:06 INFO - 'LANGUAGE': 'en_US:en', 12:08:06 INFO - 'LOGNAME': 'cltbld', 12:08:06 INFO - 'MAIL': '/var/mail/cltbld', 12:08:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:06 INFO - 'MOZ_NO_REMOTE': '1', 12:08:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:08:06 INFO - 'NO_EM_RESTART': '1', 12:08:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:08:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:08:06 INFO - 'PWD': '/builds/slave/test', 12:08:06 INFO - 'SHELL': '/bin/bash', 12:08:06 INFO - 'SHLVL': '1', 12:08:06 INFO - 'TERM': 'linux', 12:08:06 INFO - 'TMOUT': '86400', 12:08:06 INFO - 'USER': 'cltbld', 12:08:06 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:08:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:08:06 INFO - '_': '/tools/buildbot/bin/python'} 12:08:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:08:06 INFO - Running setup.py (path:/tmp/pip-e_nJFg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:08: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)) 12:08:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:08:06 INFO - Running setup.py (path:/tmp/pip-IugkdU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:08: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)) 12:08:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:08:06 INFO - Running setup.py (path:/tmp/pip-p7hsSK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:08: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)) 12:08:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:08:06 INFO - Running setup.py (path:/tmp/pip-nk9g7w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:08: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)) 12:08:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:08:06 INFO - Running setup.py (path:/tmp/pip-zKKkCf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:08: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)) 12:08:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:08:06 INFO - Running setup.py (path:/tmp/pip-zsvGZM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:08: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)) 12:08:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:08:06 INFO - Running setup.py (path:/tmp/pip-SPEQL8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:08:06 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)) 12:08:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:08:06 INFO - Running setup.py (path:/tmp/pip-I02eNk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:08:06 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)) 12:08:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:08:06 INFO - Running setup.py (path:/tmp/pip-h_FIVR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:08: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)) 12:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:08:07 INFO - Running setup.py (path:/tmp/pip-mcxTV7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:08: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)) 12:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:08:07 INFO - Running setup.py (path:/tmp/pip-qggcbf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:08: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)) 12:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:08:07 INFO - Running setup.py (path:/tmp/pip-vMpUTF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:08: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)) 12:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:08:07 INFO - Running setup.py (path:/tmp/pip-VPp4ud-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:08: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)) 12:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:08:07 INFO - Running setup.py (path:/tmp/pip-lVpJaT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:08: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)) 12:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:08:07 INFO - Running setup.py (path:/tmp/pip-ej6DV8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:08: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)) 12:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:08:07 INFO - Running setup.py (path:/tmp/pip-zCy9iu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:08: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)) 12:08:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:08:07 INFO - Running setup.py (path:/tmp/pip-lW6YEj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:08: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)) 12:08: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)) 12:08: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)) 12:08: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)) 12:08: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)) 12:08: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)) 12:08: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)) 12:08:07 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:08: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 12:08: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 12:08: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 12:08: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 12:08:08 INFO - Downloading blessings-1.6.tar.gz 12:08:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:08:08 INFO - Installing collected packages: blessings 12:08:08 INFO - Running setup.py install for blessings 12:08:08 INFO - Successfully installed blessings 12:08:08 INFO - Cleaning up... 12:08:08 INFO - Return code: 0 12:08:08 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:08:08 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:08:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:08:09 INFO - Reading from file tmpfile_stdout 12:08:09 INFO - Current package versions: 12:08:09 INFO - argparse == 1.2.1 12:08:09 INFO - blessings == 1.6 12:08:09 INFO - blobuploader == 1.2.4 12:08:09 INFO - docopt == 0.6.1 12:08:09 INFO - functools32 == 3.2.3-2 12:08:09 INFO - jsonschema == 2.5.1 12:08:09 INFO - manifestparser == 1.1 12:08:09 INFO - mozInstall == 1.13 12:08:09 INFO - mozcrash == 1.0 12:08:09 INFO - mozdebug == 0.1 12:08:09 INFO - mozdevice == 0.51 12:08:09 INFO - mozfile == 1.2 12:08:09 INFO - mozhttpd == 0.7 12:08:09 INFO - mozinfo == 0.10 12:08:09 INFO - mozleak == 0.1 12:08:09 INFO - mozlog == 3.5 12:08:09 INFO - moznetwork == 0.27 12:08:09 INFO - mozprocess == 0.25 12:08:09 INFO - mozprofile == 0.28 12:08:09 INFO - mozrunner == 6.13 12:08:09 INFO - mozscreenshot == 0.1 12:08:09 INFO - mozsystemmonitor == 0.3 12:08:09 INFO - moztest == 0.8 12:08:09 INFO - mozversion == 1.4 12:08:09 INFO - psutil == 3.1.1 12:08:09 INFO - requests == 1.2.3 12:08:09 INFO - wsgiref == 0.1.2 12:08:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:08: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')]} 12:08:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08: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')]} 12:08:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08: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 0xfd01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1199a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x133ca60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, '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': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', '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 12:08: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 12:08: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 12:08:09 INFO - Using env: {'DISPLAY': ':0', 12:08:09 INFO - 'HOME': '/home/cltbld', 12:08:09 INFO - 'LANG': 'en_US.UTF-8', 12:08:09 INFO - 'LANGUAGE': 'en_US:en', 12:08:09 INFO - 'LOGNAME': 'cltbld', 12:08:09 INFO - 'MAIL': '/var/mail/cltbld', 12:08:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:09 INFO - 'MOZ_NO_REMOTE': '1', 12:08:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:08:09 INFO - 'NO_EM_RESTART': '1', 12:08:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:08:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:08:09 INFO - 'PWD': '/builds/slave/test', 12:08:09 INFO - 'SHELL': '/bin/bash', 12:08:09 INFO - 'SHLVL': '1', 12:08:09 INFO - 'TERM': 'linux', 12:08:09 INFO - 'TMOUT': '86400', 12:08:09 INFO - 'USER': 'cltbld', 12:08:09 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:08:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:08:09 INFO - '_': '/tools/buildbot/bin/python'} 12:08:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08: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)) 12:08: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)) 12:08: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)) 12:08: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)) 12:08: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)) 12:08: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)) 12:08: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)) 12:08: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)) 12:08: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)) 12:08:09 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 12:08: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 12:08: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 12:08: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 12:08: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 12:08:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 12:08: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)) 12:08: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)) 12:08:10 INFO - Installing collected packages: simplejson 12:08:10 INFO - Running setup.py install for simplejson 12:08:10 INFO - building 'simplejson._speedups' extension 12:08: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 12:08: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 12:08:11 INFO - Successfully installed simplejson 12:08:11 INFO - Cleaning up... 12:08:11 INFO - Return code: 0 12:08:11 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:08: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')]} 12:08:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:08: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')]} 12:08:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:08: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 0xfd01f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1199a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x133ca60>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, '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': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', '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 12:08: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 12:08: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 12:08:11 INFO - Using env: {'DISPLAY': ':0', 12:08:11 INFO - 'HOME': '/home/cltbld', 12:08:11 INFO - 'LANG': 'en_US.UTF-8', 12:08:11 INFO - 'LANGUAGE': 'en_US:en', 12:08:11 INFO - 'LOGNAME': 'cltbld', 12:08:11 INFO - 'MAIL': '/var/mail/cltbld', 12:08:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:11 INFO - 'MOZ_NO_REMOTE': '1', 12:08:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:08:11 INFO - 'NO_EM_RESTART': '1', 12:08:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:08:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:08:11 INFO - 'PWD': '/builds/slave/test', 12:08:11 INFO - 'SHELL': '/bin/bash', 12:08:11 INFO - 'SHLVL': '1', 12:08:11 INFO - 'TERM': 'linux', 12:08:11 INFO - 'TMOUT': '86400', 12:08:11 INFO - 'USER': 'cltbld', 12:08:11 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:08:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:08:11 INFO - '_': '/tools/buildbot/bin/python'} 12:08:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:08:11 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 12:08:11 INFO - Cleaning up... 12:08:11 INFO - Return code: 0 12:08:11 INFO - Running post-action listener: _resource_record_post_action 12:08:11 INFO - Running post-action listener: _start_resource_monitoring 12:08:11 INFO - Starting resource monitoring. 12:08:11 INFO - [mozharness: 2017-09-15 19:08:11.912284Z] Finished create-virtualenv step (success) 12:08:11 INFO - [mozharness: 2017-09-15 19:08:11.912800Z] Running install step. 12:08:11 INFO - Running pre-action listener: _resource_record_pre_action 12:08:11 INFO - Running main action method: install 12:08:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:08:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:08:12 INFO - Reading from file tmpfile_stdout 12:08:12 INFO - Detecting whether we're running mozinstall >=1.0... 12:08:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:08:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:08:12 INFO - Reading from file tmpfile_stdout 12:08:12 INFO - Output received: 12:08:12 INFO - Usage: mozinstall [options] installer 12:08:12 INFO - Options: 12:08:12 INFO - -h, --help show this help message and exit 12:08:12 INFO - -d DEST, --destination=DEST 12:08:12 INFO - Directory to install application into. [default: 12:08:12 INFO - "/builds/slave/test"] 12:08:12 INFO - --app=APP Application being installed. [default: firefox] 12:08:12 INFO - mkdir: /builds/slave/test/build/application 12:08: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'] 12:08:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 12:08:29 INFO - Reading from file tmpfile_stdout 12:08:29 INFO - Output received: 12:08:29 INFO - /builds/slave/test/build/application/firefox/firefox 12:08:29 INFO - Running post-action listener: _resource_record_post_action 12:08:29 INFO - [mozharness: 2017-09-15 19:08:29.998041Z] Finished install step (success) 12:08:29 INFO - [mozharness: 2017-09-15 19:08:29.998293Z] Running setup-mitmproxy step. 12:08:29 INFO - Running pre-action listener: _resource_record_pre_action 12:08:29 INFO - Running main action method: setup_mitmproxy 12:08:29 INFO - Skipping: mitmproxy is not required 12:08:29 INFO - Running post-action listener: _resource_record_post_action 12:08:29 INFO - [mozharness: 2017-09-15 19:08:29.999521Z] Finished setup-mitmproxy step (success) 12:08:29 INFO - [mozharness: 2017-09-15 19:08:29.999744Z] Running run-tests step. 12:08:29 INFO - Running pre-action listener: _resource_record_pre_action 12:08:30 INFO - Running pre-action listener: _set_gcov_prefix 12:08:30 INFO - Running main action method: run_tests 12:08:30 WARNING - Try message not found. 12:08:30 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:08:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:08:30 INFO - Python 2.7.3 12:08:30 INFO - Return code: 0 12:08:30 INFO - grabbing minidump binary from tooltool 12:08: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')]} 12:08: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 0x1340090>, '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 0x1340d80>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x133af90>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:08: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 12:08: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 12:08: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 12:08:30 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:08:30 INFO - Return code: 0 12:08:30 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:08:30 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:08:30 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:08:30 INFO - ENV: RUST_BACKTRACE is now full 12:08:30 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:08:30 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:08: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/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-005', '--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 12:08: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/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-005 --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 12:08:30 INFO - Using env: {'DISPLAY': ':0', 12:08:30 INFO - 'HOME': '/home/cltbld', 12:08:30 INFO - 'LANG': 'en_US.UTF-8', 12:08:30 INFO - 'LANGUAGE': 'en_US:en', 12:08:30 INFO - 'LOGNAME': 'cltbld', 12:08:30 INFO - 'MAIL': '/var/mail/cltbld', 12:08:30 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:08:30 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:08:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:30 INFO - 'MOZ_NO_REMOTE': '1', 12:08:30 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:08:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:08:30 INFO - 'NO_EM_RESTART': '1', 12:08:30 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:08:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:08:30 INFO - 'PWD': '/builds/slave/test', 12:08:30 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:08:30 INFO - 'RUST_BACKTRACE': 'full', 12:08:30 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 12:08:30 INFO - 'SHELL': '/bin/bash', 12:08:30 INFO - 'SHLVL': '1', 12:08:30 INFO - 'TERM': 'linux', 12:08:30 INFO - 'TMOUT': '86400', 12:08:30 INFO - 'USER': 'cltbld', 12:08:30 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:08:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:08:30 INFO - '_': '/tools/buildbot/bin/python'} 12:08: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/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-005', '--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 12:08:30 INFO - mozversion application_buildid: 20170915182012 12:08:30 INFO - mozversion application_changeset: 7aceaf8bcb9f582db0f93488b48ef7019e348dba 12:08:30 INFO - mozversion application_display_name: Nightly 12:08:30 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:08:30 INFO - mozversion application_name: Firefox 12:08:30 INFO - mozversion application_remotingname: firefox 12:08:30 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 12:08:30 INFO - mozversion application_vendor: Mozilla 12:08:30 INFO - mozversion application_version: 57.0a1 12:08:30 INFO - mozversion platform_buildid: 20170915182012 12:08:30 INFO - mozversion platform_changeset: 7aceaf8bcb9f582db0f93488b48ef7019e348dba 12:08:30 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 12:08:30 INFO - mozversion platform_version: 57.0a1 12:08:30 INFO - using testdate: 1505502510 12:08:30 INFO - actual date: 1505502510 12:08:30 INFO - starting webserver on 'localhost:54253' 12:08:30 INFO - SUITE-START | Running 2 tests 12:08:30 INFO - TEST-START | dromaeo_css 12:08:30 INFO - Initialising browser for dromaeo_css test... 12:08:30 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:54253/getInfo.html -profile /tmp/tmpxBEocg/profile 12:08:30 INFO - TEST-INFO | started process 7165 (/builds/slave/test/build/application/firefox/firefox http://localhost:54253/getInfo.html) 12:08:35 INFO - TEST-INFO | 7165: exit 0 12:08:35 INFO - Browser initialized. 12:08:35 INFO - Running cycle 1/1 for dromaeo_css test... 12:08:35 INFO - Using env: {'DISPLAY': ':0', 12:08:35 INFO - 'HOME': '/home/cltbld', 12:08:35 INFO - 'JSGC_DISABLE_POISONING': '1', 12:08:35 INFO - 'LANG': 'en_US.UTF-8', 12:08:35 INFO - 'LANGUAGE': 'en_US:en', 12:08:35 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 12:08:35 INFO - 'LOGNAME': 'cltbld', 12:08:35 INFO - 'MAIL': '/var/mail/cltbld', 12:08:35 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:08:35 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:08:35 INFO - 'MOZ_CRASHREPORTER': '1', 12:08:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:08:35 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 12:08:35 INFO - 'MOZ_NO_REMOTE': '1', 12:08:35 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:08:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:08:35 INFO - 'NO_EM_RESTART': '1', 12:08:35 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:08:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:08:35 INFO - 'PWD': '/builds/slave/test', 12:08:35 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:08:35 INFO - 'RUST_BACKTRACE': 'full', 12:08:35 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 12:08:35 INFO - 'SHELL': '/bin/bash', 12:08:35 INFO - 'SHLVL': '1', 12:08:35 INFO - 'STYLO_FORCE_DISABLED': '1', 12:08:35 INFO - 'TERM': 'linux', 12:08:35 INFO - 'TMOUT': '86400', 12:08:35 INFO - 'USER': 'cltbld', 12:08:35 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:08:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:08:35 INFO - '_': '/tools/buildbot/bin/python'} 12:08:35 INFO - TEST-INFO | started process 7394 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpxBEocg/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 12:08:36 INFO - PID 7394 | 12:08:36 INFO - PID 7394 | (/builds/slave/test/build/application/firefox/firefox:7442): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 12:08:36 INFO - PID 7394 | 12:08:47 INFO - PID 7394 | RSS: Main: 174026752 12:08:47 INFO - PID 7394 | 12:11:45 INFO - PID 7394 | Cycle 1(1): loaded http://localhost:54253/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54253/tests/dromaeo/cssquery-ext.html) 12:11:46 INFO - PID 7394 | RSS: Main: 176300032 12:11:46 INFO - PID 7394 | 12:14:47 INFO - PID 7394 | Cycle 1(1): loaded http://localhost:54253/tests/dromaeo/cssquery-ext.html (next: http://localhost:54253/tests/dromaeo/cssquery-jquery.html) 12:14:48 INFO - PID 7394 | RSS: Main: 172261376 12:14:48 INFO - PID 7394 | 12:17:50 INFO - PID 7394 | Cycle 1(1): loaded http://localhost:54253/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54253/tests/dromaeo/cssquery-mootools.html) 12:17:50 INFO - PID 7394 | RSS: Main: 175030272 12:17:50 INFO - PID 7394 | 12:20:52 INFO - PID 7394 | Cycle 1(1): loaded http://localhost:54253/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54253/tests/dromaeo/cssquery-prototype.html) 12:20:52 INFO - PID 7394 | RSS: Main: 173301760 12:20:52 INFO - PID 7394 | 12:23:56 INFO - PID 7394 | Cycle 1(1): loaded http://localhost:54253/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54253/tests/dromaeo/cssquery-yui.html) 12:23:56 INFO - PID 7394 | RSS: Main: 175300608 12:23:56 INFO - PID 7394 | 12:26:58 INFO - PID 7394 | Cycle 1(1): loaded http://localhost:54253/tests/dromaeo/cssquery-yui.html (next: http://localhost:54253/tests/dromaeo/cssquery-dojo.html) 12:26:58 INFO - PID 7394 | RSS: Main: 177868800 12:26:58 INFO - PID 7394 | 12:26:58 INFO - PID 7394 | __start_tp_report 12:26:58 INFO - PID 7394 | _x_x_mozilla_page_load 12:26:58 INFO - PID 7394 | _x_x_mozilla_page_load_details 12:26:58 INFO - PID 7394 | |i|pagename|runs| 12:26:58 INFO - PID 7394 | |0;dojo.html;3124.1877111950894;3155.463571192897;3163.825989570574;3170.080676603785;3179.761517886156;6025.367336429677;6248.84377890553;6269.996800511919;6312.905306420402;6351.682415879205;6131.47882429994;6134.509239260859;6193.349698281671;6195.597286176396;6260.467860231885;5758.078707406816;5813.6802475863815;5825.592208545393;5853.970730146343;5899.793507227248;1206.8918911613168;5706.201131841545;5813.360530341659;5901.380355062721;5942.554308426864;5686.658800471964;5718.142278658234;5759.395263497315;5838;5854.385289544579;5743.310802703702;5754.913676294859;5822.796202132905;5828.5337173026055;5837.124431335291;5724.542036637101;5735.856603584902;5800.564957628195;5801.477866991991;5803.593748437611;6150.630962142286;6210.627362358273;6296.118543403882;6306.463950564207;6341.143945567382;6489;6595.70319335631;6626.304238054983;6676.332366763285;6755.121834161577;6763.7632682855865;6797.116374871235;6797.932020679779;6801.455883529356;6822.727090916357;6205.255369355661;6232.407921247474;6314.526410519184;6319.5576309658345;6324.241091069055;6916.066331045345;6922.723091076301;6993.300669932966;6997.195322537871;7005.054317667152;6445.291017988017;6520.152380190545;6546.18172728409;6557.114789503451;6662.766803161963;6619.106420633249;6626.105475760807;6645.06969024337;6646.302138275508;6649.135612370361;6580.703868325937;6606.471482281406;6718.160229971254;6736.46108311334;6737.393634572912;6672.966635166793;6691.130153080068;6760.966195168992;6764.830879228059;6780.762673306411;4889.682170658896;4991.201407774739;5052.343195384577;5107.897842043139;5126.154184559506;4434.866953991385;4470.552944705503;4494.460664720189;4505.842295519641;4557.521460246693;5798.82603521895;5829.708514574254;5855.677937713466;5863.003289440805;5878.29460464747;6693.431058359996;6696.397324240842;6707.966460167668;6802.795916122524;6815.182178138556;5666.546676265889;5743.62666426681;5804.2744656917885;5871.412858714094;5872.530197584183;5621.128725047624;5645.2096706461125;5645.350784659735;5673;5743.966086104541;6553.115329430561;6581.736730530821;6584.078229047937;6597.241317248482;6603.867922641521;6671.43292820106;6684.565503242274;6695.933040669531;6761.459083273228;6787.762428314985;6568.211814582281;6569.507286953402;6619.371159739817;6662.200535935719;6662.733490660319;6472.805815825533;6492.0261960706275;6579.407853293226;6656.900146497709;6660.300668429745;6559.672016399066;6715.597064176165;6718.496112791658;6726.159230096238;6733.730650773914;6466.385693359123;6474.902876456763;6495.935040649533;6520.543561950618;6524.641144737085;6493.253275873146;6502.284748677547;6517.087607735016;6589.538732288694;6594.802155935329;6213.813585592439;6425.614463132227;6512.511561632991;6519.478441724746;6528.543001989815;6490.545661803629;6524.67376631176;6534.509911756542;6540.574862633914;6587.176602924635;6316.273628532594;6325.841853953688;6329.936700632935;6347.270063942706;6450.741970321134 12:26:58 INFO - PID 7394 | |1;ext.html;827.92134747199;850.7022542110262;875.6147295190116;879.415188899382;879.4855009819255;39471.210575788464;40189.196216075696;40292.19415611686;40293.39559906604;40356.19287614246;36910.26179476409;41052.58947410525;41735.58264417355;41844.372334415006;41863;7583.77248682539;7662.080550333968;7662.348700360448;7670.3480204182715;7676.270754278335;7606.201348858373;7636.121845987727;7687.423443241752;7689.115751688543;7691;7705.73029943952;7711.652975616083;7740.26467485588;7752.147263800977;7775.066991960973;7654.73208437702;7692.115406728214;7693.961530192313;7698.114716807583;7728.149903510609;7515.023047003854;7546.509476883985;7571.053618297713;7574.886376704354;7575.924240757577;36685.26629467423;37394.439083413774;37412.62587374146;37805.432918506245;37806.62193378059;3489.3719130556487;3501.8074005929666;3518.6833185013215;3528.153243221608;3529.170644898447;31205.531917021264;31320.686793132234;31386.843065784753;31437;31439.52840707391;4995.650304478688;5187.455317191679;5187.922181167285;5222;5235.293235413209;184855;185087;185128;187329;188160.05919970313;47182.5281747185;47209;47271;47410.52589474061;47501.5249847504;48949.755251224226;48961;48999.265011024865;49098.263526047136;49173.262401064014;15133;15480.22598870052;15492.147931863856;15496.30266638004;15509.457168999032;12511.56209532662;12516.3741812909;12522.624321270376;12525.498980040878;12536.247825130522;12677.873221267853;12805;12833.679158020937;12905.161164524276;12955.093143479866;4958;5004.648744838946;5006.0989021975665;5009.223570346602;5051.62112841531;993.2004736187439;1004.0461561516588;1019.1541020952592;1020.4744556553381;1023.3706270643501;22747;22817.7718222819;22914.65628015581;22952.88523557405;22964.19625313106;1110.3227031510771;1116.4640972333325;1122.6239209864787;1123.9775204495863;1128.480898786551;11410.94294528522;11832.230904991147;11949.522019119138;11984.28094314344;12010.759784804255;207492;209493;222577;223286;223320;43596.78201608972;45194.32208516875;51377.48622513802;52212.477875220764;53798.999999999214;1437.7196446692794;1438.7338342406479;1461.371610207621;1463.2025546077414;1468.2365170111696;27207.319817004733;27378.863105684344;27502.449951000468;27674.44651107007;28169.15492535227;37021.81489092537;37180.25639487249;37235.627643723215;37247.44128838124;37269;200973;201861;202103;202576;202838;32341.676583233868;33093.84171553984;33176.66823331736;33353.16617084592;33798.83100584481;41749.37375939303;41972.580274196866;42358;42502.57497424986;42598.36102458404;30978.451077446487;31293.687063129077;31319;31366;31441.371172576877;32157.678423216403;32187.67812321847;32429;32504.83747581247;32755.344893101526;35492.29015419729;35530.822345888104;35543.82228088843;35674.64325356817;35752;30618.846905765327;31487.84256078705;31562;31578.526322105645;31979.36041279208;23004.769952300263;23156;23486;23542.52914941726;23623.88188059049 12:26:58 INFO - PID 7394 | |2;jquery.html;538.7279423890932;540.3542766394161;541.2990177719855;545.5826292885943;550.20220680014;21393.67909481359;22330.218442354522;22343.441413964658;22355;22385.776142238552;23989.76010239897;24356.391090222754;24390;24455.14406995751;24575.877120614416;5958.314793798714;6329.905051424233;6384;6396.6801659917055;6405.5516113872045;6274.874502509947;6364.522660800435;6376.744930202786;6380;6383.521235907302;6244.875102497947;6358.0462930560325;6374.904376434357;6481.708323125471;6493.350664933516;6466.902996455057;6510.18622672166;6512.15342005541;6531;6531.967340163269;5877.089051197071;6037.426444487766;6054.939450605481;6056.091586262052;6092.72582733778;28711.56932646012;29091.56362654562;29185.56221656677;29217.269568260963;29275.121746347642;2043.1418804102314;2081.98959005204;2082.021449918536;2084.2392526727785;2096.1301060060055;18718.90640546802;18947;19295.4211373659;19344.80655193444;19357.90321048386;2391.6532102845163;2434.440078781872;2464.297675162588;2465.506898620283;2470.295965649781;119636;124966;126186;126595;132647.33676331557;14223.217723025125;14256.35846386915;14585.308468552505;14670.579354406616;14711.74950129251;22013;22049.779502205092;22060.117595296328;22158.113675453125;22210.444738881335;9356.111169438893;9500.809983800285;9683.612655493702;9701.126898579161;9776.120149186465;8936.24041956441;8965.282777377794;8991.730248092568;9095.590698418588;9141.588628511732;8908.287337013024;9093.909060909305;9098.499582523025;9102.544872756336;9124.58939347731;2764.9308767280977;2771.528840097148;2789.456056069047;2809.971900281012;2860.537561404216;948.9857652135223;965.4545181972163;972.1833659725864;972.4165500699523;976.9804603907882;18403.631927361377;18586;18714.53213669642;18841.81158188428;19093;993.64228877604;1031.0617338222182;1031.9896801032044;1039.3815679670583;1043.3062013760916;10196.3372380795;10206.591736330463;10325.793484130276;10375;10674.412907290174;479297;480804;487541;489441;518708;101634.49182754187;103530;103777.48111259396;104476.47761761142;106691;1126.3692332293942;1136.6362763915467;1161.517970042423;1161.9302841829517;1165.7610189911047;16426.917865410596;16482.25829837684;16742.4140155094;16814.495565133064;16842.242099105813;54017.729911351766;54733.1790023142;54738.72630636821;55219.72390138184;56247.43752562422;67027;67110;67932;68281;68659.65670171617;13729.794053089012;13930.094543854617;13935.651608709457;13988.300584970508;14010.299485025911;21258.25596104129;21315.36053918385;21347.25284615031;21366.14535418628;21605.783942161004;17291.221895015005;17510.299588016336;17610.91194544019;17694.734578981584;17715.557111072325;15742;15831.52505424793;15865.365385384455;16022.198890055217;16029.599260018593;17606.64786704233;17692;17891.10544472797;17967.460976170212;18015.729764053813;13780;13795.517156899461;13803.861961380659;13822.792658110338;13834.169949803045;16052.67894642124;17471.475855724348;17476.213570389107;17485.388011419538;17493.475195744148 12:26:58 INFO - PID 7394 | |3;mootools.html;1310.7050913544451;1358.0154388068645;1367.4461842953608;1379.337917799456;1384.6469150366654;15147.545573632795;15668.216589170524;15683.92158039211;15692.843071569281;15701.607459813496;15382.769258461132;15468.845311546882;15477.613059673513;15496.535103946871;15529.14589697569;2813.9296517587018;2851.6150319706885;2856.6714827794863;2876.5109931311727;2883.2935930696904;2769.1969328894597;2800.705925877784;2805.424887897986;2815.1413818785263;2815.211740712604;2704.256329509391;2785.9164225073177;2786.7770578353784;2803.481355949156;2805.8035937484383;2617.227917764264;2646.2325925481587;2650.2711754267634;2664.6802383713884;2668.652330573058;2618.8166828322023;2635.985145718912;2665.453582015682;2669.185898301037;2676.4245687177154;14838.629034274121;15259.465918692793;15263.38946442141;15321.080735155927;15365.923170384189;7952.443328966975;8248.051474080497;8251.587420629005;8252;8255.958720206421;5450.126433113177;5560.138178582326;5641.12562552805;5684.147377893308;5708.372079071299;1916.559191385989;1954.8533859960417;1986.2352994097378;1994.7307113539632;2021.6259991901545;27053.45893082147;27295;27320.59019114715;27354.726452735416;27386.86306568474;6743.898841517381;6846.075779769767;6871.690773915186;6994.720211191597;7038.190608080136;17165.656686866194;17523.561910952074;17566.209520571603;17574.912125439547;17793.822061779218;7904.130545639975;8111.9594402027615;8125.79685507867;8146.429749917449;8151.184881511801;7366.631668416558;7369.115706115301;7494.587797671072;7515.812104697427;7517.473776835569;5108.106081435808;5214.713190774544;5237.266782650432;5288.286081379041;5321.73391330432;1521.231777952127;1528.8700460460987;1535.2554011304733;1541.183172918355;1544.289626771675;833.6748668019477;855.2644725536034;858.6565373850385;871.6339137562239;880.5333173418098;7188.388986936169;7226.205117437078;7226.819329516699;7239.276072392824;7249.130104387507;701.5229643842237;703.4337358426516;708.6173466328228;710.1371833222556;713.7715930902166;4751.667383283137;5062.417821950523;5123.052235336475;5149.2276158576515;5200.97399513;21279.255226067013;22267.554648907255;22507.662385064235;22594;22635.20776772805;21305.78694213038;22056.88971555132;22313.55372892533;22381.88809055977;22505.54988900213;11446.37044962535;11509.597164099383;11537.250078744855;11645.6506304811;11646.126540509325;7827;8173.6321865515;8316.168383161636;8345.123762004901;8388.916110838814;18795.24819007279;19032.14355353985;19041.04794760284;19163.80836191676;19370.12834422426;19207.61584768269;19566.21735130579;19640.607187856447;19843.206271749546;19845.702314465583;10870.945645272039;10917.617883374043;10946.124310055337;11025.17311201647;11031.944840275748;13780.862191378359;13892.652683682989;13924.860751392762;13933.164010159422;13937.233452160228;11256.324620522795;11401.942990284995;11425.428728563373;11523.827142593036;11551.306921584732;10664.413457259925;10710.571577136827;10736;10810.67567972962;11044.613438529934;9420.057994200524;9441.905580944103;9462;9477.052294770469;9488.525573721425;7115.217326094022;7129;7146.999420081089;7151.356377926011;7209.206987231505;7143.535670181422;7153.749618763319;7176.569405835667;7253.3834624057545;7291.927080729125 12:26:58 INFO - PID 7394 | |4;prototype.html;487.4989309233971;494.5736958275175;518.6861948521145;518.9429162792093;519.7842895198493;6150.630962142269;6202.875942481148;6223.751049958002;6324.683765811703;6325.557210995232;6146.354632763562;6201.193844800169;6217.616580310882;6246.625202487854;6266.404691554307;5199.6360254782185;5208.244804503344;5211.550571231515;5217.608679349045;5234.73826308685;4764.356811830393;4967.875803104933;5099.184130539114;5172.120739474299;5217.530422261995;4906.435759887623;4908.779104940286;4910.6317026223;4947.604191664676;4982.775775090112;4806.855794326141;4894.461609222983;4902.215645496722;4915.950840491585;4926.334944782444;4325.156594464081;4437.733735975819;4441.822327106912;4442.600165985044;4455.22033644111;5978.372270911535;5988.970055149696;6066.393360663898;6066.6663333516635;6089.421504957022;5564.8052318169075;5608.971955140239;5625.25617058709;5654.434556544354;5688;6393.8401539961405;6433.806985790434;6450.000499845063;6525.902111468332;6613.404793568602;4548.5906268436;4879.341288925985;4885.60915126789;4894.583960363338;4898.681585696918;6508.25155107164;6604.86790264192;6619.106420633249;6699.229588597276;6819.181698196248;4916.803327866845;4938.333325001151;4952.950470495321;4954.5540901319055;4987;5043.36957880265;5045.697258164522;5050.065737838511;5063.518965698253;5087.669301495465;5614.887702245932;5623.128415095667;5669.489745922804;5679.545636349082;5710.942890571124;6542.672866356663;6553.180852393451;6556.442702370352;6571.967140164268;6634.104395906587;1708.7949446066552;1715.0224372108028;1742.2595396956242;1771.1941066814568;1772.273367919147;1146.9139814513944;1203.2299328429813;1218.1777300322246;1228.766534358469;1230.9876901230873;5608.214849921014;5610.214569960209;5611.971940140274;5683.516901063456;5700.828975130753;6647.833804154935;6680.131582894192;6705.228898676714;6717.514519627769;6718.697658605374;5541.141123125922;5557.888842223133;5588.944110558924;5605.8598535036135;5616.466435688603;3417.1969587147;3476.4090104682264;3480.982595087059;3503.8640416827307;3534.2401383702627;6361.936380636227;6403.391677790602;6408.58344207625;6436.710348034349;6440.323766004596;6587.45194879203;6628.4697224221945;6716.932830671631;6761.638743010731;6785.1518560179975;5976;6284.434400904032;6347.174867267226;6408.487321014401;6420.1974753155855;6358.523110766619;6420.2937676856445;6485;6567.376099270562;6592.670366481752;6301.243850737941;6393.6483493408305;6462;6484.837879053061;6508.219013718384;6304.65324407162;6319.652419116993;6357.364263573606;6371.7132729028235;6374.203224596926;4892.755362231803;4893.1436998524405;4936.851894443173;4949.034938187019;5003.299538064601;6319.5780949286045;6472.35276472349;6563.278039415756;6592.736290548516;6655.3344665535;6301.6219026858535;6365.52258580599;6411.166548348685;6440.710168042356;6481.611103333815;6176.047329709079;6224.9377506224355;6331.240251169889;6345.921193397226;6397.488200943821;6317.557770955989;6370.140031095742;6395.560998775239;6397.680115994089;6479.092926990131;6455.257645370654;6499.837504062436;6544.411003009752;6554.934450655433;6558.934410655832;6249.500039996698;6278.372162783685;6281.59169653971;6317.473010795718;6320.4311611955145 12:26:58 INFO - PID 7394 | |5;yui.html;868.150294178928;880.1814312689198;890.2922176869388;893.5755516129835;899.9280057595392;17963;18467.445976620722;18484.815151848477;18490.537736556595;18501.53746156345;18215.72676409855;18298.08509574519;18358.082095895217;18426.44720658379;18431.07844607771;958.7842735384535;969.6751588217955;976.4239098931629;978.5449765858874;979.4466126638462;963.802420503795;967.2020583019003;969.8254314223437;970.6457143142737;970.6893793985927;979.9069088436622;1022.4427686910615;1023.6673081248587;1024.3751311699857;1025.9538320775582;1001.1790331927785;1001.3791449301407;1002.9297949143563;1006.0995409108807;1013.5489707080352;707.5966698981582;731.6414956671193;738.0700317599809;739.9001134846834;740.2856243724777;19205.90397048006;19244.903775481034;19247.711284330748;19352.32266870653;19391.709124363006;20675.379738607866;20879.26922557703;21442.46393840151;21486.355409337746;21625.567488650297;15303.923480382638;15642;15805;15939.681206375808;15979.440719574759;3777.7544459610035;3788.5643151037707;3808;3816.3321418751884;3817.1602247505502;105845.47077264564;138276;142752;143295;146670.26664866714;17575.73636395455;18015.72976405355;18172.27310907549;18309.542261443305;18311.359102431616;31373.215669608442;31494;31715;31905.202369940474;31917.361652766816;8903.376763626613;8990;9094.909050909539;9238.353315267866;9299.860502092473;4230.809613567397;4316.374125751811;4348.195583817004;4363.738175709467;4363.825446982149;5085.3134826797905;5118.718470484085;5160.40655324635;5173.172292433268;5216.66091704038;1091.2361347057092;1094.5402930769096;1112.9666110016713;1117.083991127284;1122.2985633978763;631.6368088349218;665.490899461912;678.1624693503519;680.6120511308507;684.5379368925956;12037.638870833714;12144.332061736513;12383.814242786366;12664.176828506117;12804.359782010863;672.2437258084655;672.6468603982851;677.762783025937;679.5684740190015;693.4452438049641;5511.173324001352;5532.834014979557;5560.054790685593;5595.38450770415;5716.714164291769;121159.39420303018;123843.3807830955;124751.3762431182;126479;130760.3461982684;108763.91236087537;109019;111130.44434777774;111478;113515.432422839;93063.53468232615;94783;97266;97604.99999999857;97920;10256.897431025594;10381.9480902595;10529.526171322463;10662.200334975063;10793.29843560166;45106;45267;45952.31071533997;46036.30945535753;46899.296510551685;57457.425425745205;60169.09746353896;60207.39792602018;60599.394006059374;61821;15078.698426031198;15261.160636165117;15400.537983860502;15438.5368438947;15474.5357639271;17333.306667733148;17334.39329623457;17381.913090434467;17618.11909404499;17782.288708451517;14427.062240954305;14485.771118419181;14624.707505850036;14734.410623574937;14751.92624036873;15076.698466030399;15223.314950827018;15240.466583669519;15312.846871531588;15447.2276386178;14565.635859103608;14767.852321477078;14823;14845.109293442429;14885.25573721288;11142.220044596801;11299.71750706206;11412.715285991731;11446.942765286454;11604.94197529007;12321.507139714311;12326.198797078161;12372.876271237172;12399.318037508023;12523.561675341683 12:26:58 INFO - PID 7394 | __end_tp_report 12:26:58 INFO - PID 7394 | __start_cc_report 12:26:58 INFO - PID 7394 | _x_x_mozilla_cycle_collect,365 12:26:58 INFO - PID 7394 | __end_cc_report 12:26:58 INFO - PID 7394 | __startTimestamp1505503618757__endTimestamp 12:26:58 INFO - PID 7394 | 12:26:58 INFO - PID 7394 | ------- Summary: start ------- 12:26:58 INFO - PID 7394 | Number of tests: 6 12:26:58 INFO - PID 7394 | 12:26:58 INFO - PID 7394 | [#0] dojo.html Cycles:165 Average:6130.79 Median:6450.74 stddev:845.37 (13.1%) stddev-sans-first:814.40 12:26:58 INFO - PID 7394 | Values: 3124.2 3155.5 3163.8 3170.1 3179.8 6025.4 6248.8 6270.0 6312.9 6351.7 6131.5 6134.5 6193.3 6195.6 6260.5 5758.1 5813.7 5825.6 5854.0 5899.8 1206.9 5706.2 5813.4 5901.4 5942.6 5686.7 5718.1 5759.4 5838.0 5854.4 5743.3 5754.9 5822.8 5828.5 5837.1 5724.5 5735.9 5800.6 5801.5 5803.6 6150.6 6210.6 6296.1 6306.5 6341.1 6489.0 6595.7 6626.3 6676.3 6755.1 6763.8 6797.1 6797.9 6801.5 6822.7 6205.3 6232.4 6314.5 6319.6 6324.2 6916.1 6922.7 6993.3 6997.2 7005.1 6445.3 6520.2 6546.2 6557.1 6662.8 6619.1 6626.1 6645.1 6646.3 6649.1 6580.7 6606.5 6718.2 6736.5 6737.4 6673.0 6691.1 6761.0 6764.8 6780.8 4889.7 4991.2 5052.3 5107.9 5126.2 4434.9 4470.6 4494.5 4505.8 4557.5 5798.8 5829.7 5855.7 5863.0 5878.3 6693.4 6696.4 6708.0 6802.8 6815.2 5666.5 5743.6 5804.3 5871.4 5872.5 5621.1 5645.2 5645.4 5673.0 5744.0 6553.1 6581.7 6584.1 6597.2 6603.9 6671.4 6684.6 6695.9 6761.5 6787.8 6568.2 6569.5 6619.4 6662.2 6662.7 6472.8 6492.0 6579.4 6656.9 6660.3 6559.7 6715.6 6718.5 6726.2 6733.7 6466.4 6474.9 6495.9 6520.5 6524.6 6493.3 6502.3 6517.1 6589.5 6594.8 6213.8 6425.6 6512.5 6519.5 6528.5 6490.5 6524.7 6534.5 6540.6 6587.2 6316.3 6325.8 6329.9 6347.3 6450.7 12:26:58 INFO - PID 7394 | 12:26:58 INFO - PID 7394 | [#1] ext.html Cycles:180 Average:36854.82 Median:3510.25 stddev:52319.50 (1490.5%) stddev-sans-first:52396.33 12:26:58 INFO - PID 7394 | Values: 827.9 850.7 875.6 879.4 879.5 39471.2 40189.2 40292.2 40293.4 40356.2 36910.3 41052.6 41735.6 41844.4 41863.0 7583.8 7662.1 7662.3 7670.3 7676.3 7606.2 7636.1 7687.4 7689.1 7691.0 7705.7 7711.7 7740.3 7752.1 7775.1 7654.7 7692.1 7694.0 7698.1 7728.1 7515.0 7546.5 7571.1 7574.9 7575.9 36685.3 37394.4 37412.6 37805.4 37806.6 3489.4 3501.8 3518.7 3528.2 3529.2 31205.5 31320.7 31386.8 31437.0 31439.5 4995.7 5187.5 5187.9 5222.0 5235.3 184855.0 185087.0 185128.0 187329.0 188160.1 47182.5 47209.0 47271.0 47410.5 47501.5 48949.8 48961.0 48999.3 49098.3 49173.3 15133.0 15480.2 15492.1 15496.3 15509.5 12511.6 12516.4 12522.6 12525.5 12536.2 12677.9 12805.0 12833.7 12905.2 12955.1 4958.0 5004.6 5006.1 5009.2 5051.6 993.2 1004.0 1019.2 1020.5 1023.4 22747.0 22817.8 22914.7 22952.9 22964.2 1110.3 1116.5 1122.6 1124.0 1128.5 11410.9 11832.2 11949.5 11984.3 12010.8 207492.0 209493.0 222577.0 223286.0 223320.0 43596.8 45194.3 51377.5 52212.5 53799.0 1437.7 1438.7 1461.4 1463.2 1468.2 27207.3 27378.9 27502.4 27674.4 28169.2 37021.8 37180.3 37235.6 37247.4 37269.0 200973.0 201861.0 202103.0 202576.0 202838.0 32341.7 33093.8 33176.7 33353.2 33798.8 41749.4 41972.6 42358.0 42502.6 42598.4 30978.5 31293.7 31319.0 31366.0 31441.4 32157.7 32187.7 32429.0 32504.8 32755.3 35492.3 35530.8 35543.8 35674.6 35752.0 30618.8 31487.8 31562.0 31578.5 31979.4 23004.8 23156.0 23486.0 23542.5 23623.9 12:26:58 INFO - PID 7394 | 12:26:58 INFO - PID 7394 | [#2] jquery.html Cycles:180 Average:33581.54 Median:22336.83 stddev:82117.31 (367.6%) stddev-sans-first:82310.19 12:26:58 INFO - PID 7394 | Values: 538.7 540.4 541.3 545.6 550.2 21393.7 22330.2 22343.4 22355.0 22385.8 23989.8 24356.4 24390.0 24455.1 24575.9 5958.3 6329.9 6384.0 6396.7 6405.6 6274.9 6364.5 6376.7 6380.0 6383.5 6244.9 6358.0 6374.9 6481.7 6493.4 6466.9 6510.2 6512.2 6531.0 6532.0 5877.1 6037.4 6054.9 6056.1 6092.7 28711.6 29091.6 29185.6 29217.3 29275.1 2043.1 2082.0 2082.0 2084.2 2096.1 18718.9 18947.0 19295.4 19344.8 19357.9 2391.7 2434.4 2464.3 2465.5 2470.3 119636.0 124966.0 126186.0 126595.0 132647.3 14223.2 14256.4 14585.3 14670.6 14711.7 22013.0 22049.8 22060.1 22158.1 22210.4 9356.1 9500.8 9683.6 9701.1 9776.1 8936.2 8965.3 8991.7 9095.6 9141.6 8908.3 9093.9 9098.5 9102.5 9124.6 2764.9 2771.5 2789.5 2810.0 2860.5 949.0 965.5 972.2 972.4 977.0 18403.6 18586.0 18714.5 18841.8 19093.0 993.6 1031.1 1032.0 1039.4 1043.3 10196.3 10206.6 10325.8 10375.0 10674.4 479297.0 480804.0 487541.0 489441.0 518708.0 101634.5 103530.0 103777.5 104476.5 106691.0 1126.4 1136.6 1161.5 1161.9 1165.8 16426.9 16482.3 16742.4 16814.5 16842.2 54017.7 54733.2 54738.7 55219.7 56247.4 67027.0 67110.0 67932.0 68281.0 68659.7 13729.8 13930.1 13935.7 13988.3 14010.3 21258.3 21315.4 21347.3 21366.1 21605.8 17291.2 17510.3 17610.9 17694.7 17715.6 15742.0 15831.5 15865.4 16022.2 16029.6 17606.6 17692.0 17891.1 17967.5 18015.7 13780.0 13795.5 13803.9 13822.8 13834.2 16052.7 17471.5 17476.2 17485.4 17493.5 12:26:58 INFO - PID 7394 | 12:26:58 INFO - PID 7394 | [#3] mootools.html Cycles:180 Average:9409.03 Median:14878.86 stddev:6860.82 (46.1%) stddev-sans-first:6853.08 12:26:58 INFO - PID 7394 | Values: 1310.7 1358.0 1367.4 1379.3 1384.6 15147.5 15668.2 15683.9 15692.8 15701.6 15382.8 15468.8 15477.6 15496.5 15529.1 2813.9 2851.6 2856.7 2876.5 2883.3 2769.2 2800.7 2805.4 2815.1 2815.2 2704.3 2785.9 2786.8 2803.5 2805.8 2617.2 2646.2 2650.3 2664.7 2668.7 2618.8 2636.0 2665.5 2669.2 2676.4 14838.6 15259.5 15263.4 15321.1 15365.9 7952.4 8248.1 8251.6 8252.0 8256.0 5450.1 5560.1 5641.1 5684.1 5708.4 1916.6 1954.9 1986.2 1994.7 2021.6 27053.5 27295.0 27320.6 27354.7 27386.9 6743.9 6846.1 6871.7 6994.7 7038.2 17165.7 17523.6 17566.2 17574.9 17793.8 7904.1 8112.0 8125.8 8146.4 8151.2 7366.6 7369.1 7494.6 7515.8 7517.5 5108.1 5214.7 5237.3 5288.3 5321.7 1521.2 1528.9 1535.3 1541.2 1544.3 833.7 855.3 858.7 871.6 880.5 7188.4 7226.2 7226.8 7239.3 7249.1 701.5 703.4 708.6 710.1 713.8 4751.7 5062.4 5123.1 5149.2 5201.0 21279.3 22267.6 22507.7 22594.0 22635.2 21305.8 22056.9 22313.6 22381.9 22505.5 11446.4 11509.6 11537.3 11645.7 11646.1 7827.0 8173.6 8316.2 8345.1 8388.9 18795.2 19032.1 19041.0 19163.8 19370.1 19207.6 19566.2 19640.6 19843.2 19845.7 10870.9 10917.6 10946.1 11025.2 11031.9 13780.9 13892.7 13924.9 13933.2 13937.2 11256.3 11401.9 11425.4 11523.8 11551.3 10664.4 10710.6 10736.0 10810.7 11044.6 9420.1 9441.9 9462.0 9477.1 9488.5 7115.2 7129.0 7147.0 7151.4 7209.2 7143.5 7153.7 7176.6 7253.4 7291.9 12:26:58 INFO - PID 7394 | 12:26:58 INFO - PID 7394 | [#4] prototype.html Cycles:180 Average:5435.74 Median:6117.89 stddev:1510.38 (24.7%) stddev-sans-first:1468.25 12:26:58 INFO - PID 7394 | Values: 487.5 494.6 518.7 518.9 519.8 6150.6 6202.9 6223.8 6324.7 6325.6 6146.4 6201.2 6217.6 6246.6 6266.4 5199.6 5208.2 5211.6 5217.6 5234.7 4764.4 4967.9 5099.2 5172.1 5217.5 4906.4 4908.8 4910.6 4947.6 4982.8 4806.9 4894.5 4902.2 4916.0 4926.3 4325.2 4437.7 4441.8 4442.6 4455.2 5978.4 5989.0 6066.4 6066.7 6089.4 5564.8 5609.0 5625.3 5654.4 5688.0 6393.8 6433.8 6450.0 6525.9 6613.4 4548.6 4879.3 4885.6 4894.6 4898.7 6508.3 6604.9 6619.1 6699.2 6819.2 4916.8 4938.3 4953.0 4954.6 4987.0 5043.4 5045.7 5050.1 5063.5 5087.7 5614.9 5623.1 5669.5 5679.5 5710.9 6542.7 6553.2 6556.4 6572.0 6634.1 1708.8 1715.0 1742.3 1771.2 1772.3 1146.9 1203.2 1218.2 1228.8 1231.0 5608.2 5610.2 5612.0 5683.5 5700.8 6647.8 6680.1 6705.2 6717.5 6718.7 5541.1 5557.9 5588.9 5605.9 5616.5 3417.2 3476.4 3481.0 3503.9 3534.2 6361.9 6403.4 6408.6 6436.7 6440.3 6587.5 6628.5 6716.9 6761.6 6785.2 5976.0 6284.4 6347.2 6408.5 6420.2 6358.5 6420.3 6485.0 6567.4 6592.7 6301.2 6393.6 6462.0 6484.8 6508.2 6304.7 6319.7 6357.4 6371.7 6374.2 4892.8 4893.1 4936.9 4949.0 5003.3 6319.6 6472.4 6563.3 6592.7 6655.3 6301.6 6365.5 6411.2 6440.7 6481.6 6176.0 6224.9 6331.2 6345.9 6397.5 6317.6 6370.1 6395.6 6397.7 6479.1 6455.3 6499.8 6544.4 6554.9 6558.9 6249.5 6278.4 6281.6 6317.5 6320.4 12:26:58 INFO - PID 7394 | 12:26:58 INFO - PID 7394 | [#5] yui.html Cycles:180 Average:24346.45 Median:18476.13 stddev:35527.13 (192.3%) stddev-sans-first:35583.05 12:26:58 INFO - PID 7394 | Values: 868.2 880.2 890.3 893.6 899.9 17963.0 18467.4 18484.8 18490.5 18501.5 18215.7 18298.1 18358.1 18426.4 18431.1 958.8 969.7 976.4 978.5 979.4 963.8 967.2 969.8 970.6 970.7 979.9 1022.4 1023.7 1024.4 1026.0 1001.2 1001.4 1002.9 1006.1 1013.5 707.6 731.6 738.1 739.9 740.3 19205.9 19244.9 19247.7 19352.3 19391.7 20675.4 20879.3 21442.5 21486.4 21625.6 15303.9 15642.0 15805.0 15939.7 15979.4 3777.8 3788.6 3808.0 3816.3 3817.2 105845.5 138276.0 142752.0 143295.0 146670.3 17575.7 18015.7 18172.3 18309.5 18311.4 31373.2 31494.0 31715.0 31905.2 31917.4 8903.4 8990.0 9094.9 9238.4 9299.9 4230.8 4316.4 4348.2 4363.7 4363.8 5085.3 5118.7 5160.4 5173.2 5216.7 1091.2 1094.5 1113.0 1117.1 1122.3 631.6 665.5 678.2 680.6 684.5 12037.6 12144.3 12383.8 12664.2 12804.4 672.2 672.6 677.8 679.6 693.4 5511.2 5532.8 5560.1 5595.4 5716.7 121159.4 123843.4 124751.4 126479.0 130760.3 108763.9 109019.0 111130.4 111478.0 113515.4 93063.5 94783.0 97266.0 97605.0 97920.0 10256.9 10381.9 10529.5 10662.2 10793.3 45106.0 45267.0 45952.3 46036.3 46899.3 57457.4 60169.1 60207.4 60599.4 61821.0 15078.7 15261.2 15400.5 15438.5 15474.5 17333.3 17334.4 17381.9 17618.1 17782.3 14427.1 14485.8 14624.7 14734.4 14751.9 15076.7 15223.3 15240.5 15312.8 15447.2 14565.6 14767.9 14823.0 14845.1 14885.3 11142.2 11299.7 11412.7 11446.9 11604.9 12321.5 12326.2 12372.9 12399.3 12523.6 12:26:58 INFO - PID 7394 | -------- Summary: end -------- 12:26:58 INFO - PID 7394 | 12:26:59 INFO - TEST-INFO | 7394: exit 0 12:26:59 INFO - TEST-OK | dromaeo_css | took 1109013ms 12:26:59 INFO - TEST-START | kraken 12:26:59 INFO - Initialising browser for kraken test... 12:26:59 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:54253/getInfo.html -profile /tmp/tmpFF4klc/profile 12:26:59 INFO - TEST-INFO | started process 7761 (/builds/slave/test/build/application/firefox/firefox http://localhost:54253/getInfo.html) 12:27:04 INFO - TEST-INFO | 7761: exit 0 12:27:04 INFO - Browser initialized. 12:27:04 INFO - Running cycle 1/1 for kraken test... 12:27:04 INFO - Using env: {'DISPLAY': ':0', 12:27:04 INFO - 'HOME': '/home/cltbld', 12:27:04 INFO - 'JSGC_DISABLE_POISONING': '1', 12:27:04 INFO - 'LANG': 'en_US.UTF-8', 12:27:04 INFO - 'LANGUAGE': 'en_US:en', 12:27:04 INFO - 'LD_LIBRARY_PATH': '/builds/slave/test/build/application/firefox', 12:27:04 INFO - 'LOGNAME': 'cltbld', 12:27:04 INFO - 'MAIL': '/var/mail/cltbld', 12:27:04 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:27:04 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:27:04 INFO - 'MOZ_CRASHREPORTER': '1', 12:27:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:27:04 INFO - 'MOZ_DISABLE_NONLOCAL_CONNECTIONS': '1', 12:27:04 INFO - 'MOZ_NO_REMOTE': '1', 12:27:04 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:27:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:27:04 INFO - 'NO_EM_RESTART': '1', 12:27:04 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:27:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:27:04 INFO - 'PWD': '/builds/slave/test', 12:27:04 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:27:04 INFO - 'RUST_BACKTRACE': 'full', 12:27:04 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 12:27:04 INFO - 'SHELL': '/bin/bash', 12:27:04 INFO - 'SHLVL': '1', 12:27:04 INFO - 'STYLO_FORCE_DISABLED': '1', 12:27:04 INFO - 'TERM': 'linux', 12:27:04 INFO - 'TMOUT': '86400', 12:27:04 INFO - 'USER': 'cltbld', 12:27:04 INFO - 'XDG_SESSION_COOKIE': '7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401', 12:27:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:27:04 INFO - '_': '/tools/buildbot/bin/python'} 12:27:04 INFO - TEST-INFO | started process 7991 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFF4klc/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 12:27:05 INFO - PID 7991 | 12:27:05 INFO - PID 7991 | (/builds/slave/test/build/application/firefox/firefox:8040): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 12:27:05 INFO - PID 7991 | 12:27:15 INFO - PID 7991 | RSS: Main: 173408256 12:27:15 INFO - PID 7991 | 12:27:18 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54253/tests/kraken/driver.html?testName=audio-beat-detection) 12:27:19 INFO - PID 7991 | RSS: Main: 179982336 12:27:19 INFO - PID 7991 | 12:27:21 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54253/tests/kraken/driver.html?testName=audio-dft) 12:27:22 INFO - PID 7991 | RSS: Main: 180080640 12:27:22 INFO - PID 7991 | 12:27:25 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54253/tests/kraken/driver.html?testName=audio-fft) 12:27:26 INFO - PID 7991 | RSS: Main: 174620672 12:27:26 INFO - PID 7991 | 12:27:28 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54253/tests/kraken/driver.html?testName=audio-oscillator) 12:27:28 INFO - PID 7991 | RSS: Main: 175091712 12:27:28 INFO - PID 7991 | 12:27:30 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54253/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:27:31 INFO - PID 7991 | RSS: Main: 175558656 12:27:31 INFO - PID 7991 | 12:27:34 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54253/tests/kraken/driver.html?testName=imaging-darkroom) 12:27:35 INFO - PID 7991 | RSS: Main: 178098176 12:27:35 INFO - PID 7991 | 12:27:39 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54253/tests/kraken/driver.html?testName=imaging-desaturate) 12:27:39 INFO - PID 7991 | RSS: Main: 177987584 12:27:39 INFO - PID 7991 | 12:27:42 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54253/tests/kraken/driver.html?testName=json-parse-financial) 12:27:43 INFO - PID 7991 | RSS: Main: 178266112 12:27:43 INFO - PID 7991 | 12:27:44 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54253/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:27:45 INFO - PID 7991 | RSS: Main: 177893376 12:27:45 INFO - PID 7991 | 12:27:47 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54253/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:27:47 INFO - PID 7991 | RSS: Main: 178130944 12:27:47 INFO - PID 7991 | 12:27:49 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54253/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:27:50 INFO - PID 7991 | RSS: Main: 175083520 12:27:50 INFO - PID 7991 | 12:27:53 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54253/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:27:53 INFO - PID 7991 | RSS: Main: 175198208 12:27:53 INFO - PID 7991 | 12:27:56 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54253/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:27:57 INFO - PID 7991 | RSS: Main: 175685632 12:27:57 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | Cycle 1(1): loaded http://localhost:54253/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54253/tests/kraken/driver.html?testName=ai-astar) 12:27:59 INFO - PID 7991 | RSS: Main: 177250304 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | __start_tp_report 12:27:59 INFO - PID 7991 | _x_x_mozilla_page_load 12:27:59 INFO - PID 7991 | _x_x_mozilla_page_load_details 12:27:59 INFO - PID 7991 | |i|pagename|runs| 12:27:59 INFO - PID 7991 | |0;ai-astar;108;108;107;110;111;107;108;107;108;108 12:27:59 INFO - PID 7991 | |1;audio-beat-detection;117;117;117;116;149;117;119;116;116;118 12:27:59 INFO - PID 7991 | |2;audio-dft;163;162;163;161;162;164;163;167;163;170 12:27:59 INFO - PID 7991 | |3;audio-fft;74;74;75;80;74;74;73;73;77;76 12:27:59 INFO - PID 7991 | |4;audio-oscillator;79;79;78;79;78;78;80;80;79;78 12:27:59 INFO - PID 7991 | |5;imaging-gaussian-blur;114;113;114;114;116;114;115;114;114;114 12:27:59 INFO - PID 7991 | |6;imaging-darkroom;156;147;148;147;149;148;149;148;148;150 12:27:59 INFO - PID 7991 | |7;imaging-desaturate;93;94;94;94;93;93;94;95;95;94 12:27:59 INFO - PID 7991 | |8;json-parse-financial;55;53;53;54;54;51;51;52;53;53 12:27:59 INFO - PID 7991 | |9;json-stringify-tinderbox;38;39;38;38;38;38;39;38;39;38 12:27:59 INFO - PID 7991 | |10;stanford-crypto-aes;77;83;79;75;76;76;77;77;75;74 12:27:59 INFO - PID 7991 | |11;stanford-crypto-ccm;113;112;115;114;117;113;127;119;111;119 12:27:59 INFO - PID 7991 | |12;stanford-crypto-pbkdf2;177;167;166;168;176;165;168;169;167;173 12:27:59 INFO - PID 7991 | |13;stanford-crypto-sha256-iterative;70;70;67;65;65;66;64;65;64;69 12:27:59 INFO - PID 7991 | __end_tp_report 12:27:59 INFO - PID 7991 | __start_cc_report 12:27:59 INFO - PID 7991 | _x_x_mozilla_cycle_collect,950 12:27:59 INFO - PID 7991 | __end_cc_report 12:27:59 INFO - PID 7991 | __startTimestamp1505503679312__endTimestamp 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | ------- Summary: start ------- 12:27:59 INFO - PID 7991 | Number of tests: 14 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#0] ai-astar Cycles:10 Average:108.20 Median:108.00 stddev:1.32 (1.2%) stddev-sans-first:1.39 12:27:59 INFO - PID 7991 | Values: 108.0 108.0 107.0 110.0 111.0 107.0 108.0 107.0 108.0 108.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#1] audio-beat-detection Cycles:10 Average:120.20 Median:117.00 stddev:10.16 (8.7%) stddev-sans-first:10.71 12:27:59 INFO - PID 7991 | Values: 117.0 117.0 117.0 116.0 149.0 117.0 119.0 116.0 116.0 118.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#2] audio-dft Cycles:10 Average:163.80 Median:163.00 stddev:2.70 (1.7%) stddev-sans-first:2.85 12:27:59 INFO - PID 7991 | Values: 163.0 162.0 163.0 161.0 162.0 164.0 163.0 167.0 163.0 170.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#3] audio-fft Cycles:10 Average:75.00 Median:74.50 stddev:2.16 (2.9%) stddev-sans-first:2.26 12:27:59 INFO - PID 7991 | Values: 74.0 74.0 75.0 80.0 74.0 74.0 73.0 73.0 77.0 76.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#4] audio-oscillator Cycles:10 Average:78.80 Median:79.00 stddev:0.79 (1.0%) stddev-sans-first:0.83 12:27:59 INFO - PID 7991 | Values: 79.0 79.0 78.0 79.0 78.0 78.0 80.0 80.0 79.0 78.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#5] imaging-gaussian-blur Cycles:10 Average:114.20 Median:114.00 stddev:0.79 (0.7%) stddev-sans-first:0.83 12:27:59 INFO - PID 7991 | Values: 114.0 113.0 114.0 114.0 116.0 114.0 115.0 114.0 114.0 114.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#6] imaging-darkroom Cycles:10 Average:149.00 Median:148.50 stddev:2.62 (1.8%) stddev-sans-first:0.97 12:27:59 INFO - PID 7991 | Values: 156.0 147.0 148.0 147.0 149.0 148.0 149.0 148.0 148.0 150.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#7] imaging-desaturate Cycles:10 Average:93.90 Median:94.00 stddev:0.74 (0.8%) stddev-sans-first:0.71 12:27:59 INFO - PID 7991 | Values: 93.0 94.0 94.0 94.0 93.0 93.0 94.0 95.0 95.0 94.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#8] json-parse-financial Cycles:10 Average:52.90 Median:53.00 stddev:1.29 (2.4%) stddev-sans-first:1.12 12:27:59 INFO - PID 7991 | Values: 55.0 53.0 53.0 54.0 54.0 51.0 51.0 52.0 53.0 53.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#9] json-stringify-tinderbox Cycles:10 Average:38.30 Median:38.00 stddev:0.48 (1.3%) stddev-sans-first:0.50 12:27:59 INFO - PID 7991 | Values: 38.0 39.0 38.0 38.0 38.0 38.0 39.0 38.0 39.0 38.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#10] stanford-crypto-aes Cycles:10 Average:76.90 Median:77.00 stddev:2.56 (3.3%) stddev-sans-first:2.71 12:27:59 INFO - PID 7991 | Values: 77.0 83.0 79.0 75.0 76.0 76.0 77.0 77.0 75.0 74.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#11] stanford-crypto-ccm Cycles:10 Average:116.00 Median:116.00 stddev:4.76 (4.1%) stddev-sans-first:4.92 12:27:59 INFO - PID 7991 | Values: 113.0 112.0 115.0 114.0 117.0 113.0 127.0 119.0 111.0 119.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:169.60 Median:168.50 stddev:4.22 (2.5%) stddev-sans-first:3.53 12:27:59 INFO - PID 7991 | Values: 177.0 167.0 166.0 168.0 176.0 165.0 168.0 169.0 167.0 173.0 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.50 Median:66.50 stddev:2.37 (3.6%) stddev-sans-first:2.15 12:27:59 INFO - PID 7991 | Values: 70.0 70.0 67.0 65.0 65.0 66.0 64.0 65.0 64.0 69.0 12:27:59 INFO - PID 7991 | -------- Summary: end -------- 12:27:59 INFO - PID 7991 | 12:27:59 INFO - PID 7991 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 12:27:59 INFO - TEST-INFO | 7991: exit 0 12:28:00 INFO - TEST-OK | kraken | took 60659ms 12:28:00 INFO - SUITE-END | took 1169s 12:28:00 INFO - Completed test suite (00:19:30) 12:28:00 INFO - javascript benchmark 12:28:00 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s", "stylo_disabled"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8389.460397222309, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3124.1877111950894, 3155.463571192897, 3163.825989570574, 3170.080676603785, 3179.761517886156, 6025.367336429677, 6248.84377890553, 6269.996800511919, 6312.905306420402, 6351.682415879205, 6131.47882429994, 6134.509239260859, 6193.349698281671, 6195.597286176396, 6260.467860231885, 5758.078707406816, 5813.6802475863815, 5825.592208545393, 5853.970730146343, 5899.793507227248, 1206.8918911613168, 5706.201131841545, 5813.360530341659, 5901.380355062721, 5942.554308426864, 5686.658800471964, 5718.142278658234, 5759.395263497315, 5838.0, 5854.385289544579, 5743.310802703702, 5754.913676294859, 5822.796202132905, 5828.5337173026055, 5837.124431335291, 5724.542036637101, 5735.856603584902, 5800.564957628195, 5801.477866991991, 5803.593748437611, 6150.630962142286, 6210.627362358273, 6296.118543403882, 6306.463950564207, 6341.143945567382, 6489.0, 6595.70319335631, 6626.304238054983, 6676.332366763285, 6755.121834161577, 6763.7632682855865, 6797.116374871235, 6797.932020679779, 6801.455883529356, 6822.727090916357, 6205.255369355661, 6232.407921247474, 6314.526410519184, 6319.5576309658345, 6324.241091069055, 6916.066331045345, 6922.723091076301, 6993.300669932966, 6997.195322537871, 7005.054317667152, 6445.291017988017, 6520.152380190545, 6546.18172728409, 6557.114789503451, 6662.766803161963, 6619.106420633249, 6626.105475760807, 6645.06969024337, 6646.302138275508, 6649.135612370361, 6580.703868325937, 6606.471482281406, 6718.160229971254, 6736.46108311334, 6737.393634572912, 6672.966635166793, 6691.130153080068, 6760.966195168992, 6764.830879228059, 6780.762673306411, 4889.682170658896, 4991.201407774739, 5052.343195384577, 5107.897842043139, 5126.154184559506, 4434.866953991385, 4470.552944705503, 4494.460664720189, 4505.842295519641, 4557.521460246693, 5798.82603521895, 5829.708514574254, 5855.677937713466, 5863.003289440805, 5878.29460464747, 6693.431058359996, 6696.397324240842, 6707.966460167668, 6802.795916122524, 6815.182178138556, 5666.546676265889, 5743.62666426681, 5804.2744656917885, 5871.412858714094, 5872.530197584183, 5621.128725047624, 5645.2096706461125, 5645.350784659735, 5673.0, 5743.966086104541, 6553.115329430561, 6581.736730530821, 6584.078229047937, 6597.241317248482, 6603.867922641521, 6671.43292820106, 6684.565503242274, 6695.933040669531, 6761.459083273228, 6787.762428314985, 6568.211814582281, 6569.507286953402, 6619.371159739817, 6662.200535935719, 6662.733490660319, 6472.805815825533, 6492.0261960706275, 6579.407853293226, 6656.900146497709, 6660.300668429745, 6559.672016399066, 6715.597064176165, 6718.496112791658, 6726.159230096238, 6733.730650773914, 6466.385693359123, 6474.902876456763, 6495.935040649533, 6520.543561950618, 6524.641144737085, 6493.253275873146, 6502.284748677547, 6517.087607735016, 6589.538732288694, 6594.802155935329, 6213.813585592439, 6425.614463132227, 6512.511561632991, 6519.478441724746, 6528.543001989815, 6490.545661803629, 6524.67376631176, 6534.509911756542, 6540.574862633914, 6587.176602924635, 6316.273628532594, 6325.841853953688, 6329.936700632935, 6347.270063942706, 6450.741970321134], "value": 6068.781514022454, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [827.92134747199, 850.7022542110262, 875.6147295190116, 879.415188899382, 879.4855009819255, 39471.210575788464, 40189.196216075696, 40292.19415611686, 40293.39559906604, 40356.19287614246, 36910.26179476409, 41052.58947410525, 41735.58264417355, 41844.372334415006, 41863.0, 7583.77248682539, 7662.080550333968, 7662.348700360448, 7670.3480204182715, 7676.270754278335, 7606.201348858373, 7636.121845987727, 7687.423443241752, 7689.115751688543, 7691.0, 7705.73029943952, 7711.652975616083, 7740.26467485588, 7752.147263800977, 7775.066991960973, 7654.73208437702, 7692.115406728214, 7693.961530192313, 7698.114716807583, 7728.149903510609, 7515.023047003854, 7546.509476883985, 7571.053618297713, 7574.886376704354, 7575.924240757577, 36685.26629467423, 37394.439083413774, 37412.62587374146, 37805.432918506245, 37806.62193378059, 3489.3719130556487, 3501.8074005929666, 3518.6833185013215, 3528.153243221608, 3529.170644898447, 31205.531917021264, 31320.686793132234, 31386.843065784753, 31437.0, 31439.52840707391, 4995.650304478688, 5187.455317191679, 5187.922181167285, 5222.0, 5235.293235413209, 184855.0, 185087.0, 185128.0, 187329.0, 188160.05919970313, 47182.5281747185, 47209.0, 47271.0, 47410.52589474061, 47501.5249847504, 48949.755251224226, 48961.0, 48999.265011024865, 49098.263526047136, 49173.262401064014, 15133.0, 15480.22598870052, 15492.147931863856, 15496.30266638004, 15509.457168999032, 12511.56209532662, 12516.3741812909, 12522.624321270376, 12525.498980040878, 12536.247825130522, 12677.873221267853, 12805.0, 12833.679158020937, 12905.161164524276, 12955.093143479866, 4958.0, 5004.648744838946, 5006.0989021975665, 5009.223570346602, 5051.62112841531, 993.2004736187439, 1004.0461561516588, 1019.1541020952592, 1020.4744556553381, 1023.3706270643501, 22747.0, 22817.7718222819, 22914.65628015581, 22952.88523557405, 22964.19625313106, 1110.3227031510771, 1116.4640972333325, 1122.6239209864787, 1123.9775204495863, 1128.480898786551, 11410.94294528522, 11832.230904991147, 11949.522019119138, 11984.28094314344, 12010.759784804255, 207492.0, 209493.0, 222577.0, 223286.0, 223320.0, 43596.78201608972, 45194.32208516875, 51377.48622513802, 52212.477875220764, 53798.999999999214, 1437.7196446692794, 1438.7338342406479, 1461.371610207621, 1463.2025546077414, 1468.2365170111696, 27207.319817004733, 27378.863105684344, 27502.449951000468, 27674.44651107007, 28169.15492535227, 37021.81489092537, 37180.25639487249, 37235.627643723215, 37247.44128838124, 37269.0, 200973.0, 201861.0, 202103.0, 202576.0, 202838.0, 32341.676583233868, 33093.84171553984, 33176.66823331736, 33353.16617084592, 33798.83100584481, 41749.37375939303, 41972.580274196866, 42358.0, 42502.57497424986, 42598.36102458404, 30978.451077446487, 31293.687063129077, 31319.0, 31366.0, 31441.371172576877, 32157.678423216403, 32187.67812321847, 32429.0, 32504.83747581247, 32755.344893101526, 35492.29015419729, 35530.822345888104, 35543.82228088843, 35674.64325356817, 35752.0, 30618.846905765327, 31487.84256078705, 31562.0, 31578.526322105645, 31979.36041279208, 23004.769952300263, 23156.0, 23486.0, 23542.52914941726, 23623.88188059049], "value": 16889.143996941355, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [538.7279423890932, 540.3542766394161, 541.2990177719855, 545.5826292885943, 550.20220680014, 21393.67909481359, 22330.218442354522, 22343.441413964658, 22355.0, 22385.776142238552, 23989.76010239897, 24356.391090222754, 24390.0, 24455.14406995751, 24575.877120614416, 5958.314793798714, 6329.905051424233, 6384.0, 6396.6801659917055, 6405.5516113872045, 6274.874502509947, 6364.522660800435, 6376.744930202786, 6380.0, 6383.521235907302, 6244.875102497947, 6358.0462930560325, 6374.904376434357, 6481.708323125471, 6493.350664933516, 6466.902996455057, 6510.18622672166, 6512.15342005541, 6531.0, 6531.967340163269, 5877.089051197071, 6037.426444487766, 6054.939450605481, 6056.091586262052, 6092.72582733778, 28711.56932646012, 29091.56362654562, 29185.56221656677, 29217.269568260963, 29275.121746347642, 2043.1418804102314, 2081.98959005204, 2082.021449918536, 2084.2392526727785, 2096.1301060060055, 18718.90640546802, 18947.0, 19295.4211373659, 19344.80655193444, 19357.90321048386, 2391.6532102845163, 2434.440078781872, 2464.297675162588, 2465.506898620283, 2470.295965649781, 119636.0, 124966.0, 126186.0, 126595.0, 132647.33676331557, 14223.217723025125, 14256.35846386915, 14585.308468552505, 14670.579354406616, 14711.74950129251, 22013.0, 22049.779502205092, 22060.117595296328, 22158.113675453125, 22210.444738881335, 9356.111169438893, 9500.809983800285, 9683.612655493702, 9701.126898579161, 9776.120149186465, 8936.24041956441, 8965.282777377794, 8991.730248092568, 9095.590698418588, 9141.588628511732, 8908.287337013024, 9093.909060909305, 9098.499582523025, 9102.544872756336, 9124.58939347731, 2764.9308767280977, 2771.528840097148, 2789.456056069047, 2809.971900281012, 2860.537561404216, 948.9857652135223, 965.4545181972163, 972.1833659725864, 972.4165500699523, 976.9804603907882, 18403.631927361377, 18586.0, 18714.53213669642, 18841.81158188428, 19093.0, 993.64228877604, 1031.0617338222182, 1031.9896801032044, 1039.3815679670583, 1043.3062013760916, 10196.3372380795, 10206.591736330463, 10325.793484130276, 10375.0, 10674.412907290174, 479297.0, 480804.0, 487541.0, 489441.0, 518708.0, 101634.49182754187, 103530.0, 103777.48111259396, 104476.47761761142, 106691.0, 1126.3692332293942, 1136.6362763915467, 1161.517970042423, 1161.9302841829517, 1165.7610189911047, 16426.917865410596, 16482.25829837684, 16742.4140155094, 16814.495565133064, 16842.242099105813, 54017.729911351766, 54733.1790023142, 54738.72630636821, 55219.72390138184, 56247.43752562422, 67027.0, 67110.0, 67932.0, 68281.0, 68659.65670171617, 13729.794053089012, 13930.094543854617, 13935.651608709457, 13988.300584970508, 14010.299485025911, 21258.25596104129, 21315.36053918385, 21347.25284615031, 21366.14535418628, 21605.783942161004, 17291.221895015005, 17510.299588016336, 17610.91194544019, 17694.734578981584, 17715.557111072325, 15742.0, 15831.52505424793, 15865.365385384455, 16022.198890055217, 16029.599260018593, 17606.64786704233, 17692.0, 17891.10544472797, 17967.460976170212, 18015.729764053813, 13780.0, 13795.517156899461, 13803.861961380659, 13822.792658110338, 13834.169949803045, 16052.67894642124, 17471.475855724348, 17476.213570389107, 17485.388011419538, 17493.475195744148], "value": 11558.21803649028, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1310.7050913544451, 1358.0154388068645, 1367.4461842953608, 1379.337917799456, 1384.6469150366654, 15147.545573632795, 15668.216589170524, 15683.92158039211, 15692.843071569281, 15701.607459813496, 15382.769258461132, 15468.845311546882, 15477.613059673513, 15496.535103946871, 15529.14589697569, 2813.9296517587018, 2851.6150319706885, 2856.6714827794863, 2876.5109931311727, 2883.2935930696904, 2769.1969328894597, 2800.705925877784, 2805.424887897986, 2815.1413818785263, 2815.211740712604, 2704.256329509391, 2785.9164225073177, 2786.7770578353784, 2803.481355949156, 2805.8035937484383, 2617.227917764264, 2646.2325925481587, 2650.2711754267634, 2664.6802383713884, 2668.652330573058, 2618.8166828322023, 2635.985145718912, 2665.453582015682, 2669.185898301037, 2676.4245687177154, 14838.629034274121, 15259.465918692793, 15263.38946442141, 15321.080735155927, 15365.923170384189, 7952.443328966975, 8248.051474080497, 8251.587420629005, 8252.0, 8255.958720206421, 5450.126433113177, 5560.138178582326, 5641.12562552805, 5684.147377893308, 5708.372079071299, 1916.559191385989, 1954.8533859960417, 1986.2352994097378, 1994.7307113539632, 2021.6259991901545, 27053.45893082147, 27295.0, 27320.59019114715, 27354.726452735416, 27386.86306568474, 6743.898841517381, 6846.075779769767, 6871.690773915186, 6994.720211191597, 7038.190608080136, 17165.656686866194, 17523.561910952074, 17566.209520571603, 17574.912125439547, 17793.822061779218, 7904.130545639975, 8111.9594402027615, 8125.79685507867, 8146.429749917449, 8151.184881511801, 7366.631668416558, 7369.115706115301, 7494.587797671072, 7515.812104697427, 7517.473776835569, 5108.106081435808, 5214.713190774544, 5237.266782650432, 5288.286081379041, 5321.73391330432, 1521.231777952127, 1528.8700460460987, 1535.2554011304733, 1541.183172918355, 1544.289626771675, 833.6748668019477, 855.2644725536034, 858.6565373850385, 871.6339137562239, 880.5333173418098, 7188.388986936169, 7226.205117437078, 7226.819329516699, 7239.276072392824, 7249.130104387507, 701.5229643842237, 703.4337358426516, 708.6173466328228, 710.1371833222556, 713.7715930902166, 4751.667383283137, 5062.417821950523, 5123.052235336475, 5149.2276158576515, 5200.97399513, 21279.255226067013, 22267.554648907255, 22507.662385064235, 22594.0, 22635.20776772805, 21305.78694213038, 22056.88971555132, 22313.55372892533, 22381.88809055977, 22505.54988900213, 11446.37044962535, 11509.597164099383, 11537.250078744855, 11645.6506304811, 11646.126540509325, 7827.0, 8173.6321865515, 8316.168383161636, 8345.123762004901, 8388.916110838814, 18795.24819007279, 19032.14355353985, 19041.04794760284, 19163.80836191676, 19370.12834422426, 19207.61584768269, 19566.21735130579, 19640.607187856447, 19843.206271749546, 19845.702314465583, 10870.945645272039, 10917.617883374043, 10946.124310055337, 11025.17311201647, 11031.944840275748, 13780.862191378359, 13892.652683682989, 13924.860751392762, 13933.164010159422, 13937.233452160228, 11256.324620522795, 11401.942990284995, 11425.428728563373, 11523.827142593036, 11551.306921584732, 10664.413457259925, 10710.571577136827, 10736.0, 10810.67567972962, 11044.613438529934, 9420.057994200524, 9441.905580944103, 9462.0, 9477.052294770469, 9488.525573721425, 7115.217326094022, 7129.0, 7146.999420081089, 7151.356377926011, 7209.206987231505, 7143.535670181422, 7153.749618763319, 7176.569405835667, 7253.3834624057545, 7291.927080729125], "value": 6642.967356568946, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [487.4989309233971, 494.5736958275175, 518.6861948521145, 518.9429162792093, 519.7842895198493, 6150.630962142269, 6202.875942481148, 6223.751049958002, 6324.683765811703, 6325.557210995232, 6146.354632763562, 6201.193844800169, 6217.616580310882, 6246.625202487854, 6266.404691554307, 5199.6360254782185, 5208.244804503344, 5211.550571231515, 5217.608679349045, 5234.73826308685, 4764.356811830393, 4967.875803104933, 5099.184130539114, 5172.120739474299, 5217.530422261995, 4906.435759887623, 4908.779104940286, 4910.6317026223, 4947.604191664676, 4982.775775090112, 4806.855794326141, 4894.461609222983, 4902.215645496722, 4915.950840491585, 4926.334944782444, 4325.156594464081, 4437.733735975819, 4441.822327106912, 4442.600165985044, 4455.22033644111, 5978.372270911535, 5988.970055149696, 6066.393360663898, 6066.6663333516635, 6089.421504957022, 5564.8052318169075, 5608.971955140239, 5625.25617058709, 5654.434556544354, 5688.0, 6393.8401539961405, 6433.806985790434, 6450.000499845063, 6525.902111468332, 6613.404793568602, 4548.5906268436, 4879.341288925985, 4885.60915126789, 4894.583960363338, 4898.681585696918, 6508.25155107164, 6604.86790264192, 6619.106420633249, 6699.229588597276, 6819.181698196248, 4916.803327866845, 4938.333325001151, 4952.950470495321, 4954.5540901319055, 4987.0, 5043.36957880265, 5045.697258164522, 5050.065737838511, 5063.518965698253, 5087.669301495465, 5614.887702245932, 5623.128415095667, 5669.489745922804, 5679.545636349082, 5710.942890571124, 6542.672866356663, 6553.180852393451, 6556.442702370352, 6571.967140164268, 6634.104395906587, 1708.7949446066552, 1715.0224372108028, 1742.2595396956242, 1771.1941066814568, 1772.273367919147, 1146.9139814513944, 1203.2299328429813, 1218.1777300322246, 1228.766534358469, 1230.9876901230873, 5608.214849921014, 5610.214569960209, 5611.971940140274, 5683.516901063456, 5700.828975130753, 6647.833804154935, 6680.131582894192, 6705.228898676714, 6717.514519627769, 6718.697658605374, 5541.141123125922, 5557.888842223133, 5588.944110558924, 5605.8598535036135, 5616.466435688603, 3417.1969587147, 3476.4090104682264, 3480.982595087059, 3503.8640416827307, 3534.2401383702627, 6361.936380636227, 6403.391677790602, 6408.58344207625, 6436.710348034349, 6440.323766004596, 6587.45194879203, 6628.4697224221945, 6716.932830671631, 6761.638743010731, 6785.1518560179975, 5976.0, 6284.434400904032, 6347.174867267226, 6408.487321014401, 6420.1974753155855, 6358.523110766619, 6420.2937676856445, 6485.0, 6567.376099270562, 6592.670366481752, 6301.243850737941, 6393.6483493408305, 6462.0, 6484.837879053061, 6508.219013718384, 6304.65324407162, 6319.652419116993, 6357.364263573606, 6371.7132729028235, 6374.203224596926, 4892.755362231803, 4893.1436998524405, 4936.851894443173, 4949.034938187019, 5003.299538064601, 6319.5780949286045, 6472.35276472349, 6563.278039415756, 6592.736290548516, 6655.3344665535, 6301.6219026858535, 6365.52258580599, 6411.166548348685, 6440.710168042356, 6481.611103333815, 6176.047329709079, 6224.9377506224355, 6331.240251169889, 6345.921193397226, 6397.488200943821, 6317.557770955989, 6370.140031095742, 6395.560998775239, 6397.680115994089, 6479.092926990131, 6455.257645370654, 6499.837504062436, 6544.411003009752, 6554.934450655433, 6558.934410655832, 6249.500039996698, 6278.372162783685, 6281.59169653971, 6317.473010795718, 6320.4311611955145], "value": 4990.990002753978, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [868.150294178928, 880.1814312689198, 890.2922176869388, 893.5755516129835, 899.9280057595392, 17963.0, 18467.445976620722, 18484.815151848477, 18490.537736556595, 18501.53746156345, 18215.72676409855, 18298.08509574519, 18358.082095895217, 18426.44720658379, 18431.07844607771, 958.7842735384535, 969.6751588217955, 976.4239098931629, 978.5449765858874, 979.4466126638462, 963.802420503795, 967.2020583019003, 969.8254314223437, 970.6457143142737, 970.6893793985927, 979.9069088436622, 1022.4427686910615, 1023.6673081248587, 1024.3751311699857, 1025.9538320775582, 1001.1790331927785, 1001.3791449301407, 1002.9297949143563, 1006.0995409108807, 1013.5489707080352, 707.5966698981582, 731.6414956671193, 738.0700317599809, 739.9001134846834, 740.2856243724777, 19205.90397048006, 19244.903775481034, 19247.711284330748, 19352.32266870653, 19391.709124363006, 20675.379738607866, 20879.26922557703, 21442.46393840151, 21486.355409337746, 21625.567488650297, 15303.923480382638, 15642.0, 15805.0, 15939.681206375808, 15979.440719574759, 3777.7544459610035, 3788.5643151037707, 3808.0, 3816.3321418751884, 3817.1602247505502, 105845.47077264564, 138276.0, 142752.0, 143295.0, 146670.26664866714, 17575.73636395455, 18015.72976405355, 18172.27310907549, 18309.542261443305, 18311.359102431616, 31373.215669608442, 31494.0, 31715.0, 31905.202369940474, 31917.361652766816, 8903.376763626613, 8990.0, 9094.909050909539, 9238.353315267866, 9299.860502092473, 4230.809613567397, 4316.374125751811, 4348.195583817004, 4363.738175709467, 4363.825446982149, 5085.3134826797905, 5118.718470484085, 5160.40655324635, 5173.172292433268, 5216.66091704038, 1091.2361347057092, 1094.5402930769096, 1112.9666110016713, 1117.083991127284, 1122.2985633978763, 631.6368088349218, 665.490899461912, 678.1624693503519, 680.6120511308507, 684.5379368925956, 12037.638870833714, 12144.332061736513, 12383.814242786366, 12664.176828506117, 12804.359782010863, 672.2437258084655, 672.6468603982851, 677.762783025937, 679.5684740190015, 693.4452438049641, 5511.173324001352, 5532.834014979557, 5560.054790685593, 5595.38450770415, 5716.714164291769, 121159.39420303018, 123843.3807830955, 124751.3762431182, 126479.0, 130760.3461982684, 108763.91236087537, 109019.0, 111130.44434777774, 111478.0, 113515.432422839, 93063.53468232615, 94783.0, 97266.0, 97604.99999999857, 97920.0, 10256.897431025594, 10381.9480902595, 10529.526171322463, 10662.200334975063, 10793.29843560166, 45106.0, 45267.0, 45952.31071533997, 46036.30945535753, 46899.296510551685, 57457.425425745205, 60169.09746353896, 60207.39792602018, 60599.394006059374, 61821.0, 15078.698426031198, 15261.160636165117, 15400.537983860502, 15438.5368438947, 15474.5357639271, 17333.306667733148, 17334.39329623457, 17381.913090434467, 17618.11909404499, 17782.288708451517, 14427.062240954305, 14485.771118419181, 14624.707505850036, 14734.410623574937, 14751.92624036873, 15076.698466030399, 15223.314950827018, 15240.466583669519, 15312.846871531588, 15447.2276386178, 14565.635859103608, 14767.852321477078, 14823.0, 14845.109293442429, 14885.25573721288, 11142.220044596801, 11299.71750706206, 11412.715285991731, 11446.942765286454, 11604.94197529007, 12321.507139714311, 12326.198797078161, 12372.876271237172, 12399.318037508023, 12523.561675341683], "value": 8876.254849047915, "unit": "score"}]}, {"extraOptions": ["e10s", "stylo_disabled"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1423.3, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [108.0, 108.0, 107.0, 110.0, 111.0, 107.0, 108.0, 107.0, 108.0, 108.0], "value": 108.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 116.0, 149.0, 117.0, 119.0, 116.0, 116.0, 118.0], "value": 120.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 163.0, 161.0, 162.0, 164.0, 163.0, 167.0, 163.0, 170.0], "value": 163.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 74.0, 75.0, 80.0, 74.0, 74.0, 73.0, 73.0, 77.0, 76.0], "value": 75.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 79.0, 78.0, 79.0, 78.0, 78.0, 80.0, 80.0, 79.0, 78.0], "value": 78.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 113.0, 114.0, 114.0, 116.0, 114.0, 115.0, 114.0, 114.0, 114.0], "value": 114.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [156.0, 147.0, 148.0, 147.0, 149.0, 148.0, 149.0, 148.0, 148.0, 150.0], "value": 149.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 94.0, 94.0, 94.0, 93.0, 93.0, 94.0, 95.0, 95.0, 94.0], "value": 93.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 53.0, 53.0, 54.0, 54.0, 51.0, 51.0, 52.0, 53.0, 53.0], "value": 52.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [38.0, 39.0, 38.0, 38.0, 38.0, 38.0, 39.0, 38.0, 39.0, 38.0], "value": 38.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 83.0, 79.0, 75.0, 76.0, 76.0, 77.0, 77.0, 75.0, 74.0], "value": 76.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 112.0, 115.0, 114.0, 117.0, 113.0, 127.0, 119.0, 111.0, 119.0], "value": 116.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [177.0, 167.0, 166.0, 168.0, 176.0, 165.0, 168.0, 169.0, 167.0, 173.0], "value": 169.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 70.0, 67.0, 65.0, 65.0, 66.0, 64.0, 65.0, 64.0, 69.0], "value": 66.5, "unit": "score"}]}]} 12:28:00 INFO - Return code: 0 12:28:00 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 12:28:00 INFO - # TBPL SUCCESS # 12:28:00 INFO - Running post-action listener: _package_coverage_data 12:28:00 INFO - Running post-action listener: _resource_record_post_action 12:28:00 INFO - [mozharness: 2017-09-15 19:28:00.571473Z] Finished run-tests step (success) 12:28:00 INFO - Running post-run listener: _resource_record_post_run 12:28:00 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 8192; Write bytes: 344027136; Read time: 16; Write time: 188524 12:28:00 INFO - TinderboxPrint: CPU usage
13.1% 12:28:00 INFO - TinderboxPrint: I/O read bytes / time
8,192 / 16 12:28:00 INFO - TinderboxPrint: I/O write bytes / time
344,027,136 / 188,524 12:28:00 INFO - TinderboxPrint: CPU idle
8,230.6 (86.9%) 12:28:00 INFO - TinderboxPrint: CPU user
1,193.6 (12.6%) 12:28:00 INFO - TinderboxPrint: Swap in / out
0 / 0 12:28:00 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 13062144; Read time: 0; Write time: 1256 12:28:00 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 12:28:00 INFO - run-tests - Wall time: 1171s; CPU: 13.0%; Read bytes: 4096; Write bytes: 330964992; Read time: 8; Write time: 187268 12:28:01 INFO - Running post-run listener: _upload_blobber_files 12:28:01 INFO - Blob upload gear active. 12:28:01 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 12:28: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 12:28: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'] 12:28: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 12:28:01 INFO - (blobuploader) - INFO - Open directory for files ... 12:28:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_raw.log ... 12:28:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:28:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:28:02 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_raw.log: uploaded 12:28:02 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:28:02 INFO - (blobuploader) - INFO - Done attempting. 12:28:02 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-stylo-disabled-e10s_errorsummary.log ... 12:28:02 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:28:02 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:28:03 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-stylo-disabled-e10s_errorsummary.log: uploaded 12:28:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:28:03 INFO - (blobuploader) - INFO - Done attempting. 12:28:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 12:28:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:28:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:28:10 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 12:28:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:28:10 INFO - (blobuploader) - INFO - Done attempting. 12:28:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 12:28:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:28:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:28:11 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 12:28:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:28:11 INFO - (blobuploader) - INFO - Done attempting. 12:28:11 INFO - (blobuploader) - INFO - Iteration through files over. 12:28:11 INFO - Return code: 0 12:28:11 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 12:28:11 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 12:28:11 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/9e82e7171008dc7b5abc84218d8619fb723c2e82643dce0b7c942bf3136716fa39fba4dfc0f6ee139b6475be16ab8f776396e617686dfcfa167e57d4a9359f78", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/36b9787465fe111357efaf435104a70b7e38ad6f9c946032632e43c27f60ccff876519121481dde937cdbac14832c5191043d0bd26dea08321281d9fbd330580", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/523e7dbe4df87042a25ab6421958b5cc7aa80c59fd1be63755730052ca91f084726f48915eca2ea13df3cb1b61c8829508ed75a867fda240058ef3ec2d27c60f", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/67be06076787be2ba2f0dcb1279f6d98a1901d5da03ee0578d3d86569c9eace2e6d6b0d134526171e1b1c8dfb82cac871710f5c2bb1365c69473cd47006d4637"} 12:28:11 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 12:28:11 INFO - Writing to file /builds/slave/test/properties/blobber_files 12:28:11 INFO - Contents: 12:28:11 INFO - blobber_files:{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/9e82e7171008dc7b5abc84218d8619fb723c2e82643dce0b7c942bf3136716fa39fba4dfc0f6ee139b6475be16ab8f776396e617686dfcfa167e57d4a9359f78", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/36b9787465fe111357efaf435104a70b7e38ad6f9c946032632e43c27f60ccff876519121481dde937cdbac14832c5191043d0bd26dea08321281d9fbd330580", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/523e7dbe4df87042a25ab6421958b5cc7aa80c59fd1be63755730052ca91f084726f48915eca2ea13df3cb1b61c8829508ed75a867fda240058ef3ec2d27c60f", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/67be06076787be2ba2f0dcb1279f6d98a1901d5da03ee0578d3d86569c9eace2e6d6b0d134526171e1b1c8dfb82cac871710f5c2bb1365c69473cd47006d4637"} 12:28:11 INFO - Running post-run listener: copy_logs_to_upload_dir 12:28:11 INFO - Copying logs to upload dir... 12:28:11 INFO - mkdir: /builds/slave/test/build/upload/logs 12:28:11 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1240.266320 ========= master_lag: 1.11 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2017-09-15 12:28:12.995843) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-15 12:28:12.999082) ========= 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=7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401 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/9e82e7171008dc7b5abc84218d8619fb723c2e82643dce0b7c942bf3136716fa39fba4dfc0f6ee139b6475be16ab8f776396e617686dfcfa167e57d4a9359f78", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/36b9787465fe111357efaf435104a70b7e38ad6f9c946032632e43c27f60ccff876519121481dde937cdbac14832c5191043d0bd26dea08321281d9fbd330580", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/523e7dbe4df87042a25ab6421958b5cc7aa80c59fd1be63755730052ca91f084726f48915eca2ea13df3cb1b61c8829508ed75a867fda240058ef3ec2d27c60f", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/67be06076787be2ba2f0dcb1279f6d98a1901d5da03ee0578d3d86569c9eace2e6d6b0d134526171e1b1c8dfb82cac871710f5c2bb1365c69473cd47006d4637"} build_url:https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011348 build_url: 'https://queue.taskcluster.net/v1/task/SAlNeWrsQmaSXz_lbxgWHA/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/9e82e7171008dc7b5abc84218d8619fb723c2e82643dce0b7c942bf3136716fa39fba4dfc0f6ee139b6475be16ab8f776396e617686dfcfa167e57d4a9359f78", "dromaeojs-stylo-disabled-e10s_raw.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/36b9787465fe111357efaf435104a70b7e38ad6f9c946032632e43c27f60ccff876519121481dde937cdbac14832c5191043d0bd26dea08321281d9fbd330580", "dromaeojs-stylo-disabled-e10s_errorsummary.log": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/523e7dbe4df87042a25ab6421958b5cc7aa80c59fd1be63755730052ca91f084726f48915eca2ea13df3cb1b61c8829508ed75a867fda240058ef3ec2d27c60f", "resource-usage.json": "https://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/67be06076787be2ba2f0dcb1279f6d98a1901d5da03ee0578d3d86569c9eace2e6d6b0d134526171e1b1c8dfb82cac871710f5c2bb1365c69473cd47006d4637"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-09-15 12:28:13.027304) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 12:28:13.027635) ========= 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=7fc86f70bae03e018da0b1d8000001c4-1505500935.183008-114423401 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004532 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-09-15 12:28:13.077820) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-15 12:28:13.078138) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-09-15 12:28:13.078448) ========= ========= Total master_lag: 1.24 =========