builder: mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s slave: talos-linux64-ix-044 starttime: 1493845299.87 results: success (0) revision: 96605941c0021795376d9c6ec1e458de2fac329e ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:39.869137) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:39.869650) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:39.869925) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:39.885507) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:39.885905) ========= 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=88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-05-03 14:01:39-- 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.3M=0s 2017-05-03 14:01:40 (46.3 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.307392 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:40.209800) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:40.210330) ========= 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=88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017270 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:40.260310) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-05-03 14:01:40.260670) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 96605941c0021795376d9c6ec1e458de2fac329e --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 96605941c0021795376d9c6ec1e458de2fac329e --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=88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-05-03 14:01:40,369 truncating revision to first 12 chars 2017-05-03 14:01:40,369 Setting DEBUG logging. 2017-05-03 14:01:40,369 attempt 1/10 2017-05-03 14:01:40,369 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/96605941c002?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-03 14:01:41,115 unpacking tar archive at: mozilla-central-96605941c002/testing/mozharness/ program finished with exit code 0 elapsedTime=1.072576 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-05-03 14:01:41.347228) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:41.347598) ========= script_repo_revision: 96605941c0021795376d9c6ec1e458de2fac329e ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:41.348009) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:41.348356) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-03 14:01:41.358468) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 52 secs) (at 2017-05-03 14:01:41.358879) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 14:01:41 INFO - MultiFileLogger online at 20170503 14:01:41 in /builds/slave/test 14:01:41 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 14:01:41 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 14:01:41 INFO - {'append_to_log': False, 14:01:41 INFO - 'base_work_dir': '/builds/slave/test', 14:01:41 INFO - 'blob_upload_branch': 'Firefox', 14:01:41 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 14:01:41 INFO - 'branch': 'Firefox', 14:01:41 INFO - 'buildbot_json_path': 'buildprops.json', 14:01:41 INFO - 'config_files': ('talos/linux_config.py',), 14:01:41 INFO - 'default_actions': ('clobber', 14:01:41 INFO - 'read-buildbot-config', 14:01:41 INFO - 'download-and-extract', 14:01:41 INFO - 'populate-webroot', 14:01:41 INFO - 'create-virtualenv', 14:01:41 INFO - 'install', 14:01:41 INFO - 'run-tests'), 14:01:41 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 14:01:41 INFO - 'download_minidump_stackwalk': True, 14:01:41 INFO - 'download_symbols': 'ondemand', 14:01:41 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 14:01:41 INFO - 'tooltool.py': '/tools/tooltool.py', 14:01:41 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 14:01:41 INFO - '/tools/misc-python/virtualenv.py')}, 14:01:41 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 14:01:41 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 14:01:41 INFO - 'gecko_profile': False, 14:01:41 INFO - 'gecko_profile_interval': 0, 14:01:41 INFO - 'installer_path': 'installer.exe', 14:01:41 INFO - 'log_level': 'info', 14:01:41 INFO - 'log_name': 'talos', 14:01:41 INFO - 'log_to_console': True, 14:01:41 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 14:01:41 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 14:01:41 INFO - 'opt_config_files': (), 14:01:41 INFO - 'pip_index': False, 14:01:41 INFO - 'suite': 'dromaeojs-e10s', 14:01:41 INFO - 'system_bits': '32', 14:01:41 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 14:01:41 INFO - 'title': 'talos-linux64-ix-044', 14:01:41 INFO - 'tooltool_cache': '/builds/tooltool_cache', 14:01:41 INFO - 'use_talos_json': True, 14:01:41 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 14:01:41 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 14:01:41 INFO - 'work_dir': 'build'} 14:01:41 INFO - [mozharness: 2017-05-03 21:01:41.564570Z] Running clobber step. 14:01:41 INFO - Running pre-action listener: _resource_record_pre_action 14:01:41 INFO - Running main action method: clobber 14:01:41 INFO - rmtree: /builds/slave/test/build 14:01:41 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 14:01:42 INFO - Running post-action listener: _resource_record_post_action 14:01:42 INFO - [mozharness: 2017-05-03 21:01:42.575913Z] Finished clobber step (success) 14:01:42 INFO - [mozharness: 2017-05-03 21:01:42.576013Z] Running read-buildbot-config step. 14:01:42 INFO - Running pre-action listener: _resource_record_pre_action 14:01:42 INFO - Running main action method: read_buildbot_config 14:01:42 INFO - Using buildbot properties: 14:01:42 INFO - { 14:01:42 INFO - "project": "", 14:01:42 INFO - "product": "firefox", 14:01:42 INFO - "who": "kwierso@gmail.com", 14:01:42 INFO - "installer_path": "public/build/target.tar.bz2", 14:01:42 INFO - "builddir": "mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s", 14:01:42 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 14:01:42 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo mozilla-central talos dromaeojs-e10s", 14:01:42 INFO - "stage_platform": "linux64-stylo", 14:01:42 INFO - "basedir": "/builds/slave/test", 14:01:42 INFO - "buildnumber": 69, 14:01:42 INFO - "platform": "ubuntu64_hw_stylo", 14:01:42 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 14:01:42 INFO - "slavebuilddir": "test", 14:01:42 INFO - "taskId": "ecIdcM6kQlOFj4EWfz3WBA", 14:01:42 INFO - "branch": "mozilla-central", 14:01:42 INFO - "script_repo_revision": "production", 14:01:42 INFO - "revision": "96605941c0021795376d9c6ec1e458de2fac329e", 14:01:42 INFO - "slavename": "talos-linux64-ix-044", 14:01:42 INFO - "repo_path": "mozilla-central" 14:01:42 INFO - } 14:01:42 INFO - Finding installer, test and symbols from parent task. 14:01:42 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ecIdcM6kQlOFj4EWfz3WBA'}, attempt #1 14:01:43 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/ecIdcM6kQlOFj4EWfz3WBA'}, attempt #1 14:01:43 INFO - Task dependencies: XhHz6DzcQdeZf8Dv3qufRw 14:01:43 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw'}, attempt #1 14:01:44 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.tar.bz2 14:01:44 INFO - Set test_url: https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/test_packages.json 14:01:44 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.crashreporter-symbols.zip 14:01:44 INFO - Running post-action listener: _resource_record_post_action 14:01:44 INFO - [mozharness: 2017-05-03 21:01:44.036489Z] Finished read-buildbot-config step (success) 14:01:44 INFO - [mozharness: 2017-05-03 21:01:44.036707Z] Running download-and-extract step. 14:01:44 INFO - Running pre-action listener: _resource_record_pre_action 14:01:44 INFO - Running main action method: download_and_extract 14:01:44 INFO - mkdir: /builds/slave/test/build/tests 14:01:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:01:44 INFO - trying https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.test_packages.json 14:01:44 INFO - Downloading https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 14:01:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 14:01:44 INFO - Downloaded 986 bytes. 14:01:44 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 14:01:44 INFO - Using the following test package requirements: 14:01:44 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 14:01:44 INFO - u'common': [u'target.common.tests.zip'], 14:01:44 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 14:01:44 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 14:01:44 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 14:01:44 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 14:01:44 INFO - u'mozbase': [u'target.common.tests.zip'], 14:01:44 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 14:01:44 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 14:01:44 INFO - u'web-platform': [u'target.common.tests.zip', 14:01:44 INFO - u'target.web-platform.tests.zip'], 14:01:44 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 14:01:44 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 14:01:44 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.common.tests.zip 14:01:44 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.common.tests.zip'}, attempt #1 14:01:44 INFO - Fetch https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.common.tests.zip into memory 14:01:45 INFO - Content-Length response header: 58441168 14:01:45 INFO - Bytes received: 58441168 14:01:55 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 14:01:55 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.common.tests.zip 14:01:55 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.common.tests.zip'}, attempt #1 14:01:55 INFO - Fetch https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.common.tests.zip into memory 14:01:56 INFO - Content-Length response header: 58441168 14:01:56 INFO - Bytes received: 58441168 14:02:07 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.talos.tests.zip 14:02:07 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 14:02:07 INFO - Fetch https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.talos.tests.zip into memory 14:02:08 INFO - Content-Length response header: 14408809 14:02:08 INFO - Bytes received: 14408809 14:02:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:08 INFO - trying https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.tar.bz2 14:02:08 INFO - Downloading https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 14:02:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 14:02:09 INFO - Downloaded 59992765 bytes. 14:02:09 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.tar.bz2 14:02:09 INFO - mkdir: /builds/slave/test/properties 14:02:09 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 14:02:09 INFO - Writing to file /builds/slave/test/properties/build_url 14:02:09 INFO - Contents: 14:02:09 INFO - build_url:https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.tar.bz2 14:02:09 INFO - Running post-action listener: _resource_record_post_action 14:02:09 INFO - Running post-action listener: set_extra_try_arguments 14:02:09 INFO - [mozharness: 2017-05-03 21:02:09.615663Z] Finished download-and-extract step (success) 14:02:09 INFO - [mozharness: 2017-05-03 21:02:09.615760Z] Running populate-webroot step. 14:02:09 INFO - Running pre-action listener: _resource_record_pre_action 14:02:09 INFO - Running main action method: populate_webroot 14:02:09 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 14:02:09 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 14:02:09 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 14:02:09 INFO - '--tppagecycles', 14:02:09 INFO - '7'], 14:02:09 INFO - 'tests': ['tsvgm']}}, 14:02:09 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['tresize', 'tcanvasmark']}, 14:02:09 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 14:02:09 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['dromaeo_css', 'kraken']}, 14:02:09 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 14:02:09 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 14:02:09 INFO - 'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:02:09 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 14:02:09 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:02:09 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 14:02:09 INFO - 'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['damp', 'tps']}, 14:02:09 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 14:02:09 INFO - 'tests': ['damp', 'tps']}, 14:02:09 INFO - 'g3': {'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['dromaeo_dom']}, 14:02:09 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 14:02:09 INFO - 'g4': {'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 14:02:09 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 14:02:09 INFO - 'other': {'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['a11yr', 14:02:09 INFO - 'ts_paint', 14:02:09 INFO - 'tpaint', 14:02:09 INFO - 'sessionrestore', 14:02:09 INFO - 'sessionrestore_no_auto_restore', 14:02:09 INFO - 'tabpaint']}, 14:02:09 INFO - 'other-e10s': {'tests': ['a11yr', 14:02:09 INFO - 'ts_paint', 14:02:09 INFO - 'tpaint', 14:02:09 INFO - 'sessionrestore', 14:02:09 INFO - 'sessionrestore_no_auto_restore', 14:02:09 INFO - 'tabpaint']}, 14:02:09 INFO - 'other-e10s_l64': {'tests': ['a11yr', 14:02:09 INFO - 'ts_paint', 14:02:09 INFO - 'tpaint', 14:02:09 INFO - 'sessionrestore', 14:02:09 INFO - 'sessionrestore_no_auto_restore', 14:02:09 INFO - 'tabpaint']}, 14:02:09 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 14:02:09 INFO - 'ts_paint', 14:02:09 INFO - 'tpaint', 14:02:09 INFO - 'sessionrestore', 14:02:09 INFO - 'sessionrestore_no_auto_restore', 14:02:09 INFO - 'tabpaint']}, 14:02:09 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['a11yr', 14:02:09 INFO - 'ts_paint', 14:02:09 INFO - 'tpaint', 14:02:09 INFO - 'sessionrestore', 14:02:09 INFO - 'sessionrestore_no_auto_restore', 14:02:09 INFO - 'tabpaint']}, 14:02:09 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['a11yr', 14:02:09 INFO - 'ts_paint', 14:02:09 INFO - 'tpaint', 14:02:09 INFO - 'sessionrestore', 14:02:09 INFO - 'sessionrestore_no_auto_restore', 14:02:09 INFO - 'tabpaint']}, 14:02:09 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 14:02:09 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 14:02:09 INFO - 'bloom_basic_ref']}, 14:02:09 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['tsvgx', 14:02:09 INFO - 'tsvgr_opacity', 14:02:09 INFO - 'tart', 14:02:09 INFO - 'tscrollx', 14:02:09 INFO - 'cart', 14:02:09 INFO - 'tsvg_static']}, 14:02:09 INFO - 'svgr-e10s': {'tests': ['tsvgx', 14:02:09 INFO - 'tsvgr_opacity', 14:02:09 INFO - 'tart', 14:02:09 INFO - 'tscrollx', 14:02:09 INFO - 'cart', 14:02:09 INFO - 'tsvg_static']}, 14:02:09 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 14:02:09 INFO - 'talos_options': ['--disable-e10s'], 14:02:09 INFO - 'tests': ['tp5o']}, 14:02:09 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 14:02:09 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 14:02:09 INFO - 'talos_options': ['--disable-e10s', 14:02:09 INFO - '--xperf_path', 14:02:09 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:02:09 INFO - 'tests': ['tp5n']}, 14:02:09 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 14:02:09 INFO - 'talos_options': ['--xperf_path', 14:02:09 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:02:09 INFO - 'tests': ['tp5n']}}, 14:02:09 INFO - 'talos.zip': {'path': '', 14:02:09 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 14:02:09 INFO - Running post-action listener: _resource_record_post_action 14:02:09 INFO - [mozharness: 2017-05-03 21:02:09.629527Z] Finished populate-webroot step (success) 14:02:09 INFO - [mozharness: 2017-05-03 21:02:09.629617Z] Running create-virtualenv step. 14:02:09 INFO - Running pre-action listener: _resource_record_pre_action 14:02:09 INFO - Running main action method: create_virtualenv 14:02:09 INFO - Creating virtualenv /builds/slave/test/build/venv 14:02:09 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 14:02:09 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 14:02:09 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 14:02:09 INFO - Using real prefix '/usr' 14:02:09 INFO - New python executable in /builds/slave/test/build/venv/bin/python 14:02:10 INFO - Installing distribute.............................................................................................................................................................................................done. 14:02:12 INFO - Installing pip.................done. 14:02:12 INFO - Return code: 0 14:02:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 14:02:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 14:02:12 INFO - Reading from file tmpfile_stdout 14:02:12 INFO - Output received: 14:02:12 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 14:02:12 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 14:02:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:02:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:02:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:12 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1b2b1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c23a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc8b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, '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': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', '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 14:02:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 14:02:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 14:02:12 INFO - Using env: {'DISPLAY': ':0', 14:02:12 INFO - 'HOME': '/home/cltbld', 14:02:12 INFO - 'LANG': 'en_US.UTF-8', 14:02:12 INFO - 'LANGUAGE': 'en_US:en', 14:02:12 INFO - 'LOGNAME': 'cltbld', 14:02:12 INFO - 'MAIL': '/var/mail/cltbld', 14:02:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:12 INFO - 'MOZ_NO_REMOTE': '1', 14:02:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:12 INFO - 'NO_EM_RESTART': '1', 14:02:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:12 INFO - 'PWD': '/builds/slave/test', 14:02:12 INFO - 'SHELL': '/bin/bash', 14:02:12 INFO - 'SHLVL': '1', 14:02:12 INFO - 'TERM': 'linux', 14:02:12 INFO - 'TMOUT': '86400', 14:02:12 INFO - 'USER': 'cltbld', 14:02:12 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:12 INFO - '_': '/tools/buildbot/bin/python'} 14:02:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:02:12 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 14:02:12 INFO - Cleaning up... 14:02:12 INFO - Return code: 0 14:02:12 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 14:02:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:02:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:02:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:12 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1b2b1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c23a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc8b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, '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': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', '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 14:02:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 14:02:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 14:02:12 INFO - Using env: {'DISPLAY': ':0', 14:02:12 INFO - 'HOME': '/home/cltbld', 14:02:12 INFO - 'LANG': 'en_US.UTF-8', 14:02:12 INFO - 'LANGUAGE': 'en_US:en', 14:02:12 INFO - 'LOGNAME': 'cltbld', 14:02:12 INFO - 'MAIL': '/var/mail/cltbld', 14:02:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:12 INFO - 'MOZ_NO_REMOTE': '1', 14:02:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:12 INFO - 'NO_EM_RESTART': '1', 14:02:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:12 INFO - 'PWD': '/builds/slave/test', 14:02:12 INFO - 'SHELL': '/bin/bash', 14:02:12 INFO - 'SHLVL': '1', 14:02:12 INFO - 'TERM': 'linux', 14:02:12 INFO - 'TMOUT': '86400', 14:02:12 INFO - 'USER': 'cltbld', 14:02:12 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:12 INFO - '_': '/tools/buildbot/bin/python'} 14:02:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:02:12 INFO - Downloading/unpacking psutil>=3.1.1 14:02:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:02:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:02:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:02:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:02:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 14:02:14 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:02:14 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:02:14 INFO - Installing collected packages: psutil 14:02:14 INFO - Running setup.py install for psutil 14:02:14 INFO - building 'psutil._psutil_linux' extension 14:02:14 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 14:02:14 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 14:02:14 INFO - building 'psutil._psutil_posix' extension 14:02:14 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 14:02:14 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 14:02:14 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:02:14 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:02:14 INFO - Successfully installed psutil 14:02:14 INFO - Cleaning up... 14:02:14 INFO - Return code: 0 14:02:14 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 14:02:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:02:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:02:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:14 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1b2b1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c23a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc8b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, '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': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', '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 14:02:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 14:02:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 14:02:14 INFO - Using env: {'DISPLAY': ':0', 14:02:14 INFO - 'HOME': '/home/cltbld', 14:02:14 INFO - 'LANG': 'en_US.UTF-8', 14:02:14 INFO - 'LANGUAGE': 'en_US:en', 14:02:14 INFO - 'LOGNAME': 'cltbld', 14:02:14 INFO - 'MAIL': '/var/mail/cltbld', 14:02:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:14 INFO - 'MOZ_NO_REMOTE': '1', 14:02:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:14 INFO - 'NO_EM_RESTART': '1', 14:02:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:14 INFO - 'PWD': '/builds/slave/test', 14:02:14 INFO - 'SHELL': '/bin/bash', 14:02:14 INFO - 'SHLVL': '1', 14:02:14 INFO - 'TERM': 'linux', 14:02:14 INFO - 'TMOUT': '86400', 14:02:14 INFO - 'USER': 'cltbld', 14:02:14 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:14 INFO - '_': '/tools/buildbot/bin/python'} 14:02:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:02:14 INFO - Downloading/unpacking mozsystemmonitor==0.3 14:02:14 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 14:02:14 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 14:02:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:14 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 14:02:14 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 14:02:15 INFO - Downloading mozsystemmonitor-0.3.tar.gz 14:02:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 14:02:15 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 14:02:15 INFO - Installing collected packages: mozsystemmonitor 14:02:15 INFO - Running setup.py install for mozsystemmonitor 14:02:15 INFO - Successfully installed mozsystemmonitor 14:02:15 INFO - Cleaning up... 14:02:16 INFO - Return code: 0 14:02:16 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 14:02:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:02:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:02:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:16 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1b2b1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c23a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc8b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, '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': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', '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 14:02:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 14:02:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 14:02:16 INFO - Using env: {'DISPLAY': ':0', 14:02:16 INFO - 'HOME': '/home/cltbld', 14:02:16 INFO - 'LANG': 'en_US.UTF-8', 14:02:16 INFO - 'LANGUAGE': 'en_US:en', 14:02:16 INFO - 'LOGNAME': 'cltbld', 14:02:16 INFO - 'MAIL': '/var/mail/cltbld', 14:02:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:16 INFO - 'MOZ_NO_REMOTE': '1', 14:02:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:16 INFO - 'NO_EM_RESTART': '1', 14:02:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:16 INFO - 'PWD': '/builds/slave/test', 14:02:16 INFO - 'SHELL': '/bin/bash', 14:02:16 INFO - 'SHLVL': '1', 14:02:16 INFO - 'TERM': 'linux', 14:02:16 INFO - 'TMOUT': '86400', 14:02:16 INFO - 'USER': 'cltbld', 14:02:16 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:16 INFO - '_': '/tools/buildbot/bin/python'} 14:02:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:02:16 INFO - Downloading/unpacking jsonschema==2.5.1 14:02:16 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 14:02:16 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 14:02:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:16 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 14:02:16 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 14:02:17 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 14:02:17 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 14:02:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:02:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:02:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:02:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:02:17 INFO - Downloading functools32-3.2.3-2.tar.gz 14:02:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 14:02:17 INFO - warning: no files found matching '*.txt' 14:02:17 INFO - no previously-included directories found matching 'build' 14:02:17 INFO - no previously-included directories found matching 'dist' 14:02:17 INFO - no previously-included directories found matching '.git*' 14:02:17 INFO - Installing collected packages: jsonschema, functools32 14:02:17 INFO - Running setup.py install for functools32 14:02:17 INFO - warning: no files found matching '*.txt' 14:02:17 INFO - no previously-included directories found matching 'build' 14:02:17 INFO - no previously-included directories found matching 'dist' 14:02:17 INFO - no previously-included directories found matching '.git*' 14:02:17 INFO - Successfully installed jsonschema functools32 14:02:17 INFO - Cleaning up... 14:02:17 INFO - Return code: 0 14:02:17 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 14:02:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:02:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:02:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:17 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1b2b1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c23a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc8b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, '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': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', '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 14:02:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 14:02:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 14:02:17 INFO - Using env: {'DISPLAY': ':0', 14:02:17 INFO - 'HOME': '/home/cltbld', 14:02:17 INFO - 'LANG': 'en_US.UTF-8', 14:02:17 INFO - 'LANGUAGE': 'en_US:en', 14:02:17 INFO - 'LOGNAME': 'cltbld', 14:02:17 INFO - 'MAIL': '/var/mail/cltbld', 14:02:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:17 INFO - 'MOZ_NO_REMOTE': '1', 14:02:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:17 INFO - 'NO_EM_RESTART': '1', 14:02:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:17 INFO - 'PWD': '/builds/slave/test', 14:02:17 INFO - 'SHELL': '/bin/bash', 14:02:17 INFO - 'SHLVL': '1', 14:02:17 INFO - 'TERM': 'linux', 14:02:17 INFO - 'TMOUT': '86400', 14:02:17 INFO - 'USER': 'cltbld', 14:02:17 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:17 INFO - '_': '/tools/buildbot/bin/python'} 14:02:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:02:18 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 14:02:18 INFO - Cleaning up... 14:02:18 INFO - Return code: 0 14:02:18 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 14:02:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:02:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:02:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:18 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1b2b1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c23a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc8b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, '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': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', '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 14:02:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 14:02:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 14:02:18 INFO - Using env: {'DISPLAY': ':0', 14:02:18 INFO - 'HOME': '/home/cltbld', 14:02:18 INFO - 'LANG': 'en_US.UTF-8', 14:02:18 INFO - 'LANGUAGE': 'en_US:en', 14:02:18 INFO - 'LOGNAME': 'cltbld', 14:02:18 INFO - 'MAIL': '/var/mail/cltbld', 14:02:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:18 INFO - 'MOZ_NO_REMOTE': '1', 14:02:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:18 INFO - 'NO_EM_RESTART': '1', 14:02:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:18 INFO - 'PWD': '/builds/slave/test', 14:02:18 INFO - 'SHELL': '/bin/bash', 14:02:18 INFO - 'SHLVL': '1', 14:02:18 INFO - 'TERM': 'linux', 14:02:18 INFO - 'TMOUT': '86400', 14:02:18 INFO - 'USER': 'cltbld', 14:02:18 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:18 INFO - '_': '/tools/buildbot/bin/python'} 14:02:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:02:18 INFO - Downloading/unpacking blobuploader==1.2.4 14:02:18 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 14:02:18 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 14:02:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:18 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 14:02:18 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 14:02:19 INFO - Downloading blobuploader-1.2.4.tar.gz 14:02:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 14:02:19 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 14:02:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:02:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:02:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:02:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:02:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 14:02:19 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 14:02:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:02:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:02:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:02:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:02:19 INFO - Downloading docopt-0.6.1.tar.gz 14:02:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 14:02:20 INFO - Installing collected packages: blobuploader, requests, docopt 14:02:20 INFO - Running setup.py install for blobuploader 14:02:20 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 14:02:20 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 14:02:20 INFO - Running setup.py install for requests 14:02:20 INFO - Running setup.py install for docopt 14:02:20 INFO - Successfully installed blobuploader requests docopt 14:02:20 INFO - Cleaning up... 14:02:20 INFO - Return code: 0 14:02:20 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:02:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:02:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:02:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:20 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1b2b1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c23a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc8b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, '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': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', '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 14:02:20 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 14:02:20 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 14:02:20 INFO - Using env: {'DISPLAY': ':0', 14:02:20 INFO - 'HOME': '/home/cltbld', 14:02:20 INFO - 'LANG': 'en_US.UTF-8', 14:02:20 INFO - 'LANGUAGE': 'en_US:en', 14:02:20 INFO - 'LOGNAME': 'cltbld', 14:02:20 INFO - 'MAIL': '/var/mail/cltbld', 14:02:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:20 INFO - 'MOZ_NO_REMOTE': '1', 14:02:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:20 INFO - 'NO_EM_RESTART': '1', 14:02:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:20 INFO - 'PWD': '/builds/slave/test', 14:02:20 INFO - 'SHELL': '/bin/bash', 14:02:20 INFO - 'SHLVL': '1', 14:02:20 INFO - 'TERM': 'linux', 14:02:20 INFO - 'TMOUT': '86400', 14:02:20 INFO - 'USER': 'cltbld', 14:02:20 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:20 INFO - '_': '/tools/buildbot/bin/python'} 14:02:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:02:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:02:20 INFO - Running setup.py (path:/tmp/pip-WyUgA3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:02:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:02:20 INFO - Running setup.py (path:/tmp/pip-bIYicw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:02:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:02:20 INFO - Running setup.py (path:/tmp/pip-9_3QUk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:02:21 INFO - Running setup.py (path:/tmp/pip-4CiFJf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:02:21 INFO - Running setup.py (path:/tmp/pip-1qlxUD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:02:21 INFO - Running setup.py (path:/tmp/pip-6NDBQ9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:02:21 INFO - Running setup.py (path:/tmp/pip-p5JdOh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:02:21 INFO - Running setup.py (path:/tmp/pip-afoUhF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:02:21 INFO - Running setup.py (path:/tmp/pip-7gjVN4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:02:21 INFO - Running setup.py (path:/tmp/pip-SqlVxU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:02:21 INFO - Running setup.py (path:/tmp/pip-iW3MTS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:02:21 INFO - Running setup.py (path:/tmp/pip-mq_m1F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:02:21 INFO - Running setup.py (path:/tmp/pip-s2ktek-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:02:21 INFO - Running setup.py (path:/tmp/pip-NQlTyU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:02:21 INFO - Running setup.py (path:/tmp/pip-TLqH_A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:02:21 INFO - Running setup.py (path:/tmp/pip-mIZYxw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:02:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:02:21 INFO - Running setup.py (path:/tmp/pip-rgp3aB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:02:22 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 14:02:22 INFO - Running setup.py install for manifestparser 14:02:22 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 14:02:22 INFO - Running setup.py install for mozcrash 14:02:22 INFO - Running setup.py install for mozdebug 14:02:22 INFO - Running setup.py install for mozdevice 14:02:22 INFO - Installing dm script to /builds/slave/test/build/venv/bin 14:02:22 INFO - Running setup.py install for mozfile 14:02:22 INFO - Running setup.py install for mozhttpd 14:02:22 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 14:02:22 INFO - Running setup.py install for mozinfo 14:02:22 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 14:02:22 INFO - Running setup.py install for mozInstall 14:02:22 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 14:02:22 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 14:02:22 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 14:02:22 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 14:02:22 INFO - Running setup.py install for mozleak 14:02:22 INFO - Running setup.py install for mozlog 14:02:23 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 14:02:23 INFO - Running setup.py install for moznetwork 14:02:23 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 14:02:23 INFO - Running setup.py install for mozprocess 14:02:23 INFO - Running setup.py install for mozprofile 14:02:23 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 14:02:23 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 14:02:23 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 14:02:23 INFO - Running setup.py install for mozrunner 14:02:23 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 14:02:23 INFO - Running setup.py install for mozscreenshot 14:02:23 INFO - Running setup.py install for moztest 14:02:23 INFO - Running setup.py install for mozversion 14:02:23 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 14:02:23 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 14:02:23 INFO - Cleaning up... 14:02:23 INFO - Return code: 0 14:02:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:02:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:02:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:02:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:23 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1b2b1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c23a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc8b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, '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': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', '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 14:02:23 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 14:02:23 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 14:02:23 INFO - Using env: {'DISPLAY': ':0', 14:02:23 INFO - 'HOME': '/home/cltbld', 14:02:23 INFO - 'LANG': 'en_US.UTF-8', 14:02:23 INFO - 'LANGUAGE': 'en_US:en', 14:02:23 INFO - 'LOGNAME': 'cltbld', 14:02:23 INFO - 'MAIL': '/var/mail/cltbld', 14:02:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:23 INFO - 'MOZ_NO_REMOTE': '1', 14:02:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:23 INFO - 'NO_EM_RESTART': '1', 14:02:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:23 INFO - 'PWD': '/builds/slave/test', 14:02:23 INFO - 'SHELL': '/bin/bash', 14:02:23 INFO - 'SHLVL': '1', 14:02:23 INFO - 'TERM': 'linux', 14:02:23 INFO - 'TMOUT': '86400', 14:02:23 INFO - 'USER': 'cltbld', 14:02:23 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:23 INFO - '_': '/tools/buildbot/bin/python'} 14:02:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:02:24 INFO - Running setup.py (path:/tmp/pip-9mPha1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:02:24 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:02:24 INFO - Running setup.py (path:/tmp/pip-nwpIwn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:02:24 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:02:24 INFO - Running setup.py (path:/tmp/pip-5ksePF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:02:24 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:02:24 INFO - Running setup.py (path:/tmp/pip-BQvYAT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:02:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:02:24 INFO - Running setup.py (path:/tmp/pip-_xTqyK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:02:24 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:02:24 INFO - Running setup.py (path:/tmp/pip-mJf5Sk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:02:24 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:02:24 INFO - Running setup.py (path:/tmp/pip-exLBMo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:02:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:02:24 INFO - Running setup.py (path:/tmp/pip-3jLiaW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:02:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:02:24 INFO - Running setup.py (path:/tmp/pip-JzG9LT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:02:24 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:02:24 INFO - Running setup.py (path:/tmp/pip-U0Zm43-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:02:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:02:24 INFO - Running setup.py (path:/tmp/pip-35uAas-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:02:24 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:02:24 INFO - Running setup.py (path:/tmp/pip-V5f0LO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:02:24 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:02:24 INFO - Running setup.py (path:/tmp/pip-5eYsNd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:02:24 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)) 14:02:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:02:25 INFO - Running setup.py (path:/tmp/pip-NVdNMK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:02:25 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)) 14:02:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:02:25 INFO - Running setup.py (path:/tmp/pip-CkCexr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:02:25 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)) 14:02:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:02:25 INFO - Running setup.py (path:/tmp/pip-M1OGzM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:02:25 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)) 14:02:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:02:25 INFO - Running setup.py (path:/tmp/pip-2_Ec3O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:02:25 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)) 14:02:25 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)) 14:02:25 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)) 14:02:25 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)) 14:02:25 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 14:02:25 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.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 14:02:25 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 14:02:25 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 14:02:25 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 14:02:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:02:25 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 14:02:25 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 14:02:26 INFO - Downloading blessings-1.6.tar.gz 14:02:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 14:02:26 INFO - Installing collected packages: blessings 14:02:26 INFO - Running setup.py install for blessings 14:02:26 INFO - Successfully installed blessings 14:02:26 INFO - Cleaning up... 14:02:26 INFO - Return code: 0 14:02:26 INFO - Done creating virtualenv /builds/slave/test/build/venv. 14:02:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:02:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:02:26 INFO - Reading from file tmpfile_stdout 14:02:26 INFO - Current package versions: 14:02:26 INFO - argparse == 1.2.1 14:02:26 INFO - blessings == 1.6 14:02:26 INFO - blobuploader == 1.2.4 14:02:26 INFO - docopt == 0.6.1 14:02:26 INFO - functools32 == 3.2.3-2 14:02:26 INFO - jsonschema == 2.5.1 14:02:26 INFO - manifestparser == 1.1 14:02:26 INFO - mozInstall == 1.12 14:02:26 INFO - mozcrash == 1.0 14:02:26 INFO - mozdebug == 0.1 14:02:26 INFO - mozdevice == 0.50 14:02:26 INFO - mozfile == 1.2 14:02:26 INFO - mozhttpd == 0.7 14:02:26 INFO - mozinfo == 0.9 14:02:26 INFO - mozleak == 0.1 14:02:26 INFO - mozlog == 3.4 14:02:26 INFO - moznetwork == 0.27 14:02:26 INFO - mozprocess == 0.25 14:02:26 INFO - mozprofile == 0.28 14:02:26 INFO - mozrunner == 6.13 14:02:26 INFO - mozscreenshot == 0.1 14:02:26 INFO - mozsystemmonitor == 0.3 14:02:26 INFO - moztest == 0.8 14:02:26 INFO - mozversion == 1.4 14:02:26 INFO - psutil == 3.1.1 14:02:26 INFO - requests == 1.2.3 14:02:26 INFO - wsgiref == 0.1.2 14:02:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:02:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:02:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:02:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:26 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1b2b1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c23a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc8b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, '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': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', '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 14:02:26 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 14:02:26 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 14:02:26 INFO - Using env: {'DISPLAY': ':0', 14:02:26 INFO - 'HOME': '/home/cltbld', 14:02:26 INFO - 'LANG': 'en_US.UTF-8', 14:02:26 INFO - 'LANGUAGE': 'en_US:en', 14:02:26 INFO - 'LOGNAME': 'cltbld', 14:02:26 INFO - 'MAIL': '/var/mail/cltbld', 14:02:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:26 INFO - 'MOZ_NO_REMOTE': '1', 14:02:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:26 INFO - 'NO_EM_RESTART': '1', 14:02:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:26 INFO - 'PWD': '/builds/slave/test', 14:02:26 INFO - 'SHELL': '/bin/bash', 14:02:26 INFO - 'SHLVL': '1', 14:02:26 INFO - 'TERM': 'linux', 14:02:26 INFO - 'TMOUT': '86400', 14:02:26 INFO - 'USER': 'cltbld', 14:02:26 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:26 INFO - '_': '/tools/buildbot/bin/python'} 14:02:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:02:27 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)) 14:02:27 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)) 14:02:27 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)) 14:02:27 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)) 14:02:27 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)) 14:02:27 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)) 14:02:27 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)) 14:02:27 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)) 14:02:27 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)) 14:02:27 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)) 14:02:27 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)) 14:02:27 INFO - Cleaning up... 14:02:27 INFO - Return code: 0 14:02:27 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 14:02:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:02:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:02:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:02:27 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x1b2b1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c23a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1dc8b10>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, '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': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', '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 14:02:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 14:02:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 14:02:27 INFO - Using env: {'DISPLAY': ':0', 14:02:27 INFO - 'HOME': '/home/cltbld', 14:02:27 INFO - 'LANG': 'en_US.UTF-8', 14:02:27 INFO - 'LANGUAGE': 'en_US:en', 14:02:27 INFO - 'LOGNAME': 'cltbld', 14:02:27 INFO - 'MAIL': '/var/mail/cltbld', 14:02:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:27 INFO - 'MOZ_NO_REMOTE': '1', 14:02:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:27 INFO - 'NO_EM_RESTART': '1', 14:02:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:27 INFO - 'PWD': '/builds/slave/test', 14:02:27 INFO - 'SHELL': '/bin/bash', 14:02:27 INFO - 'SHLVL': '1', 14:02:27 INFO - 'TERM': 'linux', 14:02:27 INFO - 'TMOUT': '86400', 14:02:27 INFO - 'USER': 'cltbld', 14:02:27 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:27 INFO - '_': '/tools/buildbot/bin/python'} 14:02:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:02:27 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 14:02:27 INFO - Cleaning up... 14:02:27 INFO - Return code: 0 14:02:27 INFO - Running post-action listener: _resource_record_post_action 14:02:27 INFO - Running post-action listener: _start_resource_monitoring 14:02:27 INFO - Starting resource monitoring. 14:02:27 INFO - [mozharness: 2017-05-03 21:02:27.294999Z] Finished create-virtualenv step (success) 14:02:27 INFO - [mozharness: 2017-05-03 21:02:27.295541Z] Running install step. 14:02:27 INFO - Running pre-action listener: _resource_record_pre_action 14:02:27 INFO - Running main action method: install 14:02:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:02:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:02:27 INFO - Reading from file tmpfile_stdout 14:02:27 INFO - Detecting whether we're running mozinstall >=1.0... 14:02:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 14:02:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 14:02:27 INFO - Reading from file tmpfile_stdout 14:02:27 INFO - Output received: 14:02:27 INFO - Usage: mozinstall [options] installer 14:02:27 INFO - Options: 14:02:27 INFO - -h, --help show this help message and exit 14:02:27 INFO - -d DEST, --destination=DEST 14:02:27 INFO - Directory to install application into. [default: 14:02:27 INFO - "/builds/slave/test"] 14:02:27 INFO - --app=APP Application being installed. [default: firefox] 14:02:27 INFO - mkdir: /builds/slave/test/build/application 14:02:27 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'] 14:02:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 14:02:42 INFO - Reading from file tmpfile_stdout 14:02:42 INFO - Output received: 14:02:42 INFO - /builds/slave/test/build/application/firefox/firefox 14:02:42 INFO - Running post-action listener: _resource_record_post_action 14:02:42 INFO - [mozharness: 2017-05-03 21:02:42.890992Z] Finished install step (success) 14:02:42 INFO - [mozharness: 2017-05-03 21:02:42.891117Z] Running run-tests step. 14:02:42 INFO - Running pre-action listener: _resource_record_pre_action 14:02:42 INFO - Running main action method: run_tests 14:02:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 14:02:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 14:02:42 INFO - Python 2.7.3 14:02:42 INFO - Return code: 0 14:02:42 INFO - grabbing minidump binary from tooltool 14:02:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 14:02:42 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1dc6290>, '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 0x1dc6b90>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1dc7040>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 14:02:42 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 14:02:42 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 14:02:42 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 14:02:42 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 14:02:42 INFO - Return code: 0 14:02:42 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 14:02:42 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 14:02:42 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 14:02:42 INFO - ENV: RUST_BACKTRACE is now 1 14:02:42 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 14:02:42 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 14:02:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-044', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 14:02:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-044 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 14:02:42 INFO - Using env: {'DISPLAY': ':0', 14:02:42 INFO - 'HOME': '/home/cltbld', 14:02:42 INFO - 'LANG': 'en_US.UTF-8', 14:02:42 INFO - 'LANGUAGE': 'en_US:en', 14:02:42 INFO - 'LOGNAME': 'cltbld', 14:02:42 INFO - 'MAIL': '/var/mail/cltbld', 14:02:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 14:02:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 14:02:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:02:42 INFO - 'MOZ_NO_REMOTE': '1', 14:02:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 14:02:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:02:42 INFO - 'NO_EM_RESTART': '1', 14:02:42 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:02:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:02:42 INFO - 'PWD': '/builds/slave/test', 14:02:42 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 14:02:42 INFO - 'RUST_BACKTRACE': '1', 14:02:42 INFO - 'SHELL': '/bin/bash', 14:02:42 INFO - 'SHLVL': '1', 14:02:42 INFO - 'TERM': 'linux', 14:02:42 INFO - 'TMOUT': '86400', 14:02:42 INFO - 'USER': 'cltbld', 14:02:42 INFO - 'XDG_SESSION_COOKIE': '88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302', 14:02:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:02:42 INFO - '_': '/tools/buildbot/bin/python'} 14:02:42 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-044', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 14:02:43 INFO - mozversion application_buildid: 20170503202928 14:02:43 INFO - mozversion application_changeset: 96605941c0021795376d9c6ec1e458de2fac329e 14:02:43 INFO - mozversion application_display_name: Nightly 14:02:43 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 14:02:43 INFO - mozversion application_name: Firefox 14:02:43 INFO - mozversion application_remotingname: firefox 14:02:43 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 14:02:43 INFO - mozversion application_vendor: Mozilla 14:02:43 INFO - mozversion application_version: 55.0a1 14:02:43 INFO - mozversion platform_buildid: 20170503202928 14:02:43 INFO - mozversion platform_changeset: 96605941c0021795376d9c6ec1e458de2fac329e 14:02:43 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 14:02:43 INFO - mozversion platform_version: 55.0a1 14:02:43 INFO - using testdate: 1493845363 14:02:43 INFO - actual date: 1493845363 14:02:43 INFO - starting webserver on 'localhost:54913' 14:02:43 INFO - SUITE-START | Running 2 tests 14:02:43 INFO - TEST-START | dromaeo_css 14:02:43 INFO - operating with platform_type : linux_ 14:02:43 INFO - Initialising browser for dromaeo_css test... 14:02:43 INFO - TEST-INFO | started process 29709 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpbvOOCA/profile http://localhost:54913/getInfo.html) 14:02:47 INFO - PID 29709 | __metrics Screen width/height:1600/1200 14:02:47 INFO - PID 29709 | colorDepth:24 14:02:47 INFO - PID 29709 | Browser inner width/height: 1024/695 14:02:47 INFO - PID 29709 | __metrics 14:02:49 INFO - TEST-INFO | 29709: exit 0 14:02:49 INFO - Browser initialized. 14:02:49 INFO - Running cycle 1/1 for dromaeo_css test... 14:02:49 INFO - TEST-INFO | started process 29859 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpbvOOCA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:03:01 INFO - PID 29859 | RSS: Main: 174686208 14:03:01 INFO - PID 29859 | 14:06:07 INFO - PID 29859 | Cycle 1(1): loaded http://localhost:54913/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54913/tests/dromaeo/cssquery-ext.html) 14:06:08 INFO - PID 29859 | RSS: Main: 183844864 14:06:08 INFO - PID 29859 | 14:09:10 INFO - PID 29859 | Cycle 1(1): loaded http://localhost:54913/tests/dromaeo/cssquery-ext.html (next: http://localhost:54913/tests/dromaeo/cssquery-jquery.html) 14:09:11 INFO - PID 29859 | RSS: Main: 179355648 14:09:11 INFO - PID 29859 | 14:12:13 INFO - PID 29859 | Cycle 1(1): loaded http://localhost:54913/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54913/tests/dromaeo/cssquery-mootools.html) 14:12:13 INFO - PID 29859 | RSS: Main: 189415424 14:12:13 INFO - PID 29859 | 14:15:15 INFO - PID 29859 | Cycle 1(1): loaded http://localhost:54913/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54913/tests/dromaeo/cssquery-prototype.html) 14:15:16 INFO - PID 29859 | RSS: Main: 181280768 14:15:16 INFO - PID 29859 | 14:18:19 INFO - PID 29859 | Cycle 1(1): loaded http://localhost:54913/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54913/tests/dromaeo/cssquery-yui.html) 14:18:20 INFO - PID 29859 | RSS: Main: 187043840 14:18:20 INFO - PID 29859 | 14:21:21 INFO - PID 29859 | Cycle 1(1): loaded http://localhost:54913/tests/dromaeo/cssquery-yui.html (next: http://localhost:54913/tests/dromaeo/cssquery-dojo.html) 14:21:22 INFO - PID 29859 | RSS: Main: 190324736 14:21:22 INFO - PID 29859 | 14:21:22 INFO - PID 29859 | __start_tp_report 14:21:22 INFO - PID 29859 | _x_x_mozilla_page_load 14:21:22 INFO - PID 29859 | _x_x_mozilla_page_load_details 14:21:22 INFO - PID 29859 | |i|pagename|runs| 14:21:22 INFO - PID 29859 | |0;dojo.html;2740.2327348342446;2757.4485102979397;2762.047093752655;2770.653668291465;2787.3310405502684;5123.154679477891;5142.562882155016;5158.071547121516;5173.482651734825;5192.922106168406;5216.921746173801;5221.190715439104;5242.501962313584;5343.572514198864;5358.437364076774;4327.740335579875;4594.494605593382;4674.555917187861;4696.201645720219;4707.1762441572755;4720.976395118019;4759.95281038171;4772.260299653542;4786.018866132435;4822.638302127337;4645.396098507173;4684.156851766681;4703.6942598730975;4710.24636058229;4710.576048155683;4671.112488627184;4686.601638860667;4715.339852420664;4758.310045043484;4759.428868535798;4640.118377508263;4645.140648979949;4657.068586282723;4693.718376897397;4697.929531057037;5082.593392528589;5132.230165475171;5210.192420174841;5218.13900706383;5234.502722241419;5625.80309689163;5678.630888992244;5719.742611582489;5729.627574207705;5769.596128271022;5745.88508229833;5756.8848623027725;5771.192033115367;5783.0747080467345;5798.391168927286;5203.375594928632;5254.159334506537;5255.817441075727;5308.601854860901;5352.759125839347;5835;5856;5901.675407852524;5927.436893495111;5932.614380065282;5434.402215756264;5541.5843811714285;5554.1946417770005;5557.527610153183;5561.360443548962;5601.187827764951;5601.467860553241;5650.406707295757;5655.095184770417;5663.688497132697;5588.9720551397795;5589.832305030855;5594.86012849682;5596.2165296858475;5596.86007849807;5620.718964051863;5629.831105066854;5630.662160270397;5633.549316054706;5640.71796410186;4715.7642117893965;4721.268203428474;4726.692764970266;4728.881777955578;4729.929051064237;4129.938050929239;4152.065785198367;4159.209750147463;4162.084341444877;4191.392248124005;4822.180229361017;4932.975335123301;4966.543637330031;4972.105021096165;5011.273365362075;5643.322801263875;5708.885822283531;5710.200571919934;5721.141828725725;5739.110437882135;4921.163402221631;4923.90152196954;4926.088673595396;4940.283658869444;5001.324821149171;5100.438951715309;5105.821296254613;5114.923276150861;5119.078565858182;5119.411267704113;5287.656302340336;5351.518363347317;5365.543928766098;5395.379531353945;5402.6758394496455;5793.04414771558;5819.854503637443;5822.184894114912;5829;5832.212651292021;5375.919361209507;5389.75746091419;5392.595555333287;5393.083175860034;5393.649412788313;5570.220169176399;5654.830355089354;5667.801626943037;5682.204491371129;5710.971445142748;5734.910367030251;5753.626014309057;5787;5787.2187254720075;5835.299764028344;5529.861753456195;5599.412061733622;5611.691356975405;5614.382417934105;5630.324361076697;5420.512153906167;5553.611247212656;5554.861128471821;5573.331200255995;5595.412481689364;5498.3127109111365;5539.8892022160135;5540.168974653834;5551.25058117149;5595.8880822384135;5507.311586051744;5614.045612245846;5649.802256920988;5669.574781891457;5669.688167150846;5383.300170977748;5444.26502422168;5531.557475402039;5533.335999680065;5547.5007249347755 14:21:22 INFO - PID 29859 | |1;ext.html;693.8681650486408;748.7154881145165;755.7014979083262;1054.7310435838865;1067.2795862792623;31757.206069848264;32742;32746;32757.508637370458;32866.34267314655;34606.40451966106;35072.64927350726;35142.297154056905;35218.64781352186;35347.4697879532;6831.077804496404;6851.725930962781;6923.065386172878;7026.227115017344;7029.929700702979;6886.311368863124;6963.79108626742;6987.755428560002;6989.6854641540995;6991.580505169681;6938.618375989318;6956.165260168762;7013.719451221945;7019.719211231544;7029.402500787413;6879.690413931385;6932.306769323052;6939.375456208965;6944.79165625027;6946.861062778716;6861.656917154122;6905.240423553405;6926.896096558556;6927.203371612279;7005.369516743517;32191;32542.511862322084;32548.67451325504;32559.51160732591;32775.34449311;3074.108508532523;3103.4103520331064;3106.0371284901753;3106.813591184536;3109;24823.62764558533;24862;24899.128530501526;24940.50118997628;25019.749802501923;3120.9063728088195;3148.4175427545747;3158.4314823331792;3168.413843438971;3183.9522407163913;142598.28700856428;143895.2805235967;144066;147082.26458867636;147397.26301368533;40247.1950560993;40261;40287;40407.79796101001;40466;41641.58358416438;41729.79135104305;41849.37225941613;41871.16257674829;41991.58008419938;11672.94163529194;11712.774572831135;11775.88224117765;11778.352190629426;11781.116416268815;9321.114494123047;9321.161095501302;9348.345615806827;9354.064593540592;9361.204297634777;12646.430910609044;12691.68270793219;12731.872681273255;12810.80783788244;12908.225506469642;5325.760340784674;5353.680717954815;5378.2470454136455;5393.541548968303;5432.2123292123215;890.857462805948;913.0869130869131;922.6678395777515;928.6749637626776;958.6740508227236;20850.374488765363;21849.67225491619;21898.343049708536;21902.890485547472;21935.780642193375;989.9653512127041;992.3239072505258;1017.8931212222758;1018.6791160784329;1020.1430798129607;11294.661160165208;11368.431578421212;11453.942730286295;11571.363575003455;11660.76678466426;173412;173599;173951;174139;174312;41612.58387416148;41757.37363939543;41797.1640567187;41857.58142418598;41890.37164442536;1216.4769149265724;1243.9378031098408;1250.306080125539;1252.2236213547658;1256.9120161588785;20197.394078177676;20226.797732022493;21051.368458946257;21098.472538186055;21502.354929352143;29713.405731885672;29858.253543660714;30076.84961575178;30101.548476773303;30208.5468717965;147552;147804;148056;148192;148423;28915.42169156563;29151.854240728662;29213.561796572645;29301.41397172087;29446.558301625922;34581.654183457846;34787.65212347844;35050.64949350474;35673.46489802603;36258.73094441682;26484;27248.182554523395;27363.452730945668;27976.44047119087;28487.857560712062;26673.33316667099;26796.59805102886;27066;28001.85999070073;28528.286792830346;30510.694893050786;30515.694843052173;30540;30568.541471877495;30669;25637.48725025452;26352.736472635796;26784.33039174036;26917.366155568747;27136.321591959568;19704.802951970298;21523.892380537996;21677.674834877806;21772.782272177075;21816.236431724814 14:21:22 INFO - PID 29859 | |2;jquery.html;410.3639358993559;416.76452804165626;420.17226064652635;433.83947939262475;440.0385158428833;15050.774238386406;17238.482845514638;17899.373521926736;18050.368237111703;18153.909230453846;18350.632987340246;18460.815391846078;18829.90585047076;19299.903500482476;19465.902670486626;5463.644863083907;5484.122540393528;5559.221708960748;5582.274304340451;5605.495505404513;5509.9806535791;5591.496765291123;5594.188842617818;5598.972005139969;5607.299087614048;5291.894162116755;5480.287562616854;5483.698396588186;5506.953678801035;5554.1113421852515;5449.073657478239;5465.945340546584;5503.587230957694;5508.669479831203;5523.613347065687;4871.098846713334;4964.180910149821;4970.502949705036;4970.850874473772;4986.650934434591;22905.770942290696;23074.76925230743;23125.768742312528;23164.76835231643;23360.64959025616;1590.952271431859;1642.8110767261678;1648.5960939569882;1650.1254335202361;1654.8593369563603;14681.632959175999;14846.628834279121;15273.923630381889;15338.846611533854;15508.92245538765;2036.5926814636985;2118.809307162363;2121.9151233950624;2135.4981579328846;2140.8608440451476;84104.57947710283;88504;89252;90565.54717226372;92294.53852730761;11189.608363707232;11210.159238057178;11212.495437705324;11356.659300221007;11579.652610421532;15654.217289135726;16005.439809606607;16060.919695401448;16108.597285067966;16142.515724528283;7223.226141389607;7273.199948005715;7427.888581671279;7438.59087750179;7485.214052524516;6458.321876202931;6499.54503184782;6682.2936710632275;6684.532082754258;6696.397324240745;7241.537877121804;7272.418206543463;7332.340089391981;7381.778546643609;7432.2567743225245;2031.410890841669;2036.3076553971425;2076.512019675405;2109.061467646913;2210.5357874846463;855.6791203298762;881.0704706534667;898.4250079948838;899.4962820820361;918.3755046568398;16981.235844387033;17155.313787448362;17591.560210994572;17899.855565717826;18107.81892181088;883.1609970527895;889.5418859287472;903.4940433357341;906.1255888068046;912.9726108216764;9211.69704591443;9390.389624674512;9655.662051828152;9730.562124704406;9803.166730827817;371347;374676;375771;376996;392249;76731.61634191794;77300.60737332168;77593.61203193948;79669.60165199137;79827.60086199532;1090.1823632275793;1122.7193201699574;1124.2579897267765;1126.6957921361186;1130.4121856634504;17653.82346176522;17668.293268269124;18462.63074738471;18567.071646417357;18785.812141878407;37505.437418439295;37876.81061594674;38291.42562861615;38476.42285365666;39857.60142398539;47229.527704723885;49160.50839491702;49176.50823491719;49579.25631115464;52214.47785522096;8012;8250.793730156554;8472.83054338922;8483.36374771907;8686.956565217133;11802.94098529502;11833.644990650295;11931.701707457383;12007.879921200676;12193.561287742665;10015.849762253427;10145.239107067147;10233.795324093328;10311.123554497952;10495.947520262655;9941.65204217849;10022.398656080659;10060.69817905464;10231.334963227664;10338.793224135625;10087.243456740627;10419.583216671248;10450.738731531772;10582.894171058499;10801.297915635458;8536.274416674652;8546.529940853065;8583.313334933315;8612;8706.1729135732;9836.557354919189;9963.551640176354;10146.086852183338;10410.68767936963;10663.253572250178 14:21:22 INFO - PID 29859 | |3;mootools.html;1272.5228039485194;1344.0390121063444;1351.8648135186484;1355.9932200338997;1360.0887405438352;9294.628214871414;9451.574679139438;9526.285528585366;9865.852012219822;9886.060824221706;9658.613655453792;9823.901760982388;9842.065003824644;9861.2604054696;9886.456244906527;2176.847620666554;2212.3694746997107;2212.4358288636377;2213.9889300553473;2223.9332820015425;2096.6016456873144;2171.869687818736;2179.171914672422;2183.7379514458207;2189.6715492676067;2209.7679743626927;2224.377174391173;2255.22194842779;2262.7737226277322;2267.8639281643073;2110.8205802506805;2146.710194123789;2149.355193441969;2151.8170955468804;2159.3198142585034;2049.897505124738;2055.270379015458;2104.442322784463;2119.7774233705395;2169.739631244245;9571.521423928776;9722;9735;9746.415215087118;9747.61009559624;5297.205419187114;5451.672899625995;5465.836024919259;5466.945330546683;5470.425605311425;3064.295212101229;3343.36476069546;3379.8141102239365;3404.8297585120895;3407.9659203408146;1081.1404933078222;1115.4199816095665;1121.5962253588702;1132.162199972023;1132.5413207650831;14035.508757193551;14147.575572732834;14214.147151170962;14358.210298433582;14382.352794124185;4828.179209534387;5031.195008798574;5193.636445448782;5216.37403511581;5220.843374698765;12030.27818330903;12064.57773977924;12073.939630301793;12085.335306558049;12087.576934807239;5570.86072848182;5573.27547418833;5584.636998595079;5587.38538760736;5597.524210442077;4860.198067318853;4882.731449770296;4892.168331383602;4986.2271347940405;4986.252062190701;4128.587141285848;4196.3705444183615;4219.282721937278;4251.639475367914;4273.529911709709;1325.2975922760952;1330.4079684540286;1345.1122259308809;1367.2138520350838;1375.0374737683662;692.7990882644077;716.698986425692;717.6985666020284;729.6898818002328;729.7555318968099;5188.7405629719115;5237;5323.653962492425;5371.248025276464;5397.055515284809;548;556.8357334586307;557.7908284393352;561.2899681902396;563.9548836093103;3375.8987230383127;3378.223008708011;3623.710103191738;3723.3298006358573;3791.905202369963;12051.939740301243;12395.690107747198;12581.811272830915;12607.936960315139;12608.621741347773;12224.511019559295;12338.629841104781;12396.752064958831;12536.435860386304;12539.498420063095;7089.61007144612;7163.6060016699585;7207.89188162178;7228.855422891618;7260.818479537948;5463.972680136574;5490.780368785364;5492.258545096361;5575.581831362745;5626.5780066496;10813;10818.891811081789;10942;10996.12031037531;11129.332240065622;11216.270942388719;11292.49183786748;11357.0914326852;11458.484368203617;11474.082073434272;7692.19231980634;7917.406194535318;7947.841043178988;8001.319887809368;8039;9017.09829017093;9152.771180720536;9202.263818894606;9203.677871274473;9234.076592340713;7309.232530584425;7409.592472414069;7606.695732170872;7698.230176982257;7799.06411230656;7551.244875512624;7659.463837531319;7681.347085497795;7685.730999414994;7732.7680169595005;7158.427325813818;7252.311030452099;7334.413246940126;7340.11918569775;7348.191698913009;4977.502249774993;5335.33308336458;5341.679499230058;5544.473275038865;5609.523190528851;4977;5025.296458495741;5106.463821298858;5145.794168233228;5149.665271757323 14:21:22 INFO - PID 29859 | |4;prototype.html;391.8158465521206;395.9086152084197;396.48457005892334;398.27513924657137;404.9028233224025;5553.888922221553;5589.944100559003;5597.888042239153;5602.523785478239;5608.523275521576;4986.576141028008;5386.78452861885;5402.37872644645;5467.535259502947;5484.314460692413;4317.913641727164;4325;4329.19909816685;4329.805158767856;4343.891402714926;4325.2647050001415;4327.091310824715;4332.675049371294;4344.261475549149;4356.390105385249;4221.134667393177;4288.356746488021;4306.935395969063;4311.892202694942;4318.265894797876;4286.849960251392;4291.828326866922;4297.474396589213;4297.561950439667;4328.588784065509;3888.9611103888883;3894.4742459767854;3910.980445097785;3922.195949830278;3925.371940489508;5092.9559440315015;5268.578513718893;5286.127788914824;5326.307580014573;5336.959292937879;5109.463506331819;5119.513646203604;5125.4618265082;5128.666636668605;5153.201253805666;5853.941460585383;5885.90989730395;5887.35239123696;5905.970470147665;5919.378465261128;4320.200762858881;4392.330914252596;4402.8679139625865;4410.75740834254;4412.911741765147;5986.964432093109;6097.756089756404;6158.938410615881;6181.443670069715;6190.783322583733;4262.25410553152;4283.143371325685;4292.227399068135;4318.676099292566;4325.351197320427;4345.587169218919;4347.217500849877;4350.671082273158;4365.956340436555;4372.650187984954;4832.420109586872;4932.186189278729;4944.678595891256;4951.529604687549;4955.35580374549;5825.097109947965;5832.591718579659;5833.883322333614;5833.891560603472;5858.7070646468355;1594.4100682747458;1624.8375162483894;1626.349460215923;1627.1782749711556;1632.4041724770611;1089.5315014543664;1138.0383575878534;1159.5535718748342;1161.9128565357632;1174.225011492428;5044.646874718735;5091.3635795524815;5092.414372347153;5099.8725031873755;5117.130087885069;6000.459958603747;6038.5169186465855;6067.878642427127;6104.481119104837;6105.778844231171;4999.75001249936;5083.466236045236;5084.669496482717;5124.410692770379;5144.511271429283;3192.920176995547;3198.4722520784276;3213.5983002124735;3215.2122729930848;3218.4850423932057;5541.418151094158;5644.6330988485615;5646.407127251661;5648.378678345379;5660.2075709400715;6126.969365153146;6179.443850053517;6180.598261113013;6186.226721659793;6193.7263288330905;5636.154576813511;5643.351014633287;5645.717714114277;5670.574706896917;5670.86582683465;5832.77511722543;5900.940990590039;5952.791652292149;5972.5520585955355;6064.120702498025;5925.881482370414;5939.643621382731;5939.821805345847;5941.37615550361;5976.432238937294;5452.809151679672;5599.356074051536;5605.355384130877;5649.180868774087;5666;4058.9797051014557;4087.346024636044;4094.5086589608245;4095.344744840811;4106.0761328702;5945.42446251735;6046.123312119806;6049.485793707584;6060.757569697163;6098.359672234352;5776.682282474504;5806.970965145148;5811.389804070512;5825.50483208932;5892.381299963442;5802.970985145047;5805.187273781758;5815.94184058154;5825.70871456434;5836.9493491172;5642.520385767256;5706.400827913176;5708.859177808322;5755.223044888887;5768.105943578752;5864.67744274069;5876.735546900314;5879.147523609138;5881.264841894763;5887.352391236875;5446.930166536691;5637.267155269788;5654.773809047592;5667.3482549507335;5694.402087780889 14:21:22 INFO - PID 29859 | |5;yui.html;767.8963339949105;775.6587101675262;794.3446656508379;796.1202870827735;801.226816122442;12994.28531430771;13540.796888046674;13577;13819.930900345496;13847.723045539084;15426;15592.45426410076;15866.603334916605;15907.204639767995;16324.673506529862;835.6406745099605;853.8078932240259;854.6709516836;855.9101294364095;856.5845564901018;890.875277461156;891.8082612238368;896.4307664632972;896.6413434626137;896.6771962093674;934.4393363981625;938.2212763406391;942.2367882015556;943.7310366545536;945.4469135555709;928.9256859451227;930.2279108340061;930.5951910918772;932.1936524905975;933.6452148183681;685.6503183376464;688.3495097133211;689.5759108148503;691.7959202035412;692.1935944624506;13089.803652945213;13407.932960335233;14761.409543618242;14937.626559335995;14966.775498367424;14822.332995015251;14850.331735071948;14892.180930048842;15003.549893503103;15197.164155971417;12460.688482788002;12632.936835315764;12662.55681051168;12789.232646041268;12790.104692671517;2862.470442968037;2865.871035803373;2882;2891.508443564599;2893.4068515954177;70482.9517048291;70545;71118.2888171122;71247.2875271251;72115;11142.888571114347;11177.776444471228;11224.55101795919;11241.550337986553;11253.549858005752;17896.731549026776;17916.193771280323;18064;18311.816881831277;18360.90819545894;6031.4270144336215;6117.969410153009;6270.122182894307;6284.622922624657;6293.779717709858;3001.6097907271915;3069.3094053838154;3073.3085055862252;3084.521899105642;3095.334503081848;3193.6806319368343;3232.951505727416;3241.9787766853365;3254;3258.478643417042;766.3677466090497;786.3080489169495;787.9795664614223;793.2345286798268;793.6388943030908;598.8233471126028;603.6528995827417;604.7188057553171;614.6895817612077;630.9116723658691;10376.481175941324;10381.117605003508;10441;10675.83986240207;10756.408397538211;603.9909401358983;609.8780243951228;613.8189234175928;628.8396458902951;632.6077831744255;4399.098184872094;4473.3960915276675;4542.046170304273;4542.772861356919;4558.407407037064;61265.38734612686;62424;63024.36975630277;65779;66368.66815665987;57051.42948570461;57082.71458642763;57182;57766.133507997416;58025.45669062995;50256.497435025914;50824.74587627038;51262.48737512652;51434.74282628563;52191.73904130455;9075.863862041942;9318.394304370195;9426.528673566158;9530.904690953003;9694.36986595869;27954.440911181257;28030.15909522636;28116.57825132584;28197.295067623472;28727.425451490435;32689.673103268662;32741.836290819345;44885.551144488134;46236.7688161557;46845;13285.402156903156;13395.196288222738;13400.463981440633;13531.59405217845;13640.79538806899;14956.40174393012;15684.137372444626;15941;15948.760768588249;16548.007119572863;14505.129692218501;14733.852661473677;15116.319765610355;15243.695126097638;15332.846671533589;14077.296135193405;14282.357293922007;14552.27238638085;14770.187639679922;14852.257387130385;13025.739485210432;13824.447022119002;14495;14702.926485367505;15053.548393548212;10539.841902371318;10663;10696.304740191863;10794.784104318027;11039.558417663204;10796;11164.330140191614;11408.429578520874;11493.655190344303;12127.514899404277 14:21:22 INFO - PID 29859 | __end_tp_report 14:21:22 INFO - PID 29859 | __start_cc_report 14:21:22 INFO - PID 29859 | _x_x_mozilla_cycle_collect,371 14:21:22 INFO - PID 29859 | __end_cc_report 14:21:22 INFO - PID 29859 | __startTimestamp1493846482212__endTimestamp 14:21:22 INFO - PID 29859 | 14:21:22 INFO - PID 29859 | ------- Summary: start ------- 14:21:22 INFO - PID 29859 | Number of tests: 6 14:21:22 INFO - PID 29859 | 14:21:22 INFO - PID 29859 | [#0] dojo.html Cycles:165 Average:5219.17 Median:5393.08 stddev:614.07 (11.4%) stddev-sans-first:584.35 14:21:22 INFO - PID 29859 | Values: 2740.2 2757.4 2762.0 2770.7 2787.3 5123.2 5142.6 5158.1 5173.5 5192.9 5216.9 5221.2 5242.5 5343.6 5358.4 4327.7 4594.5 4674.6 4696.2 4707.2 4721.0 4760.0 4772.3 4786.0 4822.6 4645.4 4684.2 4703.7 4710.2 4710.6 4671.1 4686.6 4715.3 4758.3 4759.4 4640.1 4645.1 4657.1 4693.7 4697.9 5082.6 5132.2 5210.2 5218.1 5234.5 5625.8 5678.6 5719.7 5729.6 5769.6 5745.9 5756.9 5771.2 5783.1 5798.4 5203.4 5254.2 5255.8 5308.6 5352.8 5835.0 5856.0 5901.7 5927.4 5932.6 5434.4 5541.6 5554.2 5557.5 5561.4 5601.2 5601.5 5650.4 5655.1 5663.7 5589.0 5589.8 5594.9 5596.2 5596.9 5620.7 5629.8 5630.7 5633.5 5640.7 4715.8 4721.3 4726.7 4728.9 4729.9 4129.9 4152.1 4159.2 4162.1 4191.4 4822.2 4933.0 4966.5 4972.1 5011.3 5643.3 5708.9 5710.2 5721.1 5739.1 4921.2 4923.9 4926.1 4940.3 5001.3 5100.4 5105.8 5114.9 5119.1 5119.4 5287.7 5351.5 5365.5 5395.4 5402.7 5793.0 5819.9 5822.2 5829.0 5832.2 5375.9 5389.8 5392.6 5393.1 5393.6 5570.2 5654.8 5667.8 5682.2 5711.0 5734.9 5753.6 5787.0 5787.2 5835.3 5529.9 5599.4 5611.7 5614.4 5630.3 5420.5 5553.6 5554.9 5573.3 5595.4 5498.3 5539.9 5540.2 5551.3 5595.9 5507.3 5614.0 5649.8 5669.6 5669.7 5383.3 5444.3 5531.6 5533.3 5547.5 14:21:22 INFO - PID 29859 | 14:21:22 INFO - PID 29859 | [#1] ext.html Cycles:180 Average:30054.45 Median:3088.76 stddev:40272.69 (1303.8%) stddev-sans-first:40325.32 14:21:22 INFO - PID 29859 | Values: 693.9 748.7 755.7 1054.7 1067.3 31757.2 32742.0 32746.0 32757.5 32866.3 34606.4 35072.6 35142.3 35218.6 35347.5 6831.1 6851.7 6923.1 7026.2 7029.9 6886.3 6963.8 6987.8 6989.7 6991.6 6938.6 6956.2 7013.7 7019.7 7029.4 6879.7 6932.3 6939.4 6944.8 6946.9 6861.7 6905.2 6926.9 6927.2 7005.4 32191.0 32542.5 32548.7 32559.5 32775.3 3074.1 3103.4 3106.0 3106.8 3109.0 24823.6 24862.0 24899.1 24940.5 25019.7 3120.9 3148.4 3158.4 3168.4 3184.0 142598.3 143895.3 144066.0 147082.3 147397.3 40247.2 40261.0 40287.0 40407.8 40466.0 41641.6 41729.8 41849.4 41871.2 41991.6 11672.9 11712.8 11775.9 11778.4 11781.1 9321.1 9321.2 9348.3 9354.1 9361.2 12646.4 12691.7 12731.9 12810.8 12908.2 5325.8 5353.7 5378.2 5393.5 5432.2 890.9 913.1 922.7 928.7 958.7 20850.4 21849.7 21898.3 21902.9 21935.8 990.0 992.3 1017.9 1018.7 1020.1 11294.7 11368.4 11453.9 11571.4 11660.8 173412.0 173599.0 173951.0 174139.0 174312.0 41612.6 41757.4 41797.2 41857.6 41890.4 1216.5 1243.9 1250.3 1252.2 1256.9 20197.4 20226.8 21051.4 21098.5 21502.4 29713.4 29858.3 30076.8 30101.5 30208.5 147552.0 147804.0 148056.0 148192.0 148423.0 28915.4 29151.9 29213.6 29301.4 29446.6 34581.7 34787.7 35050.6 35673.5 36258.7 26484.0 27248.2 27363.5 27976.4 28487.9 26673.3 26796.6 27066.0 28001.9 28528.3 30510.7 30515.7 30540.0 30568.5 30669.0 25637.5 26352.7 26784.3 26917.4 27136.3 19704.8 21523.9 21677.7 21772.8 21816.2 14:21:22 INFO - PID 29859 | 14:21:22 INFO - PID 29859 | [#2] jquery.html Cycles:180 Average:25215.90 Median:216053.30 stddev:62919.08 (29.1%) stddev-sans-first:63068.02 14:21:22 INFO - PID 29859 | Values: 410.4 416.8 420.2 433.8 440.0 15050.8 17238.5 17899.4 18050.4 18153.9 18350.6 18460.8 18829.9 19299.9 19465.9 5463.6 5484.1 5559.2 5582.3 5605.5 5510.0 5591.5 5594.2 5599.0 5607.3 5291.9 5480.3 5483.7 5507.0 5554.1 5449.1 5465.9 5503.6 5508.7 5523.6 4871.1 4964.2 4970.5 4970.9 4986.7 22905.8 23074.8 23125.8 23164.8 23360.6 1591.0 1642.8 1648.6 1650.1 1654.9 14681.6 14846.6 15273.9 15338.8 15508.9 2036.6 2118.8 2121.9 2135.5 2140.9 84104.6 88504.0 89252.0 90565.5 92294.5 11189.6 11210.2 11212.5 11356.7 11579.7 15654.2 16005.4 16060.9 16108.6 16142.5 7223.2 7273.2 7427.9 7438.6 7485.2 6458.3 6499.5 6682.3 6684.5 6696.4 7241.5 7272.4 7332.3 7381.8 7432.3 2031.4 2036.3 2076.5 2109.1 2210.5 855.7 881.1 898.4 899.5 918.4 16981.2 17155.3 17591.6 17899.9 18107.8 883.2 889.5 903.5 906.1 913.0 9211.7 9390.4 9655.7 9730.6 9803.2 371347.0 374676.0 375771.0 376996.0 392249.0 76731.6 77300.6 77593.6 79669.6 79827.6 1090.2 1122.7 1124.3 1126.7 1130.4 17653.8 17668.3 18462.6 18567.1 18785.8 37505.4 37876.8 38291.4 38476.4 39857.6 47229.5 49160.5 49176.5 49579.3 52214.5 8012.0 8250.8 8472.8 8483.4 8687.0 11802.9 11833.6 11931.7 12007.9 12193.6 10015.8 10145.2 10233.8 10311.1 10495.9 9941.7 10022.4 10060.7 10231.3 10338.8 10087.2 10419.6 10450.7 10582.9 10801.3 8536.3 8546.5 8583.3 8612.0 8706.2 9836.6 9963.6 10146.1 10410.7 10663.3 14:21:22 INFO - PID 29859 | 14:21:22 INFO - PID 29859 | [#3] mootools.html Cycles:180 Average:6075.51 Median:4981.86 stddev:3820.00 (76.7%) stddev-sans-first:3813.67 14:21:22 INFO - PID 29859 | Values: 1272.5 1344.0 1351.9 1356.0 1360.1 9294.6 9451.6 9526.3 9865.9 9886.1 9658.6 9823.9 9842.1 9861.3 9886.5 2176.8 2212.4 2212.4 2214.0 2223.9 2096.6 2171.9 2179.2 2183.7 2189.7 2209.8 2224.4 2255.2 2262.8 2267.9 2110.8 2146.7 2149.4 2151.8 2159.3 2049.9 2055.3 2104.4 2119.8 2169.7 9571.5 9722.0 9735.0 9746.4 9747.6 5297.2 5451.7 5465.8 5466.9 5470.4 3064.3 3343.4 3379.8 3404.8 3408.0 1081.1 1115.4 1121.6 1132.2 1132.5 14035.5 14147.6 14214.1 14358.2 14382.4 4828.2 5031.2 5193.6 5216.4 5220.8 12030.3 12064.6 12073.9 12085.3 12087.6 5570.9 5573.3 5584.6 5587.4 5597.5 4860.2 4882.7 4892.2 4986.2 4986.3 4128.6 4196.4 4219.3 4251.6 4273.5 1325.3 1330.4 1345.1 1367.2 1375.0 692.8 716.7 717.7 729.7 729.8 5188.7 5237.0 5323.7 5371.2 5397.1 548.0 556.8 557.8 561.3 564.0 3375.9 3378.2 3623.7 3723.3 3791.9 12051.9 12395.7 12581.8 12607.9 12608.6 12224.5 12338.6 12396.8 12536.4 12539.5 7089.6 7163.6 7207.9 7228.9 7260.8 5464.0 5490.8 5492.3 5575.6 5626.6 10813.0 10818.9 10942.0 10996.1 11129.3 11216.3 11292.5 11357.1 11458.5 11474.1 7692.2 7917.4 7947.8 8001.3 8039.0 9017.1 9152.8 9202.3 9203.7 9234.1 7309.2 7409.6 7606.7 7698.2 7799.1 7551.2 7659.5 7681.3 7685.7 7732.8 7158.4 7252.3 7334.4 7340.1 7348.2 4977.5 5335.3 5341.7 5544.5 5609.5 4977.0 5025.3 5106.5 5145.8 5149.7 14:21:22 INFO - PID 29859 | 14:21:22 INFO - PID 29859 | [#4] prototype.html Cycles:180 Average:4856.57 Median:5361.87 stddev:1379.28 (25.7%) stddev-sans-first:1341.82 14:21:22 INFO - PID 29859 | Values: 391.8 395.9 396.5 398.3 404.9 5553.9 5589.9 5597.9 5602.5 5608.5 4986.6 5386.8 5402.4 5467.5 5484.3 4317.9 4325.0 4329.2 4329.8 4343.9 4325.3 4327.1 4332.7 4344.3 4356.4 4221.1 4288.4 4306.9 4311.9 4318.3 4286.8 4291.8 4297.5 4297.6 4328.6 3889.0 3894.5 3911.0 3922.2 3925.4 5093.0 5268.6 5286.1 5326.3 5337.0 5109.5 5119.5 5125.5 5128.7 5153.2 5853.9 5885.9 5887.4 5906.0 5919.4 4320.2 4392.3 4402.9 4410.8 4412.9 5987.0 6097.8 6158.9 6181.4 6190.8 4262.3 4283.1 4292.2 4318.7 4325.4 4345.6 4347.2 4350.7 4366.0 4372.7 4832.4 4932.2 4944.7 4951.5 4955.4 5825.1 5832.6 5833.9 5833.9 5858.7 1594.4 1624.8 1626.3 1627.2 1632.4 1089.5 1138.0 1159.6 1161.9 1174.2 5044.6 5091.4 5092.4 5099.9 5117.1 6000.5 6038.5 6067.9 6104.5 6105.8 4999.8 5083.5 5084.7 5124.4 5144.5 3192.9 3198.5 3213.6 3215.2 3218.5 5541.4 5644.6 5646.4 5648.4 5660.2 6127.0 6179.4 6180.6 6186.2 6193.7 5636.2 5643.4 5645.7 5670.6 5670.9 5832.8 5900.9 5952.8 5972.6 6064.1 5925.9 5939.6 5939.8 5941.4 5976.4 5452.8 5599.4 5605.4 5649.2 5666.0 4059.0 4087.3 4094.5 4095.3 4106.1 5945.4 6046.1 6049.5 6060.8 6098.4 5776.7 5807.0 5811.4 5825.5 5892.4 5803.0 5805.2 5815.9 5825.7 5836.9 5642.5 5706.4 5708.9 5755.2 5768.1 5864.7 5876.7 5879.1 5881.3 5887.4 5446.9 5637.3 5654.8 5667.3 5694.4 14:21:22 INFO - PID 29859 | 14:21:22 INFO - PID 29859 | [#5] yui.html Cycles:180 Average:15415.99 Median:3213.32 stddev:18357.93 (571.3%) stddev-sans-first:18376.48 14:21:22 INFO - PID 29859 | Values: 767.9 775.7 794.3 796.1 801.2 12994.3 13540.8 13577.0 13819.9 13847.7 15426.0 15592.5 15866.6 15907.2 16324.7 835.6 853.8 854.7 855.9 856.6 890.9 891.8 896.4 896.6 896.7 934.4 938.2 942.2 943.7 945.4 928.9 930.2 930.6 932.2 933.6 685.7 688.3 689.6 691.8 692.2 13089.8 13407.9 14761.4 14937.6 14966.8 14822.3 14850.3 14892.2 15003.5 15197.2 12460.7 12632.9 12662.6 12789.2 12790.1 2862.5 2865.9 2882.0 2891.5 2893.4 70483.0 70545.0 71118.3 71247.3 72115.0 11142.9 11177.8 11224.6 11241.6 11253.5 17896.7 17916.2 18064.0 18311.8 18360.9 6031.4 6118.0 6270.1 6284.6 6293.8 3001.6 3069.3 3073.3 3084.5 3095.3 3193.7 3233.0 3242.0 3254.0 3258.5 766.4 786.3 788.0 793.2 793.6 598.8 603.7 604.7 614.7 630.9 10376.5 10381.1 10441.0 10675.8 10756.4 604.0 609.9 613.8 628.8 632.6 4399.1 4473.4 4542.0 4542.8 4558.4 61265.4 62424.0 63024.4 65779.0 66368.7 57051.4 57082.7 57182.0 57766.1 58025.5 50256.5 50824.7 51262.5 51434.7 52191.7 9075.9 9318.4 9426.5 9530.9 9694.4 27954.4 28030.2 28116.6 28197.3 28727.4 32689.7 32741.8 44885.6 46236.8 46845.0 13285.4 13395.2 13400.5 13531.6 13640.8 14956.4 15684.1 15941.0 15948.8 16548.0 14505.1 14733.9 15116.3 15243.7 15332.8 14077.3 14282.4 14552.3 14770.2 14852.3 13025.7 13824.4 14495.0 14702.9 15053.5 10539.8 10663.0 10696.3 10794.8 11039.6 10796.0 11164.3 11408.4 11493.7 12127.5 14:21:22 INFO - PID 29859 | -------- Summary: end -------- 14:21:22 INFO - PID 29859 | 14:21:23 INFO - TEST-INFO | 29859: exit 0 14:21:23 INFO - TEST-OK | dromaeo_css | took 1119867ms 14:21:23 INFO - TEST-START | kraken 14:21:23 INFO - operating with platform_type : linux_ 14:21:23 INFO - Initialising browser for kraken test... 14:21:23 INFO - TEST-INFO | started process 30258 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkZowAr/profile http://localhost:54913/getInfo.html) 14:21:27 INFO - PID 30258 | __metrics Screen width/height:1600/1200 14:21:27 INFO - PID 30258 | colorDepth:24 14:21:27 INFO - PID 30258 | Browser inner width/height: 1024/695 14:21:27 INFO - PID 30258 | __metrics 14:21:29 INFO - TEST-INFO | 30258: exit 0 14:21:29 INFO - Browser initialized. 14:21:29 INFO - Running cycle 1/1 for kraken test... 14:21:29 INFO - TEST-INFO | started process 30405 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkZowAr/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:21:41 INFO - PID 30405 | RSS: Main: 175579136 14:21:41 INFO - PID 30405 | 14:21:43 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54913/tests/kraken/driver.html?testName=audio-beat-detection) 14:21:44 INFO - PID 30405 | RSS: Main: 182878208 14:21:44 INFO - PID 30405 | 14:21:47 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54913/tests/kraken/driver.html?testName=audio-dft) 14:21:48 INFO - PID 30405 | RSS: Main: 181780480 14:21:48 INFO - PID 30405 | 14:21:51 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54913/tests/kraken/driver.html?testName=audio-fft) 14:21:51 INFO - PID 30405 | RSS: Main: 179503104 14:21:51 INFO - PID 30405 | 14:21:53 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54913/tests/kraken/driver.html?testName=audio-oscillator) 14:21:54 INFO - PID 30405 | RSS: Main: 179073024 14:21:54 INFO - PID 30405 | 14:21:56 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54913/tests/kraken/driver.html?testName=imaging-gaussian-blur) 14:21:57 INFO - PID 30405 | RSS: Main: 180117504 14:21:57 INFO - PID 30405 | 14:22:00 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54913/tests/kraken/driver.html?testName=imaging-darkroom) 14:22:00 INFO - PID 30405 | RSS: Main: 184074240 14:22:00 INFO - PID 30405 | 14:22:04 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54913/tests/kraken/driver.html?testName=imaging-desaturate) 14:22:05 INFO - PID 30405 | RSS: Main: 181989376 14:22:05 INFO - PID 30405 | 14:22:08 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54913/tests/kraken/driver.html?testName=json-parse-financial) 14:22:08 INFO - PID 30405 | RSS: Main: 183930880 14:22:08 INFO - PID 30405 | 14:22:10 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54913/tests/kraken/driver.html?testName=json-stringify-tinderbox) 14:22:10 INFO - PID 30405 | RSS: Main: 185085952 14:22:10 INFO - PID 30405 | 14:22:12 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54913/tests/kraken/driver.html?testName=stanford-crypto-aes) 14:22:13 INFO - PID 30405 | RSS: Main: 185036800 14:22:13 INFO - PID 30405 | 14:22:15 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54913/tests/kraken/driver.html?testName=stanford-crypto-ccm) 14:22:16 INFO - PID 30405 | RSS: Main: 185606144 14:22:16 INFO - PID 30405 | 14:22:18 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54913/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 14:22:19 INFO - PID 30405 | RSS: Main: 184971264 14:22:19 INFO - PID 30405 | 14:22:22 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54913/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 14:22:23 INFO - PID 30405 | RSS: Main: 185995264 14:22:23 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | Cycle 1(1): loaded http://localhost:54913/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54913/tests/kraken/driver.html?testName=ai-astar) 14:22:25 INFO - PID 30405 | RSS: Main: 187944960 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | __start_tp_report 14:22:25 INFO - PID 30405 | _x_x_mozilla_page_load 14:22:25 INFO - PID 30405 | _x_x_mozilla_page_load_details 14:22:25 INFO - PID 30405 | |i|pagename|runs| 14:22:25 INFO - PID 30405 | |0;ai-astar;107;112;112;110;112;114;111;113;112;112 14:22:25 INFO - PID 30405 | |1;audio-beat-detection;149;129;125;170;131;131;124;124;162;133 14:22:25 INFO - PID 30405 | |2;audio-dft;164;164;164;164;167;176;164;166;165;165 14:22:25 INFO - PID 30405 | |3;audio-fft;77;75;74;110;77;74;76;74;92;74 14:22:25 INFO - PID 30405 | |4;audio-oscillator;85;85;102;84;86;84;95;84;85;113 14:22:25 INFO - PID 30405 | |5;imaging-gaussian-blur;114;114;114;114;114;114;114;115;113;114 14:22:25 INFO - PID 30405 | |6;imaging-darkroom;151;155;153;150;152;152;149;150;151;152 14:22:25 INFO - PID 30405 | |7;imaging-desaturate;94;96;94;94;94;94;95;94;95;94 14:22:25 INFO - PID 30405 | |8;json-parse-financial;53;53;52;57;53;54;53;55;54;53 14:22:25 INFO - PID 30405 | |9;json-stringify-tinderbox;55;55;54;54;56;55;56;56;55;56 14:22:25 INFO - PID 30405 | |10;stanford-crypto-aes;84;83;83;81;83;82;82;83;83;82 14:22:25 INFO - PID 30405 | |11;stanford-crypto-ccm;142;137;137;132;137;145;137;141;225;127 14:22:25 INFO - PID 30405 | |12;stanford-crypto-pbkdf2;184;186;193;186;192;192;200;184;195;190 14:22:25 INFO - PID 30405 | |13;stanford-crypto-sha256-iterative;70;74;71;78;70;71;73;74;71;72 14:22:25 INFO - PID 30405 | __end_tp_report 14:22:25 INFO - PID 30405 | __start_cc_report 14:22:25 INFO - PID 30405 | _x_x_mozilla_cycle_collect,814 14:22:25 INFO - PID 30405 | __end_cc_report 14:22:25 INFO - PID 30405 | __startTimestamp1493846545630__endTimestamp 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | ------- Summary: start ------- 14:22:25 INFO - PID 30405 | Number of tests: 14 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#0] ai-astar Cycles:10 Average:111.50 Median:112.00 stddev:1.90 (1.7%) stddev-sans-first:1.12 14:22:25 INFO - PID 30405 | Values: 107.0 112.0 112.0 110.0 112.0 114.0 111.0 113.0 112.0 112.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#1] audio-beat-detection Cycles:10 Average:137.80 Median:132.00 stddev:16.62 (12.6%) stddev-sans-first:17.13 14:22:25 INFO - PID 30405 | Values: 149.0 129.0 125.0 170.0 131.0 131.0 124.0 124.0 162.0 133.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#2] audio-dft Cycles:10 Average:165.90 Median:165.00 stddev:3.70 (2.2%) stddev-sans-first:3.86 14:22:25 INFO - PID 30405 | Values: 164.0 164.0 164.0 164.0 167.0 176.0 164.0 166.0 165.0 165.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#3] audio-fft Cycles:10 Average:80.30 Median:75.50 stddev:11.77 (15.6%) stddev-sans-first:12.42 14:22:25 INFO - PID 30405 | Values: 77.0 75.0 74.0 110.0 77.0 74.0 76.0 74.0 92.0 74.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#4] audio-oscillator Cycles:10 Average:90.30 Median:85.00 stddev:9.98 (11.7%) stddev-sans-first:10.40 14:22:25 INFO - PID 30405 | Values: 85.0 85.0 102.0 84.0 86.0 84.0 95.0 84.0 85.0 113.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#5] imaging-gaussian-blur Cycles:10 Average:114.00 Median:114.00 stddev:0.47 (0.4%) stddev-sans-first:0.50 14:22:25 INFO - PID 30405 | Values: 114.0 114.0 114.0 114.0 114.0 114.0 114.0 115.0 113.0 114.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#6] imaging-darkroom Cycles:10 Average:151.50 Median:152.00 stddev:1.72 (1.1%) stddev-sans-first:1.81 14:22:25 INFO - PID 30405 | Values: 151.0 155.0 153.0 150.0 152.0 152.0 149.0 150.0 151.0 152.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#7] imaging-desaturate Cycles:10 Average:94.40 Median:94.00 stddev:0.70 (0.7%) stddev-sans-first:0.73 14:22:25 INFO - PID 30405 | Values: 94.0 96.0 94.0 94.0 94.0 94.0 95.0 94.0 95.0 94.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#8] json-parse-financial Cycles:10 Average:53.70 Median:53.50 stddev:1.42 (2.7%) stddev-sans-first:1.48 14:22:25 INFO - PID 30405 | Values: 53.0 53.0 52.0 57.0 53.0 54.0 53.0 55.0 54.0 53.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#9] json-stringify-tinderbox Cycles:10 Average:55.20 Median:55.50 stddev:0.79 (1.4%) stddev-sans-first:0.83 14:22:25 INFO - PID 30405 | Values: 55.0 55.0 54.0 54.0 56.0 55.0 56.0 56.0 55.0 56.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#10] stanford-crypto-aes Cycles:10 Average:82.60 Median:83.00 stddev:0.84 (1.0%) stddev-sans-first:0.73 14:22:25 INFO - PID 30405 | Values: 84.0 83.0 83.0 81.0 83.0 82.0 82.0 83.0 83.0 82.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#11] stanford-crypto-ccm Cycles:10 Average:146.00 Median:139.00 stddev:28.21 (20.3%) stddev-sans-first:29.89 14:22:25 INFO - PID 30405 | Values: 142.0 137.0 137.0 132.0 137.0 145.0 137.0 141.0 225.0 127.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:190.20 Median:192.00 stddev:5.22 (2.7%) stddev-sans-first:5.04 14:22:25 INFO - PID 30405 | Values: 184.0 186.0 193.0 186.0 192.0 192.0 200.0 184.0 195.0 190.0 14:22:25 INFO - PID 30405 | 14:22:25 INFO - PID 30405 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.40 Median:72.50 stddev:2.46 (3.4%) stddev-sans-first:2.45 14:22:25 INFO - PID 30405 | Values: 70.0 74.0 71.0 78.0 70.0 71.0 73.0 74.0 71.0 72.0 14:22:25 INFO - PID 30405 | -------- Summary: end -------- 14:22:25 INFO - PID 30405 | 14:22:26 INFO - TEST-INFO | 30405: exit 0 14:22:26 INFO - TEST-OK | kraken | took 63919ms 14:22:26 INFO - SUITE-END | took 1183s 14:22:27 INFO - Completed test suite (00:19:44) 14:22:27 INFO - javascript benchmark 14:22:27 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6735.992006292411, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2740.2327348342446, 2757.4485102979397, 2762.047093752655, 2770.653668291465, 2787.3310405502684, 5123.154679477891, 5142.562882155016, 5158.071547121516, 5173.482651734825, 5192.922106168406, 5216.921746173801, 5221.190715439104, 5242.501962313584, 5343.572514198864, 5358.437364076774, 4327.740335579875, 4594.494605593382, 4674.555917187861, 4696.201645720219, 4707.1762441572755, 4720.976395118019, 4759.95281038171, 4772.260299653542, 4786.018866132435, 4822.638302127337, 4645.396098507173, 4684.156851766681, 4703.6942598730975, 4710.24636058229, 4710.576048155683, 4671.112488627184, 4686.601638860667, 4715.339852420664, 4758.310045043484, 4759.428868535798, 4640.118377508263, 4645.140648979949, 4657.068586282723, 4693.718376897397, 4697.929531057037, 5082.593392528589, 5132.230165475171, 5210.192420174841, 5218.13900706383, 5234.502722241419, 5625.80309689163, 5678.630888992244, 5719.742611582489, 5729.627574207705, 5769.596128271022, 5745.88508229833, 5756.8848623027725, 5771.192033115367, 5783.0747080467345, 5798.391168927286, 5203.375594928632, 5254.159334506537, 5255.817441075727, 5308.601854860901, 5352.759125839347, 5835.0, 5856.0, 5901.675407852524, 5927.436893495111, 5932.614380065282, 5434.402215756264, 5541.5843811714285, 5554.1946417770005, 5557.527610153183, 5561.360443548962, 5601.187827764951, 5601.467860553241, 5650.406707295757, 5655.095184770417, 5663.688497132697, 5588.9720551397795, 5589.832305030855, 5594.86012849682, 5596.2165296858475, 5596.86007849807, 5620.718964051863, 5629.831105066854, 5630.662160270397, 5633.549316054706, 5640.71796410186, 4715.7642117893965, 4721.268203428474, 4726.692764970266, 4728.881777955578, 4729.929051064237, 4129.938050929239, 4152.065785198367, 4159.209750147463, 4162.084341444877, 4191.392248124005, 4822.180229361017, 4932.975335123301, 4966.543637330031, 4972.105021096165, 5011.273365362075, 5643.322801263875, 5708.885822283531, 5710.200571919934, 5721.141828725725, 5739.110437882135, 4921.163402221631, 4923.90152196954, 4926.088673595396, 4940.283658869444, 5001.324821149171, 5100.438951715309, 5105.821296254613, 5114.923276150861, 5119.078565858182, 5119.411267704113, 5287.656302340336, 5351.518363347317, 5365.543928766098, 5395.379531353945, 5402.6758394496455, 5793.04414771558, 5819.854503637443, 5822.184894114912, 5829.0, 5832.212651292021, 5375.919361209507, 5389.75746091419, 5392.595555333287, 5393.083175860034, 5393.649412788313, 5570.220169176399, 5654.830355089354, 5667.801626943037, 5682.204491371129, 5710.971445142748, 5734.910367030251, 5753.626014309057, 5787.0, 5787.2187254720075, 5835.299764028344, 5529.861753456195, 5599.412061733622, 5611.691356975405, 5614.382417934105, 5630.324361076697, 5420.512153906167, 5553.611247212656, 5554.861128471821, 5573.331200255995, 5595.412481689364, 5498.3127109111365, 5539.8892022160135, 5540.168974653834, 5551.25058117149, 5595.8880822384135, 5507.311586051744, 5614.045612245846, 5649.802256920988, 5669.574781891457, 5669.688167150846, 5383.300170977748, 5444.26502422168, 5531.557475402039, 5533.335999680065, 5547.5007249347755], "value": 5174.681706107554, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [693.8681650486408, 748.7154881145165, 755.7014979083262, 1054.7310435838865, 1067.2795862792623, 31757.206069848264, 32742.0, 32746.0, 32757.508637370458, 32866.34267314655, 34606.40451966106, 35072.64927350726, 35142.297154056905, 35218.64781352186, 35347.4697879532, 6831.077804496404, 6851.725930962781, 6923.065386172878, 7026.227115017344, 7029.929700702979, 6886.311368863124, 6963.79108626742, 6987.755428560002, 6989.6854641540995, 6991.580505169681, 6938.618375989318, 6956.165260168762, 7013.719451221945, 7019.719211231544, 7029.402500787413, 6879.690413931385, 6932.306769323052, 6939.375456208965, 6944.79165625027, 6946.861062778716, 6861.656917154122, 6905.240423553405, 6926.896096558556, 6927.203371612279, 7005.369516743517, 32191.0, 32542.511862322084, 32548.67451325504, 32559.51160732591, 32775.34449311, 3074.108508532523, 3103.4103520331064, 3106.0371284901753, 3106.813591184536, 3109.0, 24823.62764558533, 24862.0, 24899.128530501526, 24940.50118997628, 25019.749802501923, 3120.9063728088195, 3148.4175427545747, 3158.4314823331792, 3168.413843438971, 3183.9522407163913, 142598.28700856428, 143895.2805235967, 144066.0, 147082.26458867636, 147397.26301368533, 40247.1950560993, 40261.0, 40287.0, 40407.79796101001, 40466.0, 41641.58358416438, 41729.79135104305, 41849.37225941613, 41871.16257674829, 41991.58008419938, 11672.94163529194, 11712.774572831135, 11775.88224117765, 11778.352190629426, 11781.116416268815, 9321.114494123047, 9321.161095501302, 9348.345615806827, 9354.064593540592, 9361.204297634777, 12646.430910609044, 12691.68270793219, 12731.872681273255, 12810.80783788244, 12908.225506469642, 5325.760340784674, 5353.680717954815, 5378.2470454136455, 5393.541548968303, 5432.2123292123215, 890.857462805948, 913.0869130869131, 922.6678395777515, 928.6749637626776, 958.6740508227236, 20850.374488765363, 21849.67225491619, 21898.343049708536, 21902.890485547472, 21935.780642193375, 989.9653512127041, 992.3239072505258, 1017.8931212222758, 1018.6791160784329, 1020.1430798129607, 11294.661160165208, 11368.431578421212, 11453.942730286295, 11571.363575003455, 11660.76678466426, 173412.0, 173599.0, 173951.0, 174139.0, 174312.0, 41612.58387416148, 41757.37363939543, 41797.1640567187, 41857.58142418598, 41890.37164442536, 1216.4769149265724, 1243.9378031098408, 1250.306080125539, 1252.2236213547658, 1256.9120161588785, 20197.394078177676, 20226.797732022493, 21051.368458946257, 21098.472538186055, 21502.354929352143, 29713.405731885672, 29858.253543660714, 30076.84961575178, 30101.548476773303, 30208.5468717965, 147552.0, 147804.0, 148056.0, 148192.0, 148423.0, 28915.42169156563, 29151.854240728662, 29213.561796572645, 29301.41397172087, 29446.558301625922, 34581.654183457846, 34787.65212347844, 35050.64949350474, 35673.46489802603, 36258.73094441682, 26484.0, 27248.182554523395, 27363.452730945668, 27976.44047119087, 28487.857560712062, 26673.33316667099, 26796.59805102886, 27066.0, 28001.85999070073, 28528.286792830346, 30510.694893050786, 30515.694843052173, 30540.0, 30568.541471877495, 30669.0, 25637.48725025452, 26352.736472635796, 26784.33039174036, 26917.366155568747, 27136.321591959568, 19704.802951970298, 21523.892380537996, 21677.674834877806, 21772.782272177075, 21816.236431724814], "value": 14476.351819858974, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [410.3639358993559, 416.76452804165626, 420.17226064652635, 433.83947939262475, 440.0385158428833, 15050.774238386406, 17238.482845514638, 17899.373521926736, 18050.368237111703, 18153.909230453846, 18350.632987340246, 18460.815391846078, 18829.90585047076, 19299.903500482476, 19465.902670486626, 5463.644863083907, 5484.122540393528, 5559.221708960748, 5582.274304340451, 5605.495505404513, 5509.9806535791, 5591.496765291123, 5594.188842617818, 5598.972005139969, 5607.299087614048, 5291.894162116755, 5480.287562616854, 5483.698396588186, 5506.953678801035, 5554.1113421852515, 5449.073657478239, 5465.945340546584, 5503.587230957694, 5508.669479831203, 5523.613347065687, 4871.098846713334, 4964.180910149821, 4970.502949705036, 4970.850874473772, 4986.650934434591, 22905.770942290696, 23074.76925230743, 23125.768742312528, 23164.76835231643, 23360.64959025616, 1590.952271431859, 1642.8110767261678, 1648.5960939569882, 1650.1254335202361, 1654.8593369563603, 14681.632959175999, 14846.628834279121, 15273.923630381889, 15338.846611533854, 15508.92245538765, 2036.5926814636985, 2118.809307162363, 2121.9151233950624, 2135.4981579328846, 2140.8608440451476, 84104.57947710283, 88504.0, 89252.0, 90565.54717226372, 92294.53852730761, 11189.608363707232, 11210.159238057178, 11212.495437705324, 11356.659300221007, 11579.652610421532, 15654.217289135726, 16005.439809606607, 16060.919695401448, 16108.597285067966, 16142.515724528283, 7223.226141389607, 7273.199948005715, 7427.888581671279, 7438.59087750179, 7485.214052524516, 6458.321876202931, 6499.54503184782, 6682.2936710632275, 6684.532082754258, 6696.397324240745, 7241.537877121804, 7272.418206543463, 7332.340089391981, 7381.778546643609, 7432.2567743225245, 2031.410890841669, 2036.3076553971425, 2076.512019675405, 2109.061467646913, 2210.5357874846463, 855.6791203298762, 881.0704706534667, 898.4250079948838, 899.4962820820361, 918.3755046568398, 16981.235844387033, 17155.313787448362, 17591.560210994572, 17899.855565717826, 18107.81892181088, 883.1609970527895, 889.5418859287472, 903.4940433357341, 906.1255888068046, 912.9726108216764, 9211.69704591443, 9390.389624674512, 9655.662051828152, 9730.562124704406, 9803.166730827817, 371347.0, 374676.0, 375771.0, 376996.0, 392249.0, 76731.61634191794, 77300.60737332168, 77593.61203193948, 79669.60165199137, 79827.60086199532, 1090.1823632275793, 1122.7193201699574, 1124.2579897267765, 1126.6957921361186, 1130.4121856634504, 17653.82346176522, 17668.293268269124, 18462.63074738471, 18567.071646417357, 18785.812141878407, 37505.437418439295, 37876.81061594674, 38291.42562861615, 38476.42285365666, 39857.60142398539, 47229.527704723885, 49160.50839491702, 49176.50823491719, 49579.25631115464, 52214.47785522096, 8012.0, 8250.793730156554, 8472.83054338922, 8483.36374771907, 8686.956565217133, 11802.94098529502, 11833.644990650295, 11931.701707457383, 12007.879921200676, 12193.561287742665, 10015.849762253427, 10145.239107067147, 10233.795324093328, 10311.123554497952, 10495.947520262655, 9941.65204217849, 10022.398656080659, 10060.69817905464, 10231.334963227664, 10338.793224135625, 10087.243456740627, 10419.583216671248, 10450.738731531772, 10582.894171058499, 10801.297915635458, 8536.274416674652, 8546.529940853065, 8583.313334933315, 8612.0, 8706.1729135732, 9836.557354919189, 9963.551640176354, 10146.086852183338, 10410.68767936963, 10663.253572250178], "value": 8875.257628233956, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1272.5228039485194, 1344.0390121063444, 1351.8648135186484, 1355.9932200338997, 1360.0887405438352, 9294.628214871414, 9451.574679139438, 9526.285528585366, 9865.852012219822, 9886.060824221706, 9658.613655453792, 9823.901760982388, 9842.065003824644, 9861.2604054696, 9886.456244906527, 2176.847620666554, 2212.3694746997107, 2212.4358288636377, 2213.9889300553473, 2223.9332820015425, 2096.6016456873144, 2171.869687818736, 2179.171914672422, 2183.7379514458207, 2189.6715492676067, 2209.7679743626927, 2224.377174391173, 2255.22194842779, 2262.7737226277322, 2267.8639281643073, 2110.8205802506805, 2146.710194123789, 2149.355193441969, 2151.8170955468804, 2159.3198142585034, 2049.897505124738, 2055.270379015458, 2104.442322784463, 2119.7774233705395, 2169.739631244245, 9571.521423928776, 9722.0, 9735.0, 9746.415215087118, 9747.61009559624, 5297.205419187114, 5451.672899625995, 5465.836024919259, 5466.945330546683, 5470.425605311425, 3064.295212101229, 3343.36476069546, 3379.8141102239365, 3404.8297585120895, 3407.9659203408146, 1081.1404933078222, 1115.4199816095665, 1121.5962253588702, 1132.162199972023, 1132.5413207650831, 14035.508757193551, 14147.575572732834, 14214.147151170962, 14358.210298433582, 14382.352794124185, 4828.179209534387, 5031.195008798574, 5193.636445448782, 5216.37403511581, 5220.843374698765, 12030.27818330903, 12064.57773977924, 12073.939630301793, 12085.335306558049, 12087.576934807239, 5570.86072848182, 5573.27547418833, 5584.636998595079, 5587.38538760736, 5597.524210442077, 4860.198067318853, 4882.731449770296, 4892.168331383602, 4986.2271347940405, 4986.252062190701, 4128.587141285848, 4196.3705444183615, 4219.282721937278, 4251.639475367914, 4273.529911709709, 1325.2975922760952, 1330.4079684540286, 1345.1122259308809, 1367.2138520350838, 1375.0374737683662, 692.7990882644077, 716.698986425692, 717.6985666020284, 729.6898818002328, 729.7555318968099, 5188.7405629719115, 5237.0, 5323.653962492425, 5371.248025276464, 5397.055515284809, 548.0, 556.8357334586307, 557.7908284393352, 561.2899681902396, 563.9548836093103, 3375.8987230383127, 3378.223008708011, 3623.710103191738, 3723.3298006358573, 3791.905202369963, 12051.939740301243, 12395.690107747198, 12581.811272830915, 12607.936960315139, 12608.621741347773, 12224.511019559295, 12338.629841104781, 12396.752064958831, 12536.435860386304, 12539.498420063095, 7089.61007144612, 7163.6060016699585, 7207.89188162178, 7228.855422891618, 7260.818479537948, 5463.972680136574, 5490.780368785364, 5492.258545096361, 5575.581831362745, 5626.5780066496, 10813.0, 10818.891811081789, 10942.0, 10996.12031037531, 11129.332240065622, 11216.270942388719, 11292.49183786748, 11357.0914326852, 11458.484368203617, 11474.082073434272, 7692.19231980634, 7917.406194535318, 7947.841043178988, 8001.319887809368, 8039.0, 9017.09829017093, 9152.771180720536, 9202.263818894606, 9203.677871274473, 9234.076592340713, 7309.232530584425, 7409.592472414069, 7606.695732170872, 7698.230176982257, 7799.06411230656, 7551.244875512624, 7659.463837531319, 7681.347085497795, 7685.730999414994, 7732.7680169595005, 7158.427325813818, 7252.311030452099, 7334.413246940126, 7340.11918569775, 7348.191698913009, 4977.502249774993, 5335.33308336458, 5341.679499230058, 5544.473275038865, 5609.523190528851, 4977.0, 5025.296458495741, 5106.463821298858, 5145.794168233228, 5149.665271757323], "value": 4611.077955759083, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [391.8158465521206, 395.9086152084197, 396.48457005892334, 398.27513924657137, 404.9028233224025, 5553.888922221553, 5589.944100559003, 5597.888042239153, 5602.523785478239, 5608.523275521576, 4986.576141028008, 5386.78452861885, 5402.37872644645, 5467.535259502947, 5484.314460692413, 4317.913641727164, 4325.0, 4329.19909816685, 4329.805158767856, 4343.891402714926, 4325.2647050001415, 4327.091310824715, 4332.675049371294, 4344.261475549149, 4356.390105385249, 4221.134667393177, 4288.356746488021, 4306.935395969063, 4311.892202694942, 4318.265894797876, 4286.849960251392, 4291.828326866922, 4297.474396589213, 4297.561950439667, 4328.588784065509, 3888.9611103888883, 3894.4742459767854, 3910.980445097785, 3922.195949830278, 3925.371940489508, 5092.9559440315015, 5268.578513718893, 5286.127788914824, 5326.307580014573, 5336.959292937879, 5109.463506331819, 5119.513646203604, 5125.4618265082, 5128.666636668605, 5153.201253805666, 5853.941460585383, 5885.90989730395, 5887.35239123696, 5905.970470147665, 5919.378465261128, 4320.200762858881, 4392.330914252596, 4402.8679139625865, 4410.75740834254, 4412.911741765147, 5986.964432093109, 6097.756089756404, 6158.938410615881, 6181.443670069715, 6190.783322583733, 4262.25410553152, 4283.143371325685, 4292.227399068135, 4318.676099292566, 4325.351197320427, 4345.587169218919, 4347.217500849877, 4350.671082273158, 4365.956340436555, 4372.650187984954, 4832.420109586872, 4932.186189278729, 4944.678595891256, 4951.529604687549, 4955.35580374549, 5825.097109947965, 5832.591718579659, 5833.883322333614, 5833.891560603472, 5858.7070646468355, 1594.4100682747458, 1624.8375162483894, 1626.349460215923, 1627.1782749711556, 1632.4041724770611, 1089.5315014543664, 1138.0383575878534, 1159.5535718748342, 1161.9128565357632, 1174.225011492428, 5044.646874718735, 5091.3635795524815, 5092.414372347153, 5099.8725031873755, 5117.130087885069, 6000.459958603747, 6038.5169186465855, 6067.878642427127, 6104.481119104837, 6105.778844231171, 4999.75001249936, 5083.466236045236, 5084.669496482717, 5124.410692770379, 5144.511271429283, 3192.920176995547, 3198.4722520784276, 3213.5983002124735, 3215.2122729930848, 3218.4850423932057, 5541.418151094158, 5644.6330988485615, 5646.407127251661, 5648.378678345379, 5660.2075709400715, 6126.969365153146, 6179.443850053517, 6180.598261113013, 6186.226721659793, 6193.7263288330905, 5636.154576813511, 5643.351014633287, 5645.717714114277, 5670.574706896917, 5670.86582683465, 5832.77511722543, 5900.940990590039, 5952.791652292149, 5972.5520585955355, 6064.120702498025, 5925.881482370414, 5939.643621382731, 5939.821805345847, 5941.37615550361, 5976.432238937294, 5452.809151679672, 5599.356074051536, 5605.355384130877, 5649.180868774087, 5666.0, 4058.9797051014557, 4087.346024636044, 4094.5086589608245, 4095.344744840811, 4106.0761328702, 5945.42446251735, 6046.123312119806, 6049.485793707584, 6060.757569697163, 6098.359672234352, 5776.682282474504, 5806.970965145148, 5811.389804070512, 5825.50483208932, 5892.381299963442, 5802.970985145047, 5805.187273781758, 5815.94184058154, 5825.70871456434, 5836.9493491172, 5642.520385767256, 5706.400827913176, 5708.859177808322, 5755.223044888887, 5768.105943578752, 5864.67744274069, 5876.735546900314, 5879.147523609138, 5881.264841894763, 5887.352391236875, 5446.930166536691, 5637.267155269788, 5654.773809047592, 5667.3482549507335, 5694.402087780889], "value": 4445.926196400306, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [767.8963339949105, 775.6587101675262, 794.3446656508379, 796.1202870827735, 801.226816122442, 12994.28531430771, 13540.796888046674, 13577.0, 13819.930900345496, 13847.723045539084, 15426.0, 15592.45426410076, 15866.603334916605, 15907.204639767995, 16324.673506529862, 835.6406745099605, 853.8078932240259, 854.6709516836, 855.9101294364095, 856.5845564901018, 890.875277461156, 891.8082612238368, 896.4307664632972, 896.6413434626137, 896.6771962093674, 934.4393363981625, 938.2212763406391, 942.2367882015556, 943.7310366545536, 945.4469135555709, 928.9256859451227, 930.2279108340061, 930.5951910918772, 932.1936524905975, 933.6452148183681, 685.6503183376464, 688.3495097133211, 689.5759108148503, 691.7959202035412, 692.1935944624506, 13089.803652945213, 13407.932960335233, 14761.409543618242, 14937.626559335995, 14966.775498367424, 14822.332995015251, 14850.331735071948, 14892.180930048842, 15003.549893503103, 15197.164155971417, 12460.688482788002, 12632.936835315764, 12662.55681051168, 12789.232646041268, 12790.104692671517, 2862.470442968037, 2865.871035803373, 2882.0, 2891.508443564599, 2893.4068515954177, 70482.9517048291, 70545.0, 71118.2888171122, 71247.2875271251, 72115.0, 11142.888571114347, 11177.776444471228, 11224.55101795919, 11241.550337986553, 11253.549858005752, 17896.731549026776, 17916.193771280323, 18064.0, 18311.816881831277, 18360.90819545894, 6031.4270144336215, 6117.969410153009, 6270.122182894307, 6284.622922624657, 6293.779717709858, 3001.6097907271915, 3069.3094053838154, 3073.3085055862252, 3084.521899105642, 3095.334503081848, 3193.6806319368343, 3232.951505727416, 3241.9787766853365, 3254.0, 3258.478643417042, 766.3677466090497, 786.3080489169495, 787.9795664614223, 793.2345286798268, 793.6388943030908, 598.8233471126028, 603.6528995827417, 604.7188057553171, 614.6895817612077, 630.9116723658691, 10376.481175941324, 10381.117605003508, 10441.0, 10675.83986240207, 10756.408397538211, 603.9909401358983, 609.8780243951228, 613.8189234175928, 628.8396458902951, 632.6077831744255, 4399.098184872094, 4473.3960915276675, 4542.046170304273, 4542.772861356919, 4558.407407037064, 61265.38734612686, 62424.0, 63024.36975630277, 65779.0, 66368.66815665987, 57051.42948570461, 57082.71458642763, 57182.0, 57766.133507997416, 58025.45669062995, 50256.497435025914, 50824.74587627038, 51262.48737512652, 51434.74282628563, 52191.73904130455, 9075.863862041942, 9318.394304370195, 9426.528673566158, 9530.904690953003, 9694.36986595869, 27954.440911181257, 28030.15909522636, 28116.57825132584, 28197.295067623472, 28727.425451490435, 32689.673103268662, 32741.836290819345, 44885.551144488134, 46236.7688161557, 46845.0, 13285.402156903156, 13395.196288222738, 13400.463981440633, 13531.59405217845, 13640.79538806899, 14956.40174393012, 15684.137372444626, 15941.0, 15948.760768588249, 16548.007119572863, 14505.129692218501, 14733.852661473677, 15116.319765610355, 15243.695126097638, 15332.846671533589, 14077.296135193405, 14282.357293922007, 14552.27238638085, 14770.187639679922, 14852.257387130385, 13025.739485210432, 13824.447022119002, 14495.0, 14702.926485367505, 15053.548393548212, 10539.841902371318, 10663.0, 10696.304740191863, 10794.784104318027, 11039.558417663204, 10796.0, 11164.330140191614, 11408.429578520874, 11493.655190344303, 12127.514899404277], "value": 6853.14114647987, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1545.8000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [107.0, 112.0, 112.0, 110.0, 112.0, 114.0, 111.0, 113.0, 112.0, 112.0], "value": 111.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 129.0, 125.0, 170.0, 131.0, 131.0, 124.0, 124.0, 162.0, 133.0], "value": 137.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 164.0, 164.0, 164.0, 167.0, 176.0, 164.0, 166.0, 165.0, 165.0], "value": 165.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 75.0, 74.0, 110.0, 77.0, 74.0, 76.0, 74.0, 92.0, 74.0], "value": 80.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 102.0, 84.0, 86.0, 84.0, 95.0, 84.0, 85.0, 113.0], "value": 90.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 114.0, 114.0, 114.0, 114.0, 114.0, 115.0, 113.0, 114.0], "value": 114.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 155.0, 153.0, 150.0, 152.0, 152.0, 149.0, 150.0, 151.0, 152.0], "value": 151.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 96.0, 94.0, 94.0, 94.0, 94.0, 95.0, 94.0, 95.0, 94.0], "value": 94.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 53.0, 52.0, 57.0, 53.0, 54.0, 53.0, 55.0, 54.0, 53.0], "value": 53.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 55.0, 54.0, 54.0, 56.0, 55.0, 56.0, 56.0, 55.0, 56.0], "value": 55.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 83.0, 81.0, 83.0, 82.0, 82.0, 83.0, 83.0, 82.0], "value": 82.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 137.0, 137.0, 132.0, 137.0, 145.0, 137.0, 141.0, 225.0, 127.0], "value": 146.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [184.0, 186.0, 193.0, 186.0, 192.0, 192.0, 200.0, 184.0, 195.0, 190.0], "value": 190.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 74.0, 71.0, 78.0, 70.0, 71.0, 73.0, 74.0, 71.0, 72.0], "value": 72.4, "unit": "score"}]}]} 14:22:27 INFO - Return code: 0 14:22:27 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 14:22:27 INFO - # TBPL SUCCESS # 14:22:27 INFO - Running post-action listener: _resource_record_post_action 14:22:27 INFO - [mozharness: 2017-05-03 21:22:27.444315Z] Finished run-tests step (success) 14:22:27 INFO - Running post-run listener: _resource_record_post_run 14:22:27 INFO - Total resource usage - Wall time: 1200s; CPU: 13.0%; Read bytes: 4096; Write bytes: 357781504; Read time: 36; Write time: 287724 14:22:27 INFO - TinderboxPrint: CPU usage
13.3% 14:22:27 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 36 14:22:27 INFO - TinderboxPrint: I/O write bytes / time
357,781,504 / 287,724 14:22:27 INFO - TinderboxPrint: CPU idle
8,304.0 (86.7%) 14:22:27 INFO - TinderboxPrint: CPU user
1,216.4 (12.7%) 14:22:27 INFO - TinderboxPrint: Swap in / out
0 / 0 14:22:27 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 34582528; Read time: 0; Write time: 7528 14:22:27 INFO - run-tests - Wall time: 1185s; CPU: 13.0%; Read bytes: 0; Write bytes: 254054400; Read time: 0; Write time: 184040 14:22:28 INFO - Running post-run listener: _upload_blobber_files 14:22:28 INFO - Blob upload gear active. 14:22:28 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 14:22:28 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 14:22:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 14:22:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 14:22:28 INFO - (blobuploader) - INFO - Open directory for files ... 14:22:28 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 14:22:28 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:22:28 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:22:29 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 14:22:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:22:29 INFO - (blobuploader) - INFO - Done attempting. 14:22:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 14:22:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:22:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:22:32 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 14:22:32 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:22:32 INFO - (blobuploader) - INFO - Done attempting. 14:22:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 14:22:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:22:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:22:33 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 14:22:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:22:33 INFO - (blobuploader) - INFO - Done attempting. 14:22:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 14:22:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:22:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:22:34 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 14:22:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:22:34 INFO - (blobuploader) - INFO - Done attempting. 14:22:34 INFO - (blobuploader) - INFO - Iteration through files over. 14:22:34 INFO - Return code: 0 14:22:34 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 14:22:34 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 14:22:34 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8b6d195a4352621faa98eaba9381dbf7bba9bcd3bb634f9c919220f73c60c0ddd7353b184e43cc0f2e5474a6ed71f3ba6643108d45b861c17e551770de2343d8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/549ac5edc268ba1a33dfb40e9f7c7e8d6c32551773da963cc2d4af6450c534ae7626fe57be0dc41a2e6703fd274cb2ac3a19a7e1436b01e251c3dfecc2d5a349", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b78a2e888c60f313b85cf019cb0f74ee77c4ad69edaa1d77f5f8c4877ea70b74c0085b3356a9f8017c2c864fa6acd251a0db011992cd10fec79804e9b50b5aa9", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/df7956dcaddf53d531e77870705150ba5580673847e63038717813bc7fb17af0ca6b826ac1426d895214497f01091e4dce445da8c4b22048a56235d91ec64f25"} 14:22:34 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 14:22:34 INFO - Writing to file /builds/slave/test/properties/blobber_files 14:22:34 INFO - Contents: 14:22:34 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8b6d195a4352621faa98eaba9381dbf7bba9bcd3bb634f9c919220f73c60c0ddd7353b184e43cc0f2e5474a6ed71f3ba6643108d45b861c17e551770de2343d8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/549ac5edc268ba1a33dfb40e9f7c7e8d6c32551773da963cc2d4af6450c534ae7626fe57be0dc41a2e6703fd274cb2ac3a19a7e1436b01e251c3dfecc2d5a349", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b78a2e888c60f313b85cf019cb0f74ee77c4ad69edaa1d77f5f8c4877ea70b74c0085b3356a9f8017c2c864fa6acd251a0db011992cd10fec79804e9b50b5aa9", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/df7956dcaddf53d531e77870705150ba5580673847e63038717813bc7fb17af0ca6b826ac1426d895214497f01091e4dce445da8c4b22048a56235d91ec64f25"} 14:22:34 INFO - Running post-run listener: copy_logs_to_upload_dir 14:22:34 INFO - Copying logs to upload dir... 14:22:34 INFO - mkdir: /builds/slave/test/build/upload/logs 14:22:34 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1252.784959 ========= master_lag: 0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 52 secs) (at 2017-05-03 14:22:34.147332) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-03 14:22:34.150887) ========= 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=88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8b6d195a4352621faa98eaba9381dbf7bba9bcd3bb634f9c919220f73c60c0ddd7353b184e43cc0f2e5474a6ed71f3ba6643108d45b861c17e551770de2343d8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/549ac5edc268ba1a33dfb40e9f7c7e8d6c32551773da963cc2d4af6450c534ae7626fe57be0dc41a2e6703fd274cb2ac3a19a7e1436b01e251c3dfecc2d5a349", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b78a2e888c60f313b85cf019cb0f74ee77c4ad69edaa1d77f5f8c4877ea70b74c0085b3356a9f8017c2c864fa6acd251a0db011992cd10fec79804e9b50b5aa9", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/df7956dcaddf53d531e77870705150ba5580673847e63038717813bc7fb17af0ca6b826ac1426d895214497f01091e4dce445da8c4b22048a56235d91ec64f25"} build_url:https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011315 build_url: 'https://queue.taskcluster.net/v1/task/XhHz6DzcQdeZf8Dv3qufRw/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/8b6d195a4352621faa98eaba9381dbf7bba9bcd3bb634f9c919220f73c60c0ddd7353b184e43cc0f2e5474a6ed71f3ba6643108d45b861c17e551770de2343d8", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/549ac5edc268ba1a33dfb40e9f7c7e8d6c32551773da963cc2d4af6450c534ae7626fe57be0dc41a2e6703fd274cb2ac3a19a7e1436b01e251c3dfecc2d5a349", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b78a2e888c60f313b85cf019cb0f74ee77c4ad69edaa1d77f5f8c4877ea70b74c0085b3356a9f8017c2c864fa6acd251a0db011992cd10fec79804e9b50b5aa9", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/df7956dcaddf53d531e77870705150ba5580673847e63038717813bc7fb17af0ca6b826ac1426d895214497f01091e4dce445da8c4b22048a56235d91ec64f25"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-03 14:22:34.176566) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-03 14:22:34.176914) ========= 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=88e9d754c8c9af9f7805d7f3000001bd-1493845299.270072-2053026302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004448 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-03 14:22:34.261369) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-03 14:22:34.261702) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-03 14:22:34.261990) ========= ========= Total master_lag: 0.16 =========